Wartung am 15.11. – Forum ab 22:00 Uhr nicht erreichbar

[simatec]

@meister-mopper
Die Meldung dass keine zigbee Instanz auf dem Host liegt ist neu.
Bei der 1.8.5 gab es diese noch nicht.
Trotzdem sollte dein zigbee Backup nicht vollständig sein. Poste mal den Inhalt des zigbee Backups
Ich würde dir raten auf 2.1.0 zu gehen und auf deinem Slave eine Instanz zu installieren, die dann zigbee sichert.

[simatec]

Ab sofort steht die Version 2.1.1 auf Github und im latest bereit ...

Changelog

2.1.1 (11.04.2021)

• (simatec) Bugfix redis
• (simatec) debug Log for Restore request added
• (simatec) Bugfix influxdb
• (simatec) ignore Filenames for javascript-Backup added

[Meister Mopper]

@simatec

In der Tat ist das zigbee Backup leer, hatte ich in sträflicher Weise noch nicht getestet. Ich probier es mal mit einer Backitup-Instanz auf dem Slave.

Wie ich bereits schrieb, werden bei mir mit 2.1.0 keine Backups geschrieben, und die o. a. Fehlermeldung kommt mit 1.8.5 nachdem ich von 2.1.0 zurück bin..

[simatec]

@meister-mopper
Dann benötige ich mal den Log von der Backup Erstellung unter 2.1.0

[Meister Mopper]

@simatec

Habe erneut 2.1.0 installiert und ein Backup angeschoben. Das Backupfenster bleibt mind. 3 Minuten stehen, dann kommt ein browser refresh und das Fenster wird geschlossen.

In opt/iobroker/backups wurde ein neues Backup gespeichert. Das redis Backup ist nicht vorhanden.

Auf dem NAS und google drive tut sich nichts.

Hier das debug-log im ioBroker:

Spoiler

backitup.0	2021-04-11 17:36:47.379	debug	(21225) telegram-instance: telegram.0
backitup.0	2021-04-11 17:34:34.929	debug	(21225) [iobroker/redis] Created redistmp directory
backitup.0	2021-04-11 17:34:34.929	debug	(21225) [iobroker/redis] old redis tmp directory "/opt/iobroker/backups/redistmp" successfully deleted
backitup.0	2021-04-11 17:34:34.928	debug	(21225) [iobroker/redis] Try deleting the old redis tmp directory: "/opt/iobroker/backups/redistmp"
backitup.0	2021-04-11 17:34:34.927	debug	(21225) [iobroker/redis] Start Redis Backup ...
backitup.0	2021-04-11 17:34:34.324	debug	(21225) [iobroker/iobroker] done
backitup.0	2021-04-11 17:34:33.300	debug	(21225) [iobroker/iobroker] Backup created: /opt/iobroker/backups/iobroker_2021_04_11-17_34_22_backupiobroker.tar.gz
backitup.0	2021-04-11 17:34:26.043	debug	(21225) [iobroker/iobroker] host.iobroker 18530 objects saved
backitup.0	2021-04-11 17:34:26.011	debug	(21225) [iobroker/iobroker] host.iobroker 21538 states saved
backitup.0	2021-04-11 17:34:22.541	debug	(21225) Backup has started ...
backitup.0	2021-04-11 17:34:08.997	debug	(21225) detect last backup file: iobroker_2021_04_10-09_02_14_backupiobroker.tar.gz
backitup.0	2021-04-11 17:34:08.997	debug	(21225) detect backup file 4 from googledrive: iobroker_2021_03_31-02_01_10_backupiobroker.tar.gz
backitup.0	2021-04-11 17:34:08.996	debug	(21225) detect backup file 3 from googledrive: iobroker_2021_04_01-02_01_10_backupiobroker.tar.gz
backitup.0	2021-04-11 17:34:08.996	debug	(21225) detect backup file 2 from googledrive: iobroker_2021_04_03-02_01_10_backupiobroker.tar.gz
backitup.0	2021-04-11 17:34:08.996	debug	(21225) detect backup file 1 from googledrive: iobroker_2021_04_11-02_01_10_backupiobroker.tar.gz
backitup.0	2021-04-11 17:34:07.979	debug	(21225) detect backup file 4 from ftp: iobroker_2021_04_10-09_02_14_backupiobroker.tar.gz
backitup.0	2021-04-11 17:34:07.979	debug	(21225) detect backup file 3 from ftp: iobroker_2021_04_05-02_01_10_backupiobroker.tar.gz
backitup.0	2021-04-11 17:34:07.979	debug	(21225) detect backup file 2 from ftp: iobroker_2021_04_03-02_01_10_backupiobroker.tar.gz
backitup.0	2021-04-11 17:34:07.978	debug	(21225) detect backup file 1 from ftp: iobroker_2021_04_01-02_01_10_backupiobroker.tar.gz
backitup.0	2021-04-11 17:34:07.500	debug	(21225) telegram-instance: telegram.0
backitup.0	2021-04-11 17:34:05.959	debug	(21225) FTP: connected.
backitup.0	2021-04-11 17:34:05.722	debug	(21225) [ccu] 10 39 01 */30 * *
backitup.0	2021-04-11 17:34:05.714	info	(21225) [ccu] backup was activated at 01:39 every 30 day(s)
backitup.0	2021-04-11 17:34:05.714	debug	(21225) [iobroker] 10 01 02 */2 * *
backitup.0	2021-04-11 17:34:05.699	info	(21225) [iobroker] backup was activated at 02:01 every 2 day(s)
backitup.0	2021-04-11 17:34:05.649	info	(21225) starting. Version 2.1.0 in /opt/iobroker/node_modules/iobroker.backitup, node: v12.22.1, js-controller: 3.2.16
backitup.0	2021-04-11 17:34:05.530	debug	(21225) Plugin sentry Initialize Plugin (enabled=true)
backitup.0	2021-04-11 17:34:04.797	debug	(21225) statesDB connected
backitup.0	2021-04-11 17:34:04.796	debug	(21225) States connected to redis: 127.0.0.1:6379
backitup.0	2021-04-11 17:34:04.792	debug	(21225) States create User PubSub Client
backitup.0	2021-04-11 17:34:04.792	debug	(21225) States create System PubSub Client
backitup.0	2021-04-11 17:34:04.788	debug	(21225) Redis States: Use Redis connection: 127.0.0.1:6379
backitup.0	2021-04-11 17:34:04.787	debug	(21225) objectDB connected
backitup.0	2021-04-11 17:34:04.782	debug	(21225) Objects connected to redis: 0.0.0.0:9001
backitup.0	2021-04-11 17:34:04.768	debug	(21225) Objects client initialize lua scripts
backitup.0	2021-04-11 17:34:04.767	debug	(21225) Objects create User PubSub Client
backitup.0	2021-04-11 17:34:04.767	debug	(21225) Objects create System PubSub Client
backitup.0	2021-04-11 17:34:04.766	debug	(21225) Objects client ready ... initialize now
backitup.0	2021-04-11 17:34:04.745	debug	(21225) Redis Objects: Use Redis connection: 0.0.0.0:9001

Hier der Ordner /opt/iobroker/backups:

Spoiler

-rw-rw-r--+ 1 iobroker iobroker 21093792 Apr  7 02:01 iobroker_2021_04_07-02_01_10_backupiobroker.tar.gz
-rw-rw-r--+ 1 iobroker iobroker 21092630 Apr  9 02:01 iobroker_2021_04_09-02_01_10_backupiobroker.tar.gz
-rw-rw-r--+ 1 iobroker iobroker 21102472 Apr 10 08:56 iobroker_2021_04_10-08_55_56_backupiobroker.tar.gz
-rw-rw-r--+ 1 iobroker iobroker 21095026 Apr 10 09:02 iobroker_2021_04_10-09_02_14_backupiobroker.tar.gz
-rw-rw-r--+ 1 iobroker iobroker 21072355 Apr 11 02:01 iobroker_2021_04_11-02_01_10_backupiobroker.tar.gz
-rw-rw-r--+ 1 iobroker iobroker 21093693 Apr 11 17:29 iobroker_2021_04_11-17_29_44_backupiobroker.tar.gz
-rw-rw-r--+ 1 iobroker iobroker 21093599 Apr 11 17:34 iobroker_2021_04_11-17_34_22_backupiobroker.tar.gz
-rw-rw-r--+ 1 iobroker iobroker  1235163 Apr  3 02:01 redis_2021_04_03-02_01_22_backupiobroker.tar.gz
-rw-rw-r--+ 1 iobroker iobroker  1256577 Apr  5 02:01 redis_2021_04_05-02_01_21_backupiobroker.tar.gz
-rw-rw-r--+ 1 iobroker iobroker  1273063 Apr 10 09:02 redis_2021_04_10-09_02_25_backupiobroker.tar.gz
-rw-rw-r--+ 1 iobroker iobroker  1250573 Apr 11 02:01 redis_2021_04_11-02_01_22_backupiobroker.tar.gz
drwxrwxr-x+ 2 iobroker iobroker     4096 Apr 11 17:34 redistmp

[Meister Mopper]

@simatec

Hier bleibt der Prozess offenbar stehen:

Spoiler

Started iobroker ...
[DEBUG] [iobroker] start with {"type":"creator","time":"02:01","debugging":true,"everyXDays":"2","deleteBackupAfter":0,"ftp":{"enabled":true,"type":"storage","source":"cifs","host":"192.168.178.100","debugging":true,"deleteOldBackup":true,"ownDir":true,"bkpType":"Minimal","dir":"home/backup/standard","dirMinimal":"home/backup/standard","user":"ioBroker","pass":"****","port":"21"},"googledrive":{"enabled":true,"type":"storage","source":"cifs","debugging":true,"deleteOldBackup":true,"accessJson":"****","ownDir":true,"bkpType":"Minimal","dir":"/backupDir/minimal","dirMinimal":"/backupDir/minimal"},"dir":"/opt/iobroker","redis":{"enabled":true,"type":"creator","ftp":{"enabled":true,"type":"storage","source":"cifs","host":"192.168.178.100","debugging":true,"deleteOldBackup":true,"ownDir":true,"bkpType":"Minimal","dir":"home/backup/standard","dirMinimal":"home/backup/standard","user":"ioBroker","pass":"****","port":"21"},"cifs":{"enabled":false,"mountType":"CIFS","type":"storage","source":"cifs","mount":"192.168.178.100","debugging":true,"fileDir":"/opt/iobroker/node_modules/iobroker.backitup","wakeOnLAN":true,"macAd":"00:11:32:B6:EA:F0","wolTime":"25","smb":"vers=1.0","sudo":true,"cifsDomain":"","deleteOldBackup":false,"ownDir":true,"bkpType":"Minimal","dir":"homes/ioBroker/backup/standard","dirMinimal":"homes/ioBroker/backup/standard","user":"ioBroker","pass":"****"},"dropbox":{"enabled":false,"type":"storage","source":"cifs","debugging":true,"deleteOldBackup":false,"accessToken":"****","ownDir":false,"bkpType":"Minimal","dir":"/backupDir","dirMinimal":"/backupDir/minimal"},"webdav":{"enabled":false,"type":"storage","source":"cifs","debugging":true,"deleteOldBackup":false,"username":"username","pass":"****","url":"https://example.com/remote.php/dav/files/username/","ownDir":false,"bkpType":"Minimal","dir":"/backupDir","dirMinimal":"/backupDir/iobroker"},"googledrive":{"enabled":true,"type":"storage","source":"cifs","debugging":true,"deleteOldBackup":true,"accessJson":"****","ownDir":true,"bkpType":"Minimal","dir":"/backupDir/minimal","dirMinimal":"/backupDir/minimal"},"aof":false,"path":"/var/lib/redis/dump.rdb"},"historyHTML":{"enabled":true,"type":"message","entriesNumber":"","systemLang":"de"},"historyJSON":{"enabled":true,"type":"message","entriesNumber":"","systemLang":"de"},"telegram":{"enabled":true,"notificationsType":"Telegram","type":"message","instance":"telegram.0","SilentNotice":true,"NoticeType":"longTelegramNotice","User":"allTelegramUsers","onlyError":false,"telegramWaiting":5000,"systemLang":"de"},"email":{"enabled":true,"notificationsType":"Telegram","type":"message","instance":"","NoticeType":"longEmailNotice","emailReceiver":"xxx@xxx.com","emailSender":"xxx@xxx.com","onlyError":false,"emailWaiting":0,"systemLang":"de"},"pushover":{"enabled":true,"notificationsType":"Telegram","type":"message","instance":"","SilentNotice":false,"NoticeType":"longPushoverNotice","deviceID":"","onlyError":false,"pushoverWaiting":0,"systemLang":"de"},"whatsapp":{"enabled":true,"notificationsType":"Telegram","type":"message","instance":"","NoticeType":"longWhatsappNotice","onlyError":false,"whatsappWaiting":0,"systemLang":"de"},"backupDir":"/opt/iobroker/backups"}
[DEBUG] [iobroker] - host.iobroker 21538 states saved

[DEBUG] [iobroker] - host.iobroker 18530 objects saved

[DEBUG] [iobroker] - Backup created: /opt/iobroker/backups/iobroker_2021_04_11-17_49_13_backupiobroker.tar.gz

[DEBUG] [iobroker] - done
[DEBUG] [redis] - Start Redis Backup ...
[DEBUG] [redis] - Try deleting the old redis tmp directory: "/opt/iobroker/backups/redistmp"
[DEBUG] [redis] - old redis tmp directory "/opt/iobroker/backups/redistmp" successfully deleted
[DEBUG] [redis] - Created redistmp directory

[Rene_HM]

Seit ein paar Tagen habe ich das Problem, das backups auf meiner Fritzbox nicht mehr erzeugt werden. Ich bin mir leider nicht sicher, ob das erst seit dem update auf die 2.x nicht mehr funktioniert. Kann gut sein, dass das Problem schon eher aufgetaucht ist, ich es nur nicht gemerkt habe. Bin mir auch nicht sicher, ob es ein Adapter-Problem ist, oder auf meine Umgebung hier zurückzuführen ist...

Folgendes Phänomen: Ich bekomme im log die Fehlermeldung

2021-04-11 01:30:11.532  - error: backitup.0 (25174) [ccu] Backup folder not created: Error: EPERM: operation not permitted, chmod '/opt/iobroker/backups'Please reinstall backitup and run "iobroker fix"!!
2021-04-11 01:30:11.562  - debug: backitup.0 (25174) Backup has started ...
2021-04-11 01:30:22.007  - debug: backitup.0 (25174) [ccu/mount] first mount attempt with smb option failed. try next mount attempt without smb option ...
2021-04-11 01:30:22.514  - debug: backitup.0 (25174) [ccu/mount] [undefined Error: Command failed: sudo mount -t cifs -o username=xxx,password=****,rw,file_mode=0777,dir_mode=0777 //192.168.xx.xx/LiveSystem_Espressobin /opt/iobroker/backups
2021-04-11 01:30:22.522  - debug: backitup.0 (25174) [ccu/mount] mount error(112): Host is down
2021-04-11 01:30:22.524  - debug: backitup.0 (25174) [ccu/mount] Refer to the mount.cifs(8) manual page (e.g. man mount.cifs)
2021-04-11 01:30:22.530  - debug: backitup.0 (25174) [ccu/mount] [IGNORED] Error: Command failed: sudo mount -t cifs -o username=xxx,password=****,rw,file_mode=0777,dir_mode=0777 //192.168.xx.xx/LiveSystem_Espressobin /opt/iobroker/backups
2021-04-11 01:30:22.532  - debug: backitup.0 (25174) [ccu/mount] mount error(112): Host is down
2021-04-11 01:30:22.537  - debug: backitup.0 (25174) [ccu/mount] Refer to the mount.cifs(8) manual page (e.g. man mount.cifs)

Das "host is down" macht micht stutzig, da die FB definitiv erreichbar ist. Also habe ich das ganze manuell versucht:

1. Versuch: Befehl wie im log auf der console eingeben. Ergebnis ist wie im Adapter

sudo mount -t cifs -o username=xxx,password=xxx,rw,file_mode=0777,dir_mode=0777 //192.168.xx.xx/LiveSystem_Espressobin /opt/iobroker/backups
mount error(112): Host is down
Refer to the mount.cifs(8) manual page (e.g. man mount.cifs)

2. Versuch: erst umount und dann noch ein mount-Versuch, funktioniert auch nicht:

sudo umount /opt/iobroker/backups
sudo mount -t cifs -o username=xxx,password=xxx,rw,file_mode=0777,dir_mode=0777 //192.168.xx.xx/LiveSystem_Espressobin /opt/iobroker/backups
mount error(112): Host is down
Refer to the mount.cifs(8) manual page (e.g. man mount.cifs)

3. Versuch: erst umount und die SMB-Version auf 1.0 setzen, das funktioniert dann

sudo umount /opt/iobroker/backups
sudo mount -t cifs -o username=xxx,password=xxx,vers=1.0,rw,file_mode=0777,dir_mode=0777 //192.168.3.1/LiveSystem_Espressobin /opt/iobroker/backups

Leider führt ein mount mit vers=1.0 ohne umount zu einem nächsten Fehler:

 sudo mount -t cifs -o username=xxx,password=xxx,vers=1.0,rw,file_mode=0777,dir_mode=0777 //192.168.3.1/LiveSystem_Espressobin /opt/iobroker/backups
mount error(16): Device or resource busy
Refer to the mount.cifs(8) manual page (e.g. man mount.cifs)

Hier noch meine config dazu:

-> @simatec könnest du das umount (evtl. optional) und die SMB-Version ("vers=1.0") in den Adapter einbauen? Die SMB Version hast du ja bereits im admin und anscheinend war das auch schon mal drin (im log sehe ich "first mount attempt with smb option failed. try next mount attempt without smb option ", aber ich sehe keinen Unterschied in den Kommandos)
oder alternativ hat ja vielleicht noch jemand eine andere Idee?

[simatec]

@meister-mopper Installiere mal die Version 2.1.1

[simatec]

@rene_hm
So wie ich das sehe, hast du eine FB.
Poste mal bitte dein Config der FB.
Zu dem Device Busy würde ich dir raten dein System mal zut Sicherheit neuzustarten
Hatte das bei mir auch mal gehabt

[Meister Mopper]

@simatec
So, habe mal 2.1.1 installiert. Funktioniert problemlos, Danke!!

[Rene_HM]

@simatec sagte in Test Adapter Backitup v2.1.x:

So wie ich das sehe, hast du eine FB.

ja, richtig

Poste mal bitte dein Config der FB.

welche config meinst da damit?

Zu dem Device Busy würde ich dir raten dein System mal zut Sicherheit neuzustarten

alles neu gestartet, keine Änderung.

Bist du sicher, du schickst das "vers=1.0" für die SMB Version mit? müsste ja nach "dir_mode=0777" im ersten Versuch stehen?
Im log hier sehe ich das nicht:

2021-04-11 01:30:22.007  - debug: backitup.0 (25174) [ccu/mount] first mount attempt with smb option failed. try next mount attempt without smb option ...
2021-04-11 01:30:22.514  - debug: backitup.0 (25174) [ccu/mount] [undefined Error: Command failed: sudo mount -t cifs -o username=xxx,password=****,rw,file_mode=0777,dir_mode=0777 //192.168.xx.xx/LiveSystem_Espressobin /opt/iobroker/backups
2021-04-11 01:30:22.522  - debug: backitup.0 (25174) [ccu/mount] mount error(112): Host is down
2021-04-11 01:30:22.524  - debug: backitup.0 (25174) [ccu/mount] Refer to the mount.cifs(8) manual page (e.g. man mount.cifs)
2021-04-11 01:30:22.530  - debug: backitup.0 (25174) [ccu/mount] [IGNORED] Error: Command failed: sudo mount -t cifs -o username=xxx,password=****,rw,file_mode=0777,dir_mode=0777 //192.168.xx.xx/LiveSystem_Espressobin /opt/iobroker/backups
2021-04-11 01:30:22.532  - debug: backitup.0 (25174) [ccu/mount] mount error(112): Host is down
2021-04-11 01:30:22.537  - debug: backitup.0 (25174) [ccu/mount] Refer to the mount.cifs(8) manual page (e.g. man mount.cifs)

[simatec]

@rene_hm
Es wird zuerst mit smb Option versucht den mount zu setzen

[simatec]

@rene_hm
Hast du deine FB in letzter Zeit aktualisiert? Ich weiß, dass es da einige Probleme mit smb gab

[simatec]

@rene_hm sagte in Test Adapter Backitup v2.1.x:

welche config meinst da damit?

Die Config deiner FB im speziellen NAS

[simatec]

Ab sofort steht die Version 2.1.2 auf Github und im latest zur Verfügung.

Changelog

2.1.2 (13.04.2021)

• (simatec) Creation of temporary folders changed
• (simatec) Filter for redis rdb files changed
• (simatec) automatic deletion of old influx databases added
• (simatec) noserverino option for CIFS mount added
• (simatec) dependencies updated

[Rene_HM]

@simatec sagte in Test Adapter Backitup v2.1.x:

Hast du deine FB in letzter Zeit aktualisiert? Ich weiß, dass es da einige Probleme mit smb gab

Nein , meine FB ist so alt, die bekommt keine updates mehr Ich denke aber, ich habe das Problem gefunden. Nachdem ich den Adapter auf zwei anderen Systemen an der gleichen FB ohne Probleme betreiben konnte, habe ich das Problem-System weiter untersucht...
Wenn ich das richtig sehe, mountest du den Pfad immer dann, wenn du es brauchst (beim Start vom Adapter und dann wieder beim backup). Sobald du den Pfad nicht mehr brauchst, un-mountest du. Damit funktioniert der nächste mount-Versuch. Wenn aber (aus welchen Gründen auch immer, z.Bsp. Absturz) der Pfad gemounted bleibt, läuft der nächste mount-Versuch erst in ein "system is busy" Fehler und der retry danach endet mit "host is down". Damit war kein weiterer mount mehr möglich. Erst nach manuellem un-mount fängt sich das ganze wieder... . Ob dieserFall oft in der Praxis vorkommt, kann ich nicht sagen, aber die Fehlersuche ist definitiv schwierig...

[simatec]

@rene_hm
Eigentlich wird immer erst geprüft, ob der mount gesetzt ist und führt dann ein umount aus.
Erst danach wird der mount gesetzt

[JB_Sullivan]

@simatec

Du solltest in deinen Adapter die Möglichkeit einbauen, ein Restore auch aus der Admin Menü Leiste durchführen zu können.

Konkret ist das aufgefallen, da durch den Admin 5.0.2 unter bestimmten Umständen (zwei Admin Instanzen) kein Zugriff mehr auf die Instanzverwaltung möglich ist. Keine Instanzen = keine Möglichkeit ein Backup anzustoßen.

Darum wäre es hilfreich, wenn das auch aus dem seitlichen Menü heraus möglich wäre.

[simatec]

@jb_sullivan
siehe hier ...

[JB_Sullivan]

@simatec

---

@jb_sullivan sagte in Test Adapter Admin 5.0.x: Alpha der neuen UI:

Ist das LOG Fenster während des Restore Prozess noch aktuell? Wenn ja, so wurde es bei mir nicht angezeigt

Popup in deinem Browser eventuell nicht aktiv?

Ja, PopUp ist aktiviert