Zeitstempel bei Last Seen im Network Binding weicht von der Systemzeit ab

[udo1toni]

Ok, das ist zwar nicht schön (wegen: Fehler unklar), aber wenn es damit getan ist, ja auch ein gangbarer Weg.

[lenschith]

Hatte mich zu früh gefreut, kann aber irgendwie nicht wirklich feststellen wann und wie das passiert.
Hatte heute wieder UNDEF im Item und habe ewig getestet. Nach einen weiteren Reboot hatte folgenden Eintrag im Log

Code: Alles auswählen

2024-08-26 15:16:54.448 [INFO ] [openhab.event.ItemStateChangedEvent ] - Item 'User1ZuletztOnline_Zuletztgesehen' changed from NULL to 2024-08-26T13:32:52.851782190+0200
2024-08-26 15:16:56.420 [INFO ] [ab.event.ThingStatusInfoChangedEvent] - Thing 'network:pingdevice:User1ZuletztOnline' changed from UNINITIALIZED (HANDLER_MISSING_ERROR): Handler factory not found to UNINITIALIZED (NOT_YET_READY)
2024-08-26 15:16:58.174 [INFO ] [ab.event.ThingStatusInfoChangedEvent] - Thing 'network:pingdevice:User1ZuletztOnline' changed from UNINITIALIZED (NOT_YET_READY) to INITIALIZING
2024-08-26 15:16:58.192 [INFO ] [ab.event.ThingStatusInfoChangedEvent] - Thing 'network:pingdevice:User1ZuletztOnline' changed from INITIALIZING to ONLINE
2024-08-26 15:17:11.677 [INFO ] [openhab.event.ItemStateChangedEvent ] - Item 'User1ZuletztOnline_Zuletztgesehen' changed from 2024-08-26T13:32:52.851782190+0200 to UNDEF

Das betreffende Gerät war nicht im Netzwerk erreichbar. der erste Eintrag im Log zeigt den Wert aus der mapDB, dann scheint das das Thing zu starten und übergibt dann den Wert UNDEF.

Habe ich noch irgendwas falsch oder übersehen? Bzw. hat noch jemand ne Idee.

EDIT: Also während des Reboots war das Gerät nicht im LAN und danach auch nicht. Wenn das eine Rolle spielen sollte

[udo1toni]

Warum geht denn das Thing offline? Meine pingdevices sind alle online, unabhängig vom Status des Geräts. Ich denke, das wird das Problem sein, Du musst herausfinden, warum die Things Offline gehen.

[lenschith]

Beim reboot des containers starten die Things doch neu? Das machen glaub ich alle so.

[udo1toni]

Ja, an der Stelle ist das natürlich korrekt. Das würde natürlich den Restore ad Absurdum führen (die Reihenfolge sollte eigentlich anders sein, zuerst alle Things online, dann Restore der Items).
Wie sieht es im Log an den Stellen aus, wo UNDEF ohne vorherigen Neustart auftritt?

[EmptySoft]

Kann es sein, dass das Item eingelesen wird, eine Rule (oder sonst etwas) etwas reinschreibt und daher das Restore daher nicht durchgeführt wird?

[lenschith]

Hallo Udo,
ich kann das gerade nicht mehr verifizieren ob/wann das passiert ohne Neustart. Ich bin mir sicher das der Container das letzte mal nicht neu gestartet hat aber aktuell kann ich das so nicht mehr bestätigen.

Was ich nochmals getestet habe, ist das Verhalten bei einem reboot. Geräte die in der Zeit im LAN/WLAN nicht erreichbar sind werden wie oben beschrieben behandelt und mit einem UNDEF überschrieben. Sobald sich die Geräte wieder im Netzwerk befinden und erreichbar sind wird der Zeitstempel immer wieder wie gewohnt aktualisiert und nicht mit einem UNDEF überschrieben. Das funktioniert solange bis ein reboot ausgelöst wird. Manuell oder z.B. beim Backupjob

Code: Alles auswählen

2024-08-29 15:35:23.972 [INFO ] [openhab.event.ItemStateChangedEvent ] - Item 'User1Zuletztgesehen_Zuletztgesehen' changed from NULL to 2024-08-29T11:14:47.918796970+0200
2024-08-29 15:35:25.330 [INFO ] [ab.event.ThingStatusInfoChangedEvent] - Thing 'network:pingdevice:User1aZuletztOnline' changed from UNINITIALIZED (HANDLER_MISSING_ERROR): Handler factory not found to UNINITIALIZED (NOT_YET_READY)
2024-08-29 15:35:27.703 [INFO ] [ab.event.ThingStatusInfoChangedEvent] - Thing 'network:pingdevice:User1ZuletztOnline' changed from UNINITIALIZED (NOT_YET_READY) to INITIALIZING
2024-08-29 15:35:27.712 [INFO ] [ab.event.ThingStatusInfoChangedEvent] - Thing 'network:pingdevice:User1ZuletztOnline' changed from INITIALIZING to ONLINE
2024-08-29 15:35:40.224 [INFO ] [openhab.event.ItemStateChangedEvent ] - Item 'User1Zuletztgesehen_Zuletztgesehen' changed from 2024-08-29T11:14:47.918796970+0200 to UNDEF

Die Items werden in keiner Rule oder ähnliches verwendet. Diese dienen nur zur Anzeige wann das Gerät zuletzt im Netzwerk gesehen wurde.

Kann man am Startverhalten der Things oder ähnliches etwas ändern? oder wo kann hier bei mir der Fehler begraben sein. Da ich auch im englischen Forum bisher keine derartigen Issues gefunden habe, denke ich, ist das ein Problem meiner Installation.

Ich habe beim Update auf die 4.2.1 auch die Plattform gewechselt und habe von einen Pi4b auf einen Pi5 gewechselt. PiOS und Docker sind auf aktuellen stand.

EDIT: ich habe mal ein Testsystem aufgesetzt mit dem Netzwerk Binding und MapDB installiert. Hier ist das Verhalten genau das selbe.

Code: Alles auswählen

2024-08-29 17:23:30.817 [INFO ] [ab.event.ThingStatusInfoChangedEvent] - Thing 'network:pingdevice:Mobiltelefon_Test' changed from UNINITIALIZED (HANDLER_MISSING_ERROR): Handler factory not found to UNINITIALIZED (NOT_YET_READY)
2024-08-29 17:23:31.297 [INFO ] [openhab.event.ItemStateChangedEvent ] - Item 'Mobiletelefon_Test_zuletzt_gesehen_Zuletzt_gesehen' changed from NULL to 2024-08-29T17:21:25.284348485+0200
2024-08-29 17:23:32.331 [INFO ] [ab.event.ThingStatusInfoChangedEvent] - Thing 'network:pingdevice:Mobiltelefon_Test' changed from UNINITIALIZED (NOT_YET_READY) to INITIALIZING
2024-08-29 17:23:32.392 [INFO ] [ab.event.ThingStatusInfoChangedEvent] - Thing 'network:pingdevice:Mobiltelefon_Test' changed from INITIALIZING to ONLINE
2024-08-29 17:23:37.553 [INFO ] [openhab.event.ItemStateChangedEvent ] - Item 'Mobiletelefon_Test_zuletzt_gesehen_Zuletzt_gesehen' changed from 2024-08-29T17:21:25.284348485+0200 to UNDEF

Kann das noch jemand so verifizieren?
Gruß Lenschi

[lenschith]

Ich habe das jetzt zig Male getestet und komme immer wieder auf das selbe Ergebnis. openHAB im Docker, egal ob BridgeMode oder Macvlan. Egal ob Pi4 oder Pi5. Mir werden die Items "lastseen" vom Network Binding nach einen Neustart immer mit einem UNDEF überschrieben wenn diese zur dieser Zeit nicht im Netzwerk erreichbar sind . Jeweils Version 4.2.1.

Bin ich der einzige oder hat das doch noch jemand bzw. könnte das jemand unabhängig von mir testen. Wenn das nur bei mir ist kann ich mir sparren nen Issue zu eröffnen.

Danke
Lenschi