[Date Prev][Date Next] [Chronological] [Thread] [Top]

Re: Synrepl on 2.3



On 6/13/06, Aaron Richton <richton@nbcs.rutgers.edu> wrote:
Turn up debugging on both sides (-d trace sync) and see what's happening,
or not.  i.e., you should see the slave connect to the master, bind, and
do a search for "* +" or whatever you specify. Smart money is often on
err=49 (invalid credentials).

I wish but our replication user does work properly, it can login, communication to the master server also works via SSL, but the replication is just not happening.

on the master, i see a connection from the slave :

Jun 13 17:24:50 balor slapd[72432]: conn=0 fd=12 TLS established
tls_ssf=256 ssf=256
Jun 13 17:24:50 balor slapd[72432]: conn=0 op=0 BIND
dn="cn=ldaprep,dc=domain,dc=com" method=128
Jun 13 17:24:50 balor slapd[72432]: conn=0 op=0 BIND
dn="cn=ldaprep,dc=domain,dc=com" mech=SIMPLE ssf=0
Jun 13 17:24:50 balor slapd[72432]: conn=0 op=0 RESULT tag=97 err=0 text=
Jun 13 17:24:50 balor slapd[72432]: conn=0 op=1 SRCH
base="dc=domain,dc=com" scope=2 deref=0 filter="(objectClass=*)"
Jun 13 17:24:50 balor slapd[72432]: conn=0 op=1 SRCH attr=*
structuralObjectClass entryCSN

From the slave, upon restart, i'm getting :

Jun 13 17:24:13 ogma slapd[1715]: Config: ** successfully added syncrepl "ldaps://balor:636" Jun 13 17:26:53 ogma slapd[1752]: >>> dnPrettyNormal: <cn=ldaprep,dc=domain,dc=com> Jun 13 17:26:53 ogma slapd[1752]: <<< dnPrettyNormal: <cn=ldaprep,dc=domain,dc=com>, <cn=ldaprep,dc=domain,dc=com> Jun 13 17:26:53 ogma slapd[1752]: do_bind: version=3 dn="cn=ldaprep,dc=domain,dc=com" method=128 Jun 13 17:26:53 ogma slapd[1752]: conn=15 op=0 BIND dn="cn=ldaprep,dc=domain,dc=com" method=128 Jun 13 17:26:53 ogma slapd[1752]: ==> bdb_bind: dn: cn=ldaprep,dc=domain,dc=com Jun 13 17:26:53 ogma slapd[1752]: bdb_dn2entry("cn=ldaprep,dc=domain,dc=com") Jun 13 17:26:53 ogma slapd[1752]: => access_allowed: auth access to "cn=ldaprep,dc=domain,dc=com" "userPassword" requested Jun 13 17:26:53 ogma slapd[1752]: => acl_get: [1] attr userPassword Jun 13 17:26:53 ogma slapd[1752]: access_allowed: no res from state (userPassword) Jun 13 17:26:53 ogma slapd[1752]: => acl_mask: access to entry "cn=ldaprep,dc=domain,dc=com", attr "userPassword" requested Jun 13 17:26:53 ogma slapd[1752]: => acl_mask: to value by "", (=0) Jun 13 17:26:53 ogma slapd[1752]: <= check a_dn_pat: cn=admin,dc=domain,dc=com Jun 13 17:26:53 ogma slapd[1752]: <= check a_dn_pat: anonymous Jun 13 17:26:53 ogma slapd[1752]: <= acl_mask: [2] applying auth(=xd) (stop) Jun 13 17:26:53 ogma slapd[1752]: <= acl_mask: [2] mask: auth(=xd) Jun 13 17:26:53 ogma slapd[1752]: => access_allowed: auth access granted by auth(=xd) Jun 13 17:26:53 ogma slapd[1752]: conn=15 op=0 BIND dn="cn=ldaprep,dc=domain,dc=com" mech=SIMPLE ssf=0 Jun 13 17:26:53 ogma slapd[1752]: do_bind: v3 bind: "cn=ldaprep,dc=domain,dc=com" to "cn=ldaprep,dc=domain,dc=com" Jun 13 17:26:53 ogma slapd[1752]: send_ldap_result: conn=15 op=0 p=3 Jun 13 17:26:53 ogma slapd[1752]: send_ldap_result: err=0 matched="" text="" Jun 13 17:26:53 ogma slapd[1752]: send_ldap_response: msgid=1 tag=97 err=0 Jun 13 17:26:53 ogma slapd[1752]: conn=15 op=0 RESULT tag=97 err=0 text= Jun 13 17:26:53 ogma slapd[1752]: daemon: activity on 1 descriptor Jun 13 17:26:53 ogma slapd[1752]: daemon: activity on: Jun 13 17:26:53 ogma slapd[1752]: 28r Jun 13 17:26:53 ogma slapd[1752]: Jun 13 17:26:53 ogma slapd[1752]: daemon: read active on 28 Jun 13 17:26:53 ogma slapd[1752]: connection_get(28) Jun 13 17:26:53 ogma slapd[1752]: connection_get(28): got connid=15 Jun 13 17:26:53 ogma slapd[1752]: connection_read(28): checking for input on id=15 Jun 13 17:26:53 ogma slapd[1752]: do_extended Jun 13 17:26:53 ogma slapd[1752]: do_extended: oid=1.3.6.1.4.1.4203.1.11.3 Jun 13 17:26:53 ogma slapd[1752]: conn=15 op=1 WHOAMI Jun 13 17:26:53 ogma slapd[1752]: send_ldap_extended: err=0 oid= len=27 Jun 13 17:26:53 ogma slapd[1752]: send_ldap_response: msgid=2 tag=120 err=0 Jun 13 17:26:53 ogma slapd[1752]: ber_get_next on fd 28 failed errno=11 (Resource temporarily unavailable) Jun 13 17:26:53 ogma slapd[1752]: daemon: select: listen=7 active_threads=0 tvp=NULL Jun 13 17:26:53 ogma slapd[1752]: daemon: select: listen=8 active_threads=0 tvp=NULL Jun 13 17:26:53 ogma slapd[1752]: conn=15 op=1 RESULT oid= err=0 text= Jun 13 17:26:53 ogma slapd[1752]: daemon: activity on 1 descriptor Jun 13 17:26:53 ogma slapd[1752]: daemon: activity on: Jun 13 17:26:53 ogma slapd[1752]: 28r Jun 13 17:26:53 ogma slapd[1752]: Jun 13 17:26:53 ogma slapd[1752]: daemon: read active on 28 Jun 13 17:26:53 ogma slapd[1752]: connection_get(28) Jun 13 17:26:53 ogma slapd[1752]: connection_get(28): got connid=15 Jun 13 17:26:53 ogma slapd[1752]: connection_read(28): checking for input on id=15 Jun 13 17:26:53 ogma slapd[1752]: ber_get_next on fd 28 failed errno=11 (Resource temporarily unavailable) Jun 13 17:26:53 ogma slapd[1752]: daemon: select: listen=7 active_threads=0 tvp=NULL Jun 13 17:26:53 ogma slapd[1752]: daemon: select: listen=8 active_threads=0 tvp=NULL Jun 13 17:26:53 ogma slapd[1752]: do_unbind Jun 13 17:26:53 ogma slapd[1752]: conn=15 op=2 UNBIND Jun 13 17:26:53 ogma slapd[1752]: connection_closing: readying conn=15 sd=28 for close Jun 13 17:26:53 ogma slapd[1752]: connection_resched: attempting closing conn=15 sd=28 Jun 13 17:26:53 ogma slapd[1752]: connection_close: conn=15 sd=28 Jun 13 17:26:53 ogma slapd[1752]: daemon: removing 28 Jun 13 17:26:53 ogma slapd[1752]: conn=15 fd=28 closed Jun 13 17:26:53 ogma slapd[1752]: daemon: activity on 1 descriptor Jun 13 17:26:53 ogma slapd[1752]: daemon: activity on:

I can't really see what is happening here.
Steph