[389-users] restarting the 389 after a reboot

[Steven Jones]

8><----
 
>start the admin server like this:
>/usr/sbin/start-ds-admin -e debug

8><----

Great thanks...nice output.....

====================
[root at vuwunicooimm001 admin-serv]# /usr/sbin/start-ds-admin -e debug
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module authz_host_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module auth_basic_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module authn_file_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module log_config_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module env_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module mime_magic_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module expires_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module deflate_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module headers_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module unique_id_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module setenvif_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module mime_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module vhost_alias_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module negotiation_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module dir_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module actions_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module alias_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module rewrite_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module cache_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module disk_cache_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module cgi_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module restartd_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module nss_module
[Thu Jun 24 13:44:55 2010] [debug] mod_so.c(246): loaded module admserv_module
[Thu Jun 24 13:44:55 2010] [debug] mod_admserv/mod_admserv.c(2506): [18043] create_server_config [0xbogus %p for (null)
[Thu Jun 24 13:44:55 2010] [debug] mod_admserv/mod_admserv.c(2494): [18043] create_config [0xbogus %p for (null)
[Thu Jun 24 13:44:55 2010] [debug] mod_admserv/mod_admserv.c(2567): [18043] Set [0xbogus %p [ADMCacheLifeTime] to 600
[Thu Jun 24 13:44:55 2010] [debug] mod_admserv/mod_admserv.c(2585): [18043] Set [0xbogus %p [ADMServerVersionString] to 389-Administrator/1.1.10
[Thu Jun 24 13:44:55 2010] [debug] mod_admserv/mod_admserv.c(2494): [18043] create_config [0xbogus %p for /*/[tT]asks/[Oo]peration/*
[Thu Jun 24 13:44:55 2010] [debug] mod_admserv/mod_admserv.c(2519): [18043] adminsdk [0xbogus %p flag 1
[Thu Jun 24 13:44:55 2010] [debug] mod_admserv/mod_admserv.c(2494): [18043] create_config [0xbogus %p for /*/[tT]asks/[Cc]onfiguration/*
[Thu Jun 24 13:44:55 2010] [debug] mod_admserv/mod_admserv.c(2519): [18043] adminsdk [0xbogus %p flag 1
[Thu Jun 24 13:44:55 2010] [debug] mod_admserv/mod_admserv.c(2494): [18043] create_config [0xbogus %p for /*/[tT]asks/[Oo]peration/(?i:stop|start|restart|startconfigds|create|remove)$
[Thu Jun 24 13:44:55 2010] [debug] mod_admserv/mod_admserv.c(2519): [18043] adminsdk [0xbogus %p flag 0
httpd (pid 11347) already running
[root at vuwunicooimm001 admin-serv]# pwd
/etc/dirsrv/admin-serv
=============

So I stopped it with,

"stop-ds-admin"

and restarted it,

=====================
[root at vuwunicooimm001 sbin]# /usr/sbin/start-ds-admin -e debug
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module authz_host_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module auth_basic_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module authn_file_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module log_config_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module env_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module mime_magic_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module expires_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module deflate_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module headers_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module unique_id_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module setenvif_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module mime_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module vhost_alias_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module negotiation_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module dir_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module actions_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module alias_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module rewrite_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module cache_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module disk_cache_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module cgi_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module restartd_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module nss_module
[Thu Jun 24 13:56:59 2010] [debug] mod_so.c(246): loaded module admserv_module
[Thu Jun 24 13:56:59 2010] [debug] mod_admserv/mod_admserv.c(2506): [18668] create_server_config [0xbogus %p for (null)
[Thu Jun 24 13:56:59 2010] [debug] mod_admserv/mod_admserv.c(2494): [18668] create_config [0xbogus %p for (null)
[Thu Jun 24 13:56:59 2010] [debug] mod_admserv/mod_admserv.c(2567): [18668] Set [0xbogus %p [ADMCacheLifeTime] to 600
[Thu Jun 24 13:56:59 2010] [debug] mod_admserv/mod_admserv.c(2585): [18668] Set [0xbogus %p [ADMServerVersionString] to 389-Administrator/1.1.10
[Thu Jun 24 13:56:59 2010] [debug] mod_admserv/mod_admserv.c(2494): [18668] create_config [0xbogus %p for /*/[tT]asks/[Oo]peration/*
[Thu Jun 24 13:56:59 2010] [debug] mod_admserv/mod_admserv.c(2519): [18668] adminsdk [0xbogus %p flag 1
[Thu Jun 24 13:56:59 2010] [debug] mod_admserv/mod_admserv.c(2494): [18668] create_config [0xbogus %p for /*/[tT]asks/[Cc]onfiguration/*
[Thu Jun 24 13:56:59 2010] [debug] mod_admserv/mod_admserv.c(2519): [18668] adminsdk [0xbogus %p flag 1
[Thu Jun 24 13:56:59 2010] [debug] mod_admserv/mod_admserv.c(2494): [18668] create_config [0xbogus %p for /*/[tT]asks/[Oo]peration/(?i:stop|start|restart|startconfigds|create|remove)$
[Thu Jun 24 13:56:59 2010] [debug] mod_admserv/mod_admserv.c(2519): [18668] adminsdk [0xbogus %p flag 0
[root at vuwunicooimm001 sbin]#
====================

So I try the console, and I get a pop up box saying,

"Cannot logon because of an incorrect User ID, incorrect password or directory problem"

"java.io.InterruptedIOException: HTTP response timeout"

It appears to disappear on the second or tenth attempt, the admin server seems to take 2 to 7 minutes to get ready to answer.......

Then I get cannot connect to the directory server blah:389.

Now I have some error messages,

===========
[Thu Jun 24 14:05:46 2010] [notice] [client 127.0.0.1] admserv_host_ip_check: host [localhost.localdomain] did not match pattern [*.vuw.ac.nz] -will scan aliases
[Thu Jun 24 14:05:46 2010] [notice] [client 127.0.0.1] admserv_host_ip_check: host alias [localhost] did not match pattern [*.vuw.ac.nz]
[Thu Jun 24 14:05:46 2010] [debug] mod_admserv/mod_admserv.c(2762): admserv_check_user_id
[Thu Jun 24 14:05:46 2010] [debug] mod_admserv/mod_admserv.c(1910): [18934] cache entry not found for user [ldapadmin]
[Thu Jun 24 14:05:46 2010] [debug] mod_admserv/mod_admserv.c(1918): [18934] user [ldapadmin] not cached - reason user not in cache
[Thu Jun 24 14:05:46 2010] [crit] buildUGInfo(): unable to initialize TLS connection to LDAP host vuwunicooimm001.vuw.ac.nz port 389: 4
[Thu Jun 24 14:05:46 2010] [notice] [client 127.0.0.1] admserv_check_authz(): passing [/admin-serv/authenticate] to the userauth handler
[Thu Jun 24 14:05:46 2010] [crit] buildUGInfo(): unable to initialize TLS connection to LDAP host vuwunicooimm001.vuw.ac.nz port 389: 4
[Thu Jun 24 14:05:46 2010] [debug] mod_admserv/mod_admserv.c(2609): userauth, bind (null)
[Thu Jun 24 14:52:25 2010] [notice] [client 127.0.0.1] admserv_host_ip_check: ap_get_remote_host could not resolve 127.0.0.1
[Thu Jun 24 14:52:25 2010] [notice] [client 127.0.0.1] admserv_host_ip_check: host [localhost.localdomain] did not match pattern [*.vuw.ac.nz] -will scan aliases
[Thu Jun 24 14:52:25 2010] [notice] [client 127.0.0.1] admserv_host_ip_check: host alias [localhost] did not match pattern [*.vuw.ac.nz]
[Thu Jun 24 14:52:25 2010] [debug] mod_admserv/mod_admserv.c(2762): admserv_check_user_id
[Thu Jun 24 14:52:25 2010] [debug] mod_admserv/mod_admserv.c(1910): [18934] cache entry not found for user [ldapadmin]
[Thu Jun 24 14:52:25 2010] [debug] mod_admserv/mod_admserv.c(1918): [18934] user [ldapadmin] not cached - reason user not in cache
[Thu Jun 24 14:52:25 2010] [crit] buildUGInfo(): unable to initialize TLS connection to LDAP host vuwunicooimm001.vuw.ac.nz port 389: 4
[Thu Jun 24 14:52:25 2010] [notice] [client 127.0.0.1] admserv_check_authz(): passing [/admin-serv/authenticate] to the userauth handler
[Thu Jun 24 14:52:25 2010] [crit] buildUGInfo(): unable to initialize TLS connection to LDAP host vuwunicooimm001.vuw.ac.nz port 389: 4
[Thu Jun 24 14:52:25 2010] [debug] mod_admserv/mod_admserv.c(2609): userauth, bind (null)
[root at vuwunicooimm001 admin-serv]#
====================

regards

Steven