Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter server min protocol = SMB2_02
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter server max protocol = SMB3
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter interfaces = 127.0.0.1 10.0.10.102
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter bind interfaces only = yes
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter encrypt passwords = yes
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter dns proxy = no
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter strict locking = no
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter aio max threads = 2
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter oplocks = yes
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter deadtime = 15
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter max log size = 51200
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter private dir = /var/db/samba4/private
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter max open files = 467462
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter logging = syslog:10
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter load printers = no
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter printing = bsd
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter printcap name = /dev/null
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter disable spoolss = yes
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter getwd cache = yes
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter guest account = nobody
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter obey pam restrictions = no
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter ntlm auth = no
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter directory name cache size = 0
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter kernel change notify = no
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter nsupdate command = /usr/local/bin/samba-nsupdate -g
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter server string = FreeNAS Server slave
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter ea support = yes
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter store dos attributes = yes
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter lm announce = yes
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter hostname lookups = yes
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter acl allow execute always = true
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter dos filemode = yes
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter multicast dns register = yes
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter local master = no
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter idmap config *: backend = tdb
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter idmap config *: range = 90000001-100000000
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter server role = member server
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter security = user
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter passdb backend = ldapsam:ldap://ucs.mydomain.de:7389
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter ldap admin dn = uid=Administrator,cn=users,dc=ourname,dc=de
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter ldap suffix = dc=ourname,dc=de
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter ldap user suffix = ou=Users
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter ldap group suffix = ou=Groups
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter ldap ssl = start tls
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter ldap replication sleep = 1000
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter ldap passwd sync = yes
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter ldapsam:trusted = yes
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter workgroup = WORKGROUP
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter domain logons = yes
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter idmap config WORKGROUP: backend = ldap
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter idmap config WORKGROUP: range = 10000-90000000
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter netbios name = STORAGESLAVE
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter create mask = 0666
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter directory mask = 0777
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter client ntlmv2 auth = yes
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter dos charset = CP437
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter unix charset = UTF-8
Jun 26 21:08:07 storageslave smbd[14581]:   doing parameter log level = 10
Jun 26 21:08:07 storageslave smbd[14581]: [2019/06/26 21:08:07.362888,  5, pid=14581, effective(0, 0), real(0, 0)] ../lib/util/debug.c:754(debug_dump_status)
Jun 26 21:08:07 storageslave smbd[14581]:   INFO: Current debug levels:
Jun 26 21:08:07 storageslave smbd[14581]:     all: 10
Jun 26 21:08:07 storageslave smbd[14581]:     tdb: 10
Jun 26 21:08:07 storageslave smbd[14581]:     printdrivers: 10
Jun 26 21:08:07 storageslave smbd[14581]:     smb: 10
Jun 26 21:08:07 storageslave smbd[14581]:     rpc_srv: 10
Jun 26 21:08:07 storageslave smbd[14581]:     rpc_cli: 10
Jun 26 21:08:07 storageslave smbd[14581]:     passdb: 10
Jun 26 21:08:07 storageslave smbd[14581]:     sam: 10
Jun 26 21:08:07 storageslave smbd[14581]:     auth: 10
Jun 26 21:08:07 storageslave smbd[14581]:     winbind: 10
Jun 26 21:08:07 storageslave smbd[14581]:     vfs: 10
Jun 26 21:08:07 storageslave smbd[14581]:     idmap: 10
Jun 26 21:08:07 storageslave smbd[14581]:     quota: 10
Jun 26 21:08:07 storageslave smbd[14581]:     acls: 10
Jun 26 21:08:07 storageslave smbd[14581]:     locking: 10
Jun 26 21:08:07 storageslave smbd[14581]:     msdfs: 10
Jun 26 21:08:07 storageslave smbd[14581]: [2019/06/26 21:08:07.363328,  2, pid=14581, effective(0, 0), real(0, 0)] ../source3/lib/interface.c:345(add_interface)
Jun 26 21:08:07 storageslave smbd[14581]:   added interface lo0 ip=127.0.0.1 bcast=127.255.255.255 netmask=255.0.0.0
Jun 26 21:08:07 storageslave smbd[14581]: [2019/06/26 21:08:07.363421,  1, pid=14581, effective(0, 0), real(0, 0)] ../source3/profile/profile_dummy.c:30(set_profile_level)
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.364575,  5, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:79(smb_register_passdb)
Jun 26 21:08:07 storageslave smbd[14582]:   Attempting to register passdb backend smbpasswd
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.364588,  5, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:92(smb_register_passdb)
Jun 26 21:08:07 storageslave smbd[14582]:   Successfully added passdb backend 'smbpasswd'
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.364598,  5, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:79(smb_register_passdb)
Jun 26 21:08:07 storageslave smbd[14582]:   Attempting to register passdb backend tdbsam
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.364608,  5, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:92(smb_register_passdb)
Jun 26 21:08:07 storageslave smbd[14582]:   Successfully added passdb backend 'tdbsam'
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.364617,  5, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:79(smb_register_passdb)
Jun 26 21:08:07 storageslave smbd[14582]:   Attempting to register passdb backend samba_dsdb
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.364627,  5, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:92(smb_register_passdb)
Jun 26 21:08:07 storageslave smbd[14582]:   Successfully added passdb backend 'samba_dsdb'
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.364635,  5, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:79(smb_register_passdb)
Jun 26 21:08:07 storageslave smbd[14582]:   Attempting to register passdb backend samba4
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.364644,  5, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:92(smb_register_passdb)
Jun 26 21:08:07 storageslave smbd[14582]:   Successfully added passdb backend 'samba4'
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.364653,  5, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:79(smb_register_passdb)
Jun 26 21:08:07 storageslave smbd[14582]:   Attempting to register passdb backend ldapsam
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.364662,  5, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:92(smb_register_passdb)
Jun 26 21:08:07 storageslave smbd[14582]:   Successfully added passdb backend 'ldapsam'
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.364671,  5, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:79(smb_register_passdb)
Jun 26 21:08:07 storageslave smbd[14582]:   Attempting to register passdb backend NDS_ldapsam
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.364680,  5, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:92(smb_register_passdb)
Jun 26 21:08:07 storageslave smbd[14582]:   Successfully added passdb backend 'NDS_ldapsam'
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.364689,  5, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:155(make_pdb_method_name)
Jun 26 21:08:07 storageslave smbd[14582]:   Attempting to find a passdb backend to match ldapsam:ldap://ucs.mydomain.de:7389 (ldapsam)
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.364699,  5, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:176(make_pdb_method_name)
Jun 26 21:08:07 storageslave smbd[14582]:   Found pdb backend ldapsam
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.364741,  2, pid=14582, effective(0, 0), real(0, 0)] ../source3/passdb/pdb_ldap_util.c:281(smbldap_search_domain_info)
Jun 26 21:08:07 storageslave smbd[14582]:   smbldap_search_domain_info: Searching for:[(&(objectClass=sambaDomain)(sambaDomainName=WORKGROUP))]
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.364808,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1173(smbldap_close)
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.394377,  3, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:632(smbldap_start_tls)
Jun 26 21:08:07 storageslave smbd[14582]:   StartTLS issued: using a TLS connection
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.394402,  2, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:847(smbldap_open_connection)
Jun 26 21:08:07 storageslave smbd[14582]:   smbldap_open_connection: connection opened
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.406359,  3, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1069(smbldap_connect_system)
Jun 26 21:08:07 storageslave smbd[14582]:   ldap_connect_system: successful connection to the LDAP server
Jun 26 21:08:07 storageslave smbd[14582]:   ldap_connect_system: LDAP server does support paged results
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.406392,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1151(smbldap_open)
Jun 26 21:08:07 storageslave smbd[14582]:   The LDAP server is successfully connected
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.407086,  5, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:187(make_pdb_method_name)
Jun 26 21:08:07 storageslave smbd[14582]:   pdb backend ldapsam:ldap://ucs.mydomain.de:7389 has a valid init
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.409072,  5, pid=14582, effective(0, 0), real(0, 0)] ../lib/dbwrap/dbwrap.c:130(dbwrap_lock_order_lock)
Jun 26 21:08:07 storageslave smbd[14582]:   dbwrap_lock_order_lock: check lock order 1 for /var/run/samba4/smbXsrv_version_global.tdb
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.409192,  5, pid=14582, effective(0, 0), real(0, 0)] ../lib/dbwrap/dbwrap.c:159(dbwrap_lock_order_unlock)
Jun 26 21:08:07 storageslave smbd[14582]:   dbwrap_lock_order_unlock: release lock order 1 for /var/run/samba4/smbXsrv_version_global.tdb
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.409218,  1, pid=14582, effective(0, 0), real(0, 0), class=rpc_parse] ../librpc/ndr/ndr.c:422(ndr_print_debug)
Jun 26 21:08:07 storageslave smbd[14582]:        &global_blob: struct smbXsrv_version_globalB
Jun 26 21:08:07 storageslave smbd[14582]:           version                  : SMBXSRV_VERSION_0 (0)
Jun 26 21:08:07 storageslave smbd[14582]:           seqnum                   : 0x00000001 (1)
Jun 26 21:08:07 storageslave smbd[14582]:           info                     : union smbXsrv_version_globalU(case 0)
Jun 26 21:08:07 storageslave smbd[14582]:           info0                    : *
Jun 26 21:08:07 storageslave smbd[14582]:               info0: struct smbXsrv_version_global0
Jun 26 21:08:07 storageslave smbd[14582]:                   db_rec                   : NULL
Jun 26 21:08:07 storageslave smbd[14582]:                   num_nodes                : 0x00000001 (1)
Jun 26 21:08:07 storageslave smbd[14582]:                   nodes: ARRAY(1)
Jun 26 21:08:07 storageslave smbd[14582]:                       nodes: struct smbXsrv_version_node0
Jun 26 21:08:07 storageslave smbd[14582]:                           server_id: struct server_id
Jun 26 21:08:07 storageslave smbd[14582]:                               pid                      : 0x00000000000038f6 (14582)
Jun 26 21:08:07 storageslave smbd[14582]:                               task_id                  : 0x00000000 (0)
Jun 26 21:08:07 storageslave smbd[14582]:                               vnn                      : 0xffffffff (4294967295)
Jun 26 21:08:07 storageslave smbd[14582]:                               unique_id                : 0x8c38af4ee5047d98 (-8342725556319257192)
Jun 26 21:08:07 storageslave smbd[14582]:                           min_version              : SMBXSRV_VERSION_0 (0)
Jun 26 21:08:07 storageslave smbd[14582]:                           current_version          : SMBXSRV_VERSION_0 (0)
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.470262,  3, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/util_procid.c:54(pid_to_procid)
Jun 26 21:08:07 storageslave smbd[14582]:   pid_to_procid: messaging_dgm_get_unique failed: No such file or directory
Jun 26 21:08:07 storageslave smbd[14623]: [2019/06/26 21:08:07.472018,  5, pid=14623, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1173(smbldap_close)
Jun 26 21:08:07 storageslave smbd[14623]:   The connection to the LDAP server was closed
Jun 26 21:08:07 storageslave smbd[14623]: [2019/06/26 21:08:07.472037,  5, pid=14623, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1173(smbldap_close)
Jun 26 21:08:07 storageslave smbd[14623]:   The connection to the LDAP server was closed
Jun 26 21:08:07 storageslave smbd[14623]: [2019/06/26 21:08:07.472055,  5, pid=14623, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:155(make_pdb_method_name)
Jun 26 21:08:07 storageslave smbd[14623]:   Attempting to find a passdb backend to match ldapsam:ldap://ucs.mydomain.de:7389 (ldapsam)
Jun 26 21:08:07 storageslave smbd[14623]: [2019/06/26 21:08:07.472067,  5, pid=14623, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:176(make_pdb_method_name)
Jun 26 21:08:07 storageslave smbd[14623]:   Found pdb backend ldapsam
Jun 26 21:08:07 storageslave smbd[14623]: [2019/06/26 21:08:07.472133,  2, pid=14623, effective(0, 0), real(0, 0)] ../source3/passdb/pdb_ldap_util.c:281(smbldap_search_domain_info)
Jun 26 21:08:07 storageslave smbd[14623]:   smbldap_search_domain_info: Searching for:[(&(objectClass=sambaDomain)(sambaDomainName=WORKGROUP))]
Jun 26 21:08:07 storageslave smbd[14623]: [2019/06/26 21:08:07.472155,  5, pid=14623, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1308(smbldap_search_ext)
Jun 26 21:08:07 storageslave smbd[14623]:   smbldap_search_ext: base => [dc=ourname,dc=de], filter => [(&(objectClass=sambaDomain)(sambaDomainName=WORKGROUP))], scope => [2]
Jun 26 21:08:07 storageslave smbd[14623]: [2019/06/26 21:08:07.472183,  5, pid=14623, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1173(smbldap_close)
Jun 26 21:08:07 storageslave smbd[14623]:   The connection to the LDAP server was closed
Jun 26 21:08:07 storageslave smbd[14624]: [2019/06/26 21:08:07.475763,  5, pid=14624, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1173(smbldap_close)
Jun 26 21:08:07 storageslave smbd[14624]:   The connection to the LDAP server was closed
Jun 26 21:08:07 storageslave smbd[14624]: [2019/06/26 21:08:07.475780,  5, pid=14624, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1173(smbldap_close)
Jun 26 21:08:07 storageslave smbd[14624]:   The connection to the LDAP server was closed
Jun 26 21:08:07 storageslave smbd[14624]: [2019/06/26 21:08:07.475793,  5, pid=14624, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:155(make_pdb_method_name)
Jun 26 21:08:07 storageslave smbd[14624]:   Attempting to find a passdb backend to match ldapsam:ldap://ucs.mydomain.de:7389 (ldapsam)
Jun 26 21:08:07 storageslave smbd[14624]: [2019/06/26 21:08:07.475805,  5, pid=14624, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:176(make_pdb_method_name)
Jun 26 21:08:07 storageslave smbd[14624]:   Found pdb backend ldapsam
Jun 26 21:08:07 storageslave smbd[14624]: [2019/06/26 21:08:07.475849,  2, pid=14624, effective(0, 0), real(0, 0)] ../source3/passdb/pdb_ldap_util.c:281(smbldap_search_domain_info)
Jun 26 21:08:07 storageslave smbd[14624]:   smbldap_search_domain_info: Searching for:[(&(objectClass=sambaDomain)(sambaDomainName=WORKGROUP))]
Jun 26 21:08:07 storageslave smbd[14624]: [2019/06/26 21:08:07.475862,  5, pid=14624, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1308(smbldap_search_ext)
Jun 26 21:08:07 storageslave smbd[14624]:   smbldap_search_ext: base => [dc=ourname,dc=de], filter => [(&(objectClass=sambaDomain)(sambaDomainName=WORKGROUP))], scope => [2]
Jun 26 21:08:07 storageslave smbd[14624]: [2019/06/26 21:08:07.475879,  5, pid=14624, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1173(smbldap_close)
Jun 26 21:08:07 storageslave smbd[14624]:   The connection to the LDAP server was closed
Jun 26 21:08:07 storageslave smbd[14623]: [2019/06/26 21:08:07.481369,  3, pid=14623, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:632(smbldap_start_tls)
Jun 26 21:08:07 storageslave smbd[14623]:   StartTLS issued: using a TLS connection
Jun 26 21:08:07 storageslave smbd[14623]: [2019/06/26 21:08:07.481389,  2, pid=14623, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:847(smbldap_open_connection)
Jun 26 21:08:07 storageslave smbd[14623]:   smbldap_open_connection: connection opened
Jun 26 21:08:07 storageslave smbd[14624]: [2019/06/26 21:08:07.486711,  3, pid=14624, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:632(smbldap_start_tls)
Jun 26 21:08:07 storageslave smbd[14624]:   StartTLS issued: using a TLS connection
Jun 26 21:08:07 storageslave smbd[14624]: [2019/06/26 21:08:07.486729,  2, pid=14624, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:847(smbldap_open_connection)
Jun 26 21:08:07 storageslave smbd[14624]:   smbldap_open_connection: connection opened
Jun 26 21:08:07 storageslave smbd[14623]: [2019/06/26 21:08:07.494514,  3, pid=14623, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1069(smbldap_connect_system)
Jun 26 21:08:07 storageslave smbd[14623]:   ldap_connect_system: successful connection to the LDAP server
Jun 26 21:08:07 storageslave smbd[14623]:   ldap_connect_system: LDAP server does support paged results
Jun 26 21:08:07 storageslave smbd[14623]: [2019/06/26 21:08:07.494547,  4, pid=14623, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1151(smbldap_open)
Jun 26 21:08:07 storageslave smbd[14623]:   The LDAP server is successfully connected
Jun 26 21:08:07 storageslave smbd[14623]: [2019/06/26 21:08:07.495233,  5, pid=14623, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:187(make_pdb_method_name)
Jun 26 21:08:07 storageslave smbd[14623]:   pdb backend ldapsam:ldap://ucs.mydomain.de:7389 has a valid init
Jun 26 21:08:07 storageslave smbd[14623]: [2019/06/26 21:08:07.495282,  5, pid=14623, effective(0, 0), real(0, 0)] ../source3/lib/messages.c:709(messaging_register)
Jun 26 21:08:07 storageslave smbd[14623]:   Registering messaging pointer for type 794 - private_data=0x813e7d730
Jun 26 21:08:07 storageslave smbd[14623]: [2019/06/26 21:08:07.495293,  5, pid=14623, effective(0, 0), real(0, 0)] ../source3/lib/messages.c:709(messaging_register)
Jun 26 21:08:07 storageslave smbd[14623]:   Registering messaging pointer for type 795 - private_data=0x813e7d730
Jun 26 21:08:07 storageslave smbd[14623]: [2019/06/26 21:08:07.495303,  5, pid=14623, effective(0, 0), real(0, 0)] ../source3/lib/messages.c:709(messaging_register)
Jun 26 21:08:07 storageslave smbd[14623]:   Registering messaging pointer for type 796 - private_data=0x813e7d730
Jun 26 21:08:07 storageslave smbd[14624]: [2019/06/26 21:08:07.501789,  3, pid=14624, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1069(smbldap_connect_system)
Jun 26 21:08:07 storageslave smbd[14624]:   ldap_connect_system: successful connection to the LDAP server
Jun 26 21:08:07 storageslave smbd[14624]:   ldap_connect_system: LDAP server does support paged results
Jun 26 21:08:07 storageslave smbd[14624]: [2019/06/26 21:08:07.501813,  4, pid=14624, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1151(smbldap_open)
Jun 26 21:08:07 storageslave smbd[14624]:   The LDAP server is successfully connected
Jun 26 21:08:07 storageslave smbd[14624]: [2019/06/26 21:08:07.502348,  5, pid=14624, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_interface.c:187(make_pdb_method_name)
Jun 26 21:08:07 storageslave smbd[14624]:   pdb backend ldapsam:ldap://ucs.mydomain.de:7389 has a valid init
Jun 26 21:08:07 storageslave smbd[14624]: [2019/06/26 21:08:07.502382,  5, pid=14624, effective(0, 0), real(0, 0)] ../source3/lib/messages.c:709(messaging_register)
Jun 26 21:08:07 storageslave smbd[14624]:   Registering messaging pointer for type 13 - private_data=0x813e7d580
Jun 26 21:08:07 storageslave smbd[14624]: [2019/06/26 21:08:07.502393,  5, pid=14624, effective(0, 0), real(0, 0)] ../source3/lib/messages.c:709(messaging_register)
Jun 26 21:08:07 storageslave smbd[14624]:   Registering messaging pointer for type 788 - private_data=0x813e7d580
Jun 26 21:08:07 storageslave smbd[14624]: [2019/06/26 21:08:07.502403,  5, pid=14624, effective(0, 0), real(0, 0)] ../source3/lib/messages.c:709(messaging_register)
Jun 26 21:08:07 storageslave smbd[14624]:   Registering messaging pointer for type 785 - private_data=0x0
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.502612,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/messages.c:709(messaging_register)
Jun 26 21:08:07 storageslave smbd[14582]:   Registering messaging pointer for type 789 - private_data=0x813e3f380
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.503788,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/username.c:181(Get_Pwnam_alloc)
Jun 26 21:08:07 storageslave smbd[14582]:   Finding user nobody
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.503798,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/username.c:120(Get_Pwnam_internals)
Jun 26 21:08:07 storageslave smbd[14582]:   Trying _Get_Pwnam(), username as lowercase is nobody
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.503914,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/username.c:159(Get_Pwnam_internals)
Jun 26 21:08:07 storageslave smbd[14582]:   Get_Pwnam_internals did find user [nobody]!
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.503935,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/username.c:181(Get_Pwnam_alloc)
Jun 26 21:08:07 storageslave smbd[14582]:   Finding user WORKGROUP\nobody
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.503944,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/username.c:120(Get_Pwnam_internals)
Jun 26 21:08:07 storageslave smbd[14582]:   Trying _Get_Pwnam(), username as lowercase is WORKGROUP\nobody
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.504660,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/username.c:128(Get_Pwnam_internals)
Jun 26 21:08:07 storageslave smbd[14582]:   Trying _Get_Pwnam(), username as given is WORKGROUP\nobody
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.504857,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/username.c:141(Get_Pwnam_internals)
Jun 26 21:08:07 storageslave smbd[14582]:   Trying _Get_Pwnam(), username as uppercase is WORKGROUP\NOBODY
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.505059,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/username.c:153(Get_Pwnam_internals)
Jun 26 21:08:07 storageslave smbd[14582]:   Checking combinations of 0 uppercase letters in WORKGROUP\nobody
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.505075,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/username.c:159(Get_Pwnam_internals)
Jun 26 21:08:07 storageslave smbd[14582]:   Get_Pwnam_internals didn't find user [WORKGROUP\nobody]!
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.505085,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/username.c:181(Get_Pwnam_alloc)
Jun 26 21:08:07 storageslave smbd[14582]:   Finding user nobody
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.505094,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/username.c:120(Get_Pwnam_internals)
Jun 26 21:08:07 storageslave smbd[14582]:   Trying _Get_Pwnam(), username as lowercase is nobody
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.505104,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/username.c:159(Get_Pwnam_internals)
Jun 26 21:08:07 storageslave smbd[14582]:   Get_Pwnam_internals did find user [nobody]!
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.505137,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/username.c:181(Get_Pwnam_alloc)
Jun 26 21:08:07 storageslave smbd[14582]:   Finding user nobody
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.505146,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/username.c:120(Get_Pwnam_internals)
Jun 26 21:08:07 storageslave smbd[14582]:   Trying _Get_Pwnam(), username as lowercase is nobody
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.505155,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/username.c:159(Get_Pwnam_internals)
Jun 26 21:08:07 storageslave smbd[14582]:   Get_Pwnam_internals did find user [nobody]!
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.506305,  5, pid=14582, effective(0, 0), real(0, 0), class=tdb] ../source3/lib/gencache.c:72(gencache_init)
Jun 26 21:08:07 storageslave smbd[14582]:   Opening cache file at /var/run/samba4/gencache.tdb
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.506359,  5, pid=14582, effective(0, 0), real(0, 0), class=tdb] ../source3/lib/gencache.c:100(gencache_init)
Jun 26 21:08:07 storageslave smbd[14582]:   Opening cache file at /var/run/samba4/gencache_notrans.tdb
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.506553,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/sec_ctx.c:216(push_sec_ctx)
Jun 26 21:08:07 storageslave smbd[14582]:   push_sec_ctx(0, 0) : sec_ctx_stack_ndx = 1
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.506572,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/uid.c:558(push_conn_ctx)
Jun 26 21:08:07 storageslave smbd[14582]:   push_conn_ctx(0) : conn_ctx_stack_ndx = 0
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.506587,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/sec_ctx.c:320(set_sec_ctx_internal)
Jun 26 21:08:07 storageslave smbd[14582]:   setting sec ctx (0, 0) - sec_ctx_stack_ndx = 1
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.506599,  5, pid=14582, effective(0, 0), real(0, 0)] ../libcli/security/security_token.c:53(security_token_debug)
Jun 26 21:08:07 storageslave smbd[14582]:   Security token: (NULL)
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.506613,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/auth/token_util.c:866(debug_unix_user_token)
Jun 26 21:08:07 storageslave smbd[14582]:   UNIX token of user 0
Jun 26 21:08:07 storageslave smbd[14582]:   Primary group is 0 and contains 0 supplementary groups
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.506658,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/sec_ctx.c:438(pop_sec_ctx)
Jun 26 21:08:07 storageslave smbd[14582]:   pop_sec_ctx (0, 0) - sec_ctx_stack_ndx = 0
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.506700,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1308(smbldap_search_ext)
Jun 26 21:08:07 storageslave smbd[14582]:   smbldap_search_ext: base => [dc=ourname,dc=de], filter => [(&(objectClass=sambaGroupMapping)(sambaSID=S-1-5-32-544))], scope => [2]
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.515060,  3, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:632(smbldap_start_tls)
Jun 26 21:08:07 storageslave smbd[14582]:   StartTLS issued: using a TLS connection
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.515077,  2, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:847(smbldap_open_connection)
Jun 26 21:08:07 storageslave smbd[14582]:   smbldap_open_connection: connection opened
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.523622,  3, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1069(smbldap_connect_system)
Jun 26 21:08:07 storageslave smbd[14582]:   ldap_connect_system: successful connection to the LDAP server
Jun 26 21:08:07 storageslave smbd[14582]:   ldap_connect_system: LDAP server does support paged results
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.523657,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1151(smbldap_open)
Jun 26 21:08:07 storageslave smbd[14582]:   The LDAP server is successfully connected
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.524111,  2, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_ldap.c:2386(init_group_from_ldap)
Jun 26 21:08:07 storageslave smbd[14582]:   init_group_from_ldap: Entry found for group: 5052
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.524233,  2, pid=14582, effective(0, 0), real(0, 0)] ../source3/groupdb/mapping.c:611(pdb_default_get_aliasinfo)
Jun 26 21:08:07 storageslave smbd[14582]:   S-1-5-32-544 is a Domain Group, expected an alias
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.524248,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/sec_ctx.c:216(push_sec_ctx)
Jun 26 21:08:07 storageslave smbd[14582]:   push_sec_ctx(0, 0) : sec_ctx_stack_ndx = 1
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.524259,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/uid.c:558(push_conn_ctx)
Jun 26 21:08:07 storageslave smbd[14582]:   push_conn_ctx(0) : conn_ctx_stack_ndx = 0
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.524268,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/sec_ctx.c:320(set_sec_ctx_internal)
Jun 26 21:08:07 storageslave smbd[14582]:   setting sec ctx (0, 0) - sec_ctx_stack_ndx = 1
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.524277,  5, pid=14582, effective(0, 0), real(0, 0)] ../libcli/security/security_token.c:53(security_token_debug)
Jun 26 21:08:07 storageslave smbd[14582]:   Security token: (NULL)
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.524286,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/auth/token_util.c:866(debug_unix_user_token)
Jun 26 21:08:07 storageslave smbd[14582]:   UNIX token of user 0
Jun 26 21:08:07 storageslave smbd[14582]:   Primary group is 0 and contains 0 supplementary groups
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.524326,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1308(smbldap_search_ext)
Jun 26 21:08:07 storageslave smbd[14582]:   smbldap_search_ext: base => [dc=ourname,dc=de], filter => [(&(sambaSid=S-1-5-32-544)(|(objectClass=sambaGroupMapping)(objectClass=sambaSamAccount)))], scope => [2]
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.524950,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1308(smbldap_search_ext)
Jun 26 21:08:07 storageslave smbd[14582]:   smbldap_search_ext: base => [dc=ourname,dc=de], filter => [(&(objectClass=sambaGroupMapping)(sambaSid=S-1-5-32-544)(sambaGroupType=4))], scope => [2]
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.525348,  4, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_ldap.c:3599(ldapsam_modify_aliasmem)
Jun 26 21:08:07 storageslave smbd[14582]:   ldapsam_modify_aliasmem: Did not find alias
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.525365,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/passdb/pdb_util.c:59(add_sid_to_builtin)
Jun 26 21:08:07 storageslave smbd[14582]:   add_sid_to_builtin S-1-5-21-2046844337-1097251823-4019794627-512 could not be added to S-1-5-32-544: NT_STATUS_NO_SUCH_ALIAS
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.525388,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/sec_ctx.c:438(pop_sec_ctx)
Jun 26 21:08:07 storageslave smbd[14582]:   pop_sec_ctx (0, 0) - sec_ctx_stack_ndx = 0
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.525398,  2, pid=14582, effective(0, 0), real(0, 0)] ../source3/auth/token_util.c:713(finalize_local_nt_token)
Jun 26 21:08:07 storageslave smbd[14582]:   WARNING: Failed to create BUILTIN\Administrators group!  Can Winbind allocate gids?
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.525412,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1308(smbldap_search_ext)
Jun 26 21:08:07 storageslave smbd[14582]:   smbldap_search_ext: base => [dc=ourname,dc=de], filter => [(&(objectClass=sambaGroupMapping)(sambaSID=S-1-5-32-545))], scope => [2]
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.525897,  2, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_ldap.c:2386(init_group_from_ldap)
Jun 26 21:08:07 storageslave smbd[14582]:   init_group_from_ldap: Entry found for group: 5053
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.525997,  2, pid=14582, effective(0, 0), real(0, 0)] ../source3/groupdb/mapping.c:611(pdb_default_get_aliasinfo)
Jun 26 21:08:07 storageslave smbd[14582]:   S-1-5-32-545 is a Domain Group, expected an alias
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.526015,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/sec_ctx.c:216(push_sec_ctx)
Jun 26 21:08:07 storageslave smbd[14582]:   push_sec_ctx(0, 0) : sec_ctx_stack_ndx = 1
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.526032,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/uid.c:558(push_conn_ctx)
Jun 26 21:08:07 storageslave smbd[14582]:   push_conn_ctx(0) : conn_ctx_stack_ndx = 0
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.526047,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/sec_ctx.c:320(set_sec_ctx_internal)
Jun 26 21:08:07 storageslave smbd[14582]:   setting sec ctx (0, 0) - sec_ctx_stack_ndx = 1
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.526059,  5, pid=14582, effective(0, 0), real(0, 0)] ../libcli/security/security_token.c:53(security_token_debug)
Jun 26 21:08:07 storageslave smbd[14582]:   Security token: (NULL)
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.526068,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/auth/token_util.c:866(debug_unix_user_token)
Jun 26 21:08:07 storageslave smbd[14582]:   UNIX token of user 0
Jun 26 21:08:07 storageslave smbd[14582]:   Primary group is 0 and contains 0 supplementary groups
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.526090,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1308(smbldap_search_ext)
Jun 26 21:08:07 storageslave smbd[14582]:   smbldap_search_ext: base => [dc=ourname,dc=de], filter => [(&(sambaSid=S-1-5-32-545)(|(objectClass=sambaGroupMapping)(objectClass=sambaSamAccount)))], scope => [2]
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.526752,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1308(smbldap_search_ext)
Jun 26 21:08:07 storageslave smbd[14582]:   smbldap_search_ext: base => [dc=ourname,dc=de], filter => [(&(objectClass=sambaGroupMapping)(sambaSid=S-1-5-32-545)(sambaGroupType=4))], scope => [2]
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.527136,  4, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_ldap.c:3599(ldapsam_modify_aliasmem)
Jun 26 21:08:07 storageslave smbd[14582]:   ldapsam_modify_aliasmem: Did not find alias
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.527152,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/passdb/pdb_util.c:59(add_sid_to_builtin)
Jun 26 21:08:07 storageslave smbd[14582]:   add_sid_to_builtin S-1-5-21-2046844337-1097251823-4019794627-513 could not be added to S-1-5-32-545: NT_STATUS_NO_SUCH_ALIAS
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.527171,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/sec_ctx.c:438(pop_sec_ctx)
Jun 26 21:08:07 storageslave smbd[14582]:   pop_sec_ctx (0, 0) - sec_ctx_stack_ndx = 0
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.527181,  2, pid=14582, effective(0, 0), real(0, 0)] ../source3/auth/token_util.c:732(finalize_local_nt_token)
Jun 26 21:08:07 storageslave smbd[14582]:   WARNING: Failed to create BUILTIN\Users group! Can Winbind allocate gids?
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.527194,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1308(smbldap_search_ext)
Jun 26 21:08:07 storageslave smbd[14582]:   smbldap_search_ext: base => [dc=ourname,dc=de], filter => [(&(objectClass=sambaGroupMapping)(sambaSID=S-1-5-32-546))], scope => [2]
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.527668,  2, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_ldap.c:2386(init_group_from_ldap)
Jun 26 21:08:07 storageslave smbd[14582]:   init_group_from_ldap: Entry found for group: 5054
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.527760,  2, pid=14582, effective(0, 0), real(0, 0)] ../source3/groupdb/mapping.c:611(pdb_default_get_aliasinfo)
Jun 26 21:08:07 storageslave smbd[14582]:   S-1-5-32-546 is a Domain Group, expected an alias
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.527771,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/sec_ctx.c:216(push_sec_ctx)
Jun 26 21:08:07 storageslave smbd[14582]:   push_sec_ctx(0, 0) : sec_ctx_stack_ndx = 1
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.527782,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/uid.c:558(push_conn_ctx)
Jun 26 21:08:07 storageslave smbd[14582]:   push_conn_ctx(0) : conn_ctx_stack_ndx = 0
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.527792,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/sec_ctx.c:320(set_sec_ctx_internal)
Jun 26 21:08:07 storageslave smbd[14582]:   setting sec ctx (0, 0) - sec_ctx_stack_ndx = 1
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.527800,  5, pid=14582, effective(0, 0), real(0, 0)] ../libcli/security/security_token.c:53(security_token_debug)
Jun 26 21:08:07 storageslave smbd[14582]:   Security token: (NULL)
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.527809,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/auth/token_util.c:866(debug_unix_user_token)
Jun 26 21:08:07 storageslave smbd[14582]:   UNIX token of user 0
Jun 26 21:08:07 storageslave smbd[14582]:   Primary group is 0 and contains 0 supplementary groups
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.527830,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1308(smbldap_search_ext)
Jun 26 21:08:07 storageslave smbd[14582]:   smbldap_search_ext: base => [dc=ourname,dc=de], filter => [(&(sambaSid=S-1-5-32-546)(|(objectClass=sambaGroupMapping)(objectClass=sambaSamAccount)))], scope => [2]
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.528304,  5, pid=14582, effective(0, 0), real(0, 0)] ../source3/lib/smbldap.c:1308(smbldap_search_ext)
Jun 26 21:08:07 storageslave smbd[14582]:   smbldap_search_ext: base => [dc=ourname,dc=de], filter => [(&(objectClass=sambaGroupMapping)(sambaSid=S-1-5-32-546)(sambaGroupType=4))], scope => [2]
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.528785,  4, pid=14582, effective(0, 0), real(0, 0), class=passdb] ../source3/passdb/pdb_ldap.c:3599(ldapsam_modify_aliasmem)
Jun 26 21:08:07 storageslave smbd[14582]:   ldapsam_modify_aliasmem: Did not find alias
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.528799,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/passdb/pdb_util.c:59(add_sid_to_builtin)
Jun 26 21:08:07 storageslave smbd[14582]:   add_sid_to_builtin S-1-5-21-2046844337-1097251823-4019794627-501 could not be added to S-1-5-32-546: NT_STATUS_NO_SUCH_ALIAS
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.528817,  4, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/sec_ctx.c:438(pop_sec_ctx)
Jun 26 21:08:07 storageslave smbd[14582]:   pop_sec_ctx (0, 0) - sec_ctx_stack_ndx = 0
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.528827,  2, pid=14582, effective(0, 0), real(0, 0)] ../source3/auth/token_util.c:790(finalize_local_nt_token)
Jun 26 21:08:07 storageslave smbd[14582]:   Failed to create BUILTIN\Guests group NT_STATUS_NO_SUCH_ALIAS!  Can Winbind allocate gids?
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.528836,  3, pid=14582, effective(0, 0), real(0, 0)] ../source3/auth/token_util.c:412(create_local_nt_token_from_info3)
Jun 26 21:08:07 storageslave smbd[14582]:   Failed to finalize nt token
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.528846,  0, pid=14582, effective(0, 0), real(0, 0), class=auth] ../source3/auth/auth_util.c:1382(make_new_session_info_guest)
Jun 26 21:08:07 storageslave smbd[14582]:   create_local_token failed: NT_STATUS_NO_SUCH_ALIAS
Jun 26 21:08:07 storageslave smbd[14582]: [2019/06/26 21:08:07.528858,  0, pid=14582, effective(0, 0), real(0, 0)] ../source3/smbd/server.c:2000(main)
Jun 26 21:08:07 storageslave smbd[14582]:   ERROR: failed to setup guest info.