Error while backing up /var/lib/machines/nsdc/var/lib/samba/private/netlogon_creds_cli.tdb!
Action: /etc/e-smith/events/pre-backup-config/S40nethserver-dc-pre-backup FAILED: 1 [3.188115]
Also the email message is SUCCESS.
Oct 10 21:47:01 pdc-ad systemd: Started Session 6 of user root.
Oct 10 21:47:01 pdc-ad systemd: Starting Session 6 of user root.
Oct 10 21:47:02 pdc-ad esmith::event[29572]: Event: pre-backup-data
Oct 10 21:47:02 pdc-ad esmith::event[29575]: Event: pre-backup-config
Oct 10 21:47:02 pdc-ad esmith::event[29575]: expanding /etc/backup-config.d/nethserver-sssd.include
Oct 10 21:47:03 pdc-ad dbus[647]: [system] Activating via systemd: service name='org.freedesktop.timedate1' unit='dbus-org.freedesktop.timedate1.service'
Oct 10 21:47:03 pdc-ad dbus-daemon: dbus[647]: [system] Activating via systemd: service name='org.freedesktop.timedate1' unit='dbus-org.freedesktop.timedate1.service'
Oct 10 21:47:03 pdc-ad systemd: Starting Time & Date Service...
Oct 10 21:47:03 pdc-ad dbus[647]: [system] Successfully activated service 'org.freedesktop.timedate1'
Oct 10 21:47:03 pdc-ad systemd: Started Time & Date Service.
Oct 10 21:47:03 pdc-ad dbus-daemon: dbus[647]: [system] Successfully activated service 'org.freedesktop.timedate1'
Oct 10 21:47:03 pdc-ad esmith::event[29575]: Action: /etc/e-smith/events/actions/generic_template_expand SUCCESS [0.452615]
Oct 10 21:47:05 pdc-ad esmith::event[29575]: Error while backing up /var/lib/machines/nsdc/var/lib/samba/private/netlogon_creds_cli.tdb!
Oct 10 21:47:06 pdc-ad esmith::event[29575]: Action: /etc/e-smith/events/pre-backup-config/S40nethserver-dc-pre-backup FAILED: 1 [3.188115]
Oct 10 21:47:06 pdc-ad esmith::event[29575]: Action: /etc/e-smith/events/pre-backup-config/S40nethserver-sssd-backup-tdb SUCCESS [0.026547]
Oct 10 21:47:07 pdc-ad esmith::event[29575]: Action: /etc/e-smith/events/pre-backup-config/S50nethserver-backup-config-list-packages SUCCESS [1.381274]
Oct 10 21:47:07 pdc-ad esmith::event[29575]: Event: pre-backup-config FAILED
Oct 10 21:47:07 pdc-ad esmith::event[29572]: Action: /etc/e-smith/events/pre-backup-data/S20nethserver-backup-config-predatabackup SUCCESS [5.58331]
Oct 10 21:47:10 pdc-ad esmith::event[29572]: Action: /etc/e-smith/events/pre-backup-data/S20nethserver-restore-data-duc-index SUCCESS [2.219989]
Oct 10 21:47:10 pdc-ad esmith::event[29572]: Action: /etc/e-smith/events/pre-backup-data/S50mysql-dump-tables SUCCESS [0.65034]
Oct 10 21:47:10 pdc-ad esmith::event[29572]: Action: /etc/e-smith/events/pre-backup-data/S50nethserver-ibays-dump-acls SUCCESS [0.020839]
Oct 10 21:47:11 pdc-ad esmith::event[29572]: Action: /etc/e-smith/events/pre-backup-data/S70mount-cifs SUCCESS [0.444162]
Oct 10 21:47:12 pdc-ad esmith::event[29572]: Action: /etc/e-smith/events/pre-backup-data/S70mount-nfs SUCCESS [0.82255]
Oct 10 21:47:12 pdc-ad esmith::event[29572]: Action: /etc/e-smith/events/pre-backup-data/S70mount-usb SUCCESS [0.305569]
Oct 10 21:47:12 pdc-ad esmith::event[29572]: Action: /etc/e-smith/events/pre-backup-data/S70mount-webdav SUCCESS [0.31524]
Oct 10 21:47:12 pdc-ad esmith::event[29572]: Event: pre-backup-data SUCCESS
Oct 10 21:47:14 pdc-ad esmith::event[29882]: Event: post-backup-data
Oct 10 21:47:14 pdc-ad esmith::event[29882]: Action: /etc/e-smith/events/post-backup-data/S20nethserver-backup-config-push2history SUCCESS [0.042355]
Oct 10 21:47:14 pdc-ad esmith::event[29882]: Action: /etc/e-smith/events/post-backup-data/S20nethserver-backup-config-push2mount SUCCESS [0.846543]
Oct 10 21:47:15 pdc-ad esmith::event[29882]: Action: /etc/e-smith/events/post-backup-data/S50mysql-delete-dumped-tables SUCCESS [0.016379]
Oct 10 21:47:15 pdc-ad esmith::event[29882]: Action: /etc/e-smith/events/post-backup-data/S70cleanup-data-duplicity SUCCESS [0.328907]
Oct 10 21:47:15 pdc-ad esmith::event[29882]: Action: /etc/e-smith/events/post-backup-data/S70cleanup-restore-index SUCCESS [0.301255]
Oct 10 21:47:16 pdc-ad esmith::event[29882]: Action: /etc/e-smith/events/post-backup-data/S70disk-usage SUCCESS [0.442732]
Oct 10 21:47:16 pdc-ad esmith::event[29882]: Action: /etc/e-smith/events/post-backup-data/S80umount-cifs SUCCESS [0.337286]
Oct 10 21:47:16 pdc-ad esmith::event[29882]: Action: /etc/e-smith/events/post-backup-data/S80umount-nfs SUCCESS [0.484841]
Oct 10 21:47:17 pdc-ad esmith::event[29882]: Action: /etc/e-smith/events/post-backup-data/S80umount-usb SUCCESS [0.297476]
Oct 10 21:47:17 pdc-ad esmith::event[29882]: Action: /etc/e-smith/events/post-backup-data/S80umount-webdav SUCCESS [0.294454]
Oct 10 21:47:17 pdc-ad esmith::event[29882]: Event: post-backup-data SUCCESS
When I backup from my NS fully updated incl. testing 7.4b1 VM to a samba share on my raspi, it’s working except of this:
Oct 10 22:44:47 testserver esmith::event[44745]: Error while backing up /var/lib/machines/nsdc/var/lib/samba/private/netlogon_creds_cli.tdb!
Oct 10 22:44:47 testserver esmith::event[44745]: Action: /etc/e-smith/events/pre-backup-config/S40nethserver-dc-pre-backup FAILED: 1 [0.320091]
Logs:
Oct 10 22:44:46 testserver esmith::event[44742]: Event: pre-backup-data
Oct 10 22:44:47 testserver esmith::event[44745]: Event: pre-backup-config
Oct 10 22:44:47 testserver esmith::event[44745]: expanding /etc/backup-config.d/nethserver-sssd.include
Oct 10 22:44:47 testserver dbus[660]: [system] Activating via systemd: service name='org.freedesktop.timedate1' unit='dbus-org.freedesktop.timedate1.service'
Oct 10 22:44:47 testserver dbus-daemon: dbus[660]: [system] Activating via systemd: service name='org.freedesktop.timedate1' unit='dbus-org.freedesktop.timedate1.service'
Oct 10 22:44:47 testserver systemd: Starting Time & Date Service...
Oct 10 22:44:47 testserver dbus[660]: [system] Successfully activated service 'org.freedesktop.timedate1'
Oct 10 22:44:47 testserver dbus-daemon: dbus[660]: [system] Successfully activated service 'org.freedesktop.timedate1'
Oct 10 22:44:47 testserver systemd: Started Time & Date Service.
Oct 10 22:44:47 testserver esmith::event[44745]: Action: /etc/e-smith/events/actions/generic_template_expand SUCCESS [0.274598]
Oct 10 22:44:47 testserver esmith::event[44745]: Error while backing up /var/lib/machines/nsdc/var/lib/samba/private/netlogon_creds_cli.tdb!
Oct 10 22:44:47 testserver esmith::event[44745]: Action: /etc/e-smith/events/pre-backup-config/S40nethserver-dc-pre-backup FAILED: 1 [0.320091]
Oct 10 22:44:47 testserver esmith::event[44745]: Action: /etc/e-smith/events/pre-backup-config/S40nethserver-sssd-backup-tdb SUCCESS [0.007075]
Oct 10 22:44:48 testserver esmith::event[44745]: Action: /etc/e-smith/events/pre-backup-config/S50nethserver-backup-config-list-packages SUCCESS [1.052734]
Oct 10 22:44:48 testserver esmith::event[44745]: Event: pre-backup-config FAILED
Oct 10 22:44:48 testserver esmith::event[44742]: Action: /etc/e-smith/events/pre-backup-data/S20nethserver-backup-config-predatabackup SUCCESS [1.878055]
Oct 10 22:44:49 testserver esmith::event[44742]: Requested path not found
Oct 10 22:44:49 testserver esmith::event[44742]: Requested path not found
Oct 10 22:44:49 testserver esmith::event[44742]: Requested path not found
Oct 10 22:44:49 testserver esmith::event[44742]: Requested path not found
Oct 10 22:44:49 testserver esmith::event[44742]: Requested path not found
Oct 10 22:44:49 testserver esmith::event[44742]: Requested path not found
Oct 10 22:44:50 testserver esmith::event[44742]: Action: /etc/e-smith/events/pre-backup-data/S20nethserver-restore-data-duc-index SUCCESS [1.25604]
Oct 10 22:44:50 testserver esmith::event[44742]: Action: /etc/e-smith/events/pre-backup-data/S50mysql-dump-tables SUCCESS [0.41267]
Oct 10 22:44:50 testserver esmith::event[44742]: Action: /etc/e-smith/events/pre-backup-data/S50nethserver-ibays-dump-acls SUCCESS [0.014991]
Oct 10 22:44:50 testserver su: (to postgres) root on none
Oct 10 22:44:50 testserver esmith::event[44742]: Action: /etc/e-smith/events/pre-backup-data/S50nethserver-webtop5-backup SUCCESS [0.194781]
Oct 10 22:44:50 testserver esmith::event[44742]: Action: /etc/e-smith/events/pre-backup-data/S50rh-mariadb101-dump-tables SUCCESS [0.210701]
Oct 10 22:44:51 testserver esmith::event[44742]: Action: /etc/e-smith/events/pre-backup-data/S70mount-cifs SUCCESS [0.210781]
Oct 10 22:44:51 testserver esmith::event[44742]: Action: /etc/e-smith/events/pre-backup-data/S70mount-nfs SUCCESS [0.159023]
Oct 10 22:44:51 testserver esmith::event[44742]: Action: /etc/e-smith/events/pre-backup-data/S70mount-usb SUCCESS [0.131788]
Oct 10 22:44:51 testserver esmith::event[44742]: Action: /etc/e-smith/events/pre-backup-data/S70mount-webdav SUCCESS [0.137688]
Oct 10 22:44:51 testserver esmith::event[44742]: Action: /etc/e-smith/events/pre-backup-data/S80nethserver-sogo-backup-users SUCCESS [0.14306]
Oct 10 22:44:51 testserver esmith::event[44742]: Event: pre-backup-data SUCCESS
...
Oct 10 22:45:45 testserver esmith::event[45268]: Event: post-backup-data
Oct 10 22:45:45 testserver esmith::event[45268]: Action: /etc/e-smith/events/post-backup-data/S20nethserver-backup-config-push2history SUCCESS [0.015521]
Oct 10 22:45:45 testserver esmith::event[45268]: Action: /etc/e-smith/events/post-backup-data/S20nethserver-backup-config-push2mount SUCCESS [0.358711]
Oct 10 22:45:45 testserver esmith::event[45268]: Action: /etc/e-smith/events/post-backup-data/S50mysql-delete-dumped-tables SUCCESS [0.004223]
Oct 10 22:45:45 testserver esmith::event[45268]: Action: /etc/e-smith/events/post-backup-data/S50rh-mariadb101-delete-dumped-tables SUCCESS [0.003727]
Oct 10 22:45:46 testserver esmith::event[45268]: Action: /etc/e-smith/events/post-backup-data/S70cleanup-data-duplicity SUCCESS [0.158009]
Oct 10 22:45:46 testserver esmith::event[45268]: Action: /etc/e-smith/events/post-backup-data/S70cleanup-restore-index SUCCESS [0.127746]
Oct 10 22:45:46 testserver esmith::event[45268]: Action: /etc/e-smith/events/post-backup-data/S70disk-usage SUCCESS [0.166846]
Oct 10 22:45:48 testserver esmith::event[45268]: Action: /etc/e-smith/events/post-backup-data/S80umount-cifs SUCCESS [2.690879]
Oct 10 22:45:49 testserver esmith::event[45268]: Action: /etc/e-smith/events/post-backup-data/S80umount-nfs SUCCESS [0.131298]
Oct 10 22:45:49 testserver esmith::event[45268]: Action: /etc/e-smith/events/post-backup-data/S80umount-usb SUCCESS [0.129431]
Oct 10 22:45:49 testserver esmith::event[45268]: Action: /etc/e-smith/events/post-backup-data/S80umount-webdav SUCCESS [0.128236]
Oct 10 22:45:49 testserver esmith::event[45268]: Event: post-backup-data SUCCESS
I have noticed that the order of installing / updating NS as DC / AD, counts.
In my tests, when the order of installing/updating was:
Install NS 7.4 -> updates -> set as DC-AD -> first bacckup -> update to Samba 4.7.0
(Install NS 7.3 -> updates -> set as DC-AD -> first bacckup -> update to NS 7.4 -> update to Samba 4.7.0)
the backup worked even if there are the two errors.
When the order of installing/updating was:
Install NS 7.4 -> updates -> set as DC-AD -> update to Samba 4.7.0 -> first backup
Thank you very much @GG_jr@mrmarkuz, it seems we hit some bug. I change the category to #bug, now let’s find some information about the error and a possible solution.
In 4.7 Samba changed locks handling (“Whole DB read locks” - see release notes)…
As workaround, we can leave 4.7 behind until this issue is solved. I want to compile ns-samba-4.6.8 and push it to 7.4 repositories. Other enhancements (automatic updates, showing samba version in Accounts provider page) can live with 4.6.8.