Nur Text | Text mit Bildern

FHEM Forum

FHEM => Automatisierung => Thema gestartet von: wopl am 19 Juni 2016, 14:21:57

Titel: Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: wopl am 19 Juni 2016, 14:21:57
Ich benutze das Module ModbusAttr zur Kommunikation (nur schreibend) mit meiner Wago SPS. Funktioniert ganz prima (Dank Stefan).

In meinem Log taucht allerdings alle 60 Sekunden die Meldung auf, daß die TCP-Verbindung (Ethernet) disconnected wurde und gleich darauf wieder "reappeared".
Neben den vielen Einträgen im Log-File (naja, einwenig nervig) ist die Frage, ob es sich hier um ein Schließen und Wiederaufbau der Verbindung handelt, und ob man das Intervall ggf. deutlich vergrößern könnte. Da ich nur schreibend zugreife (ich polle keine Inputs), "müßte" die Verbindung auch nur geöffnet werden, wenn ich auf dem Modbus-Device (mit set) auf entsprechende Coils etc. zugreife.

Dank Wolfram

Titel: Antw:Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: rudolfkoenig am 19 Juni 2016, 15:58:01
Ich habe heute eine Aenderung in DevIo.pm eingecheckt (https://forum.fhem.de/index.php?topic=54732 (https://forum.fhem.de/index.php/topic,54732.html)), was dieses Verhalten evtl. aendert. Auf der anderen Seite ist es nicht normal, dass die andere Seite den Dienst einstellt.
Titel: Antw:Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: wopl am 21 Juni 2016, 11:14:55
Habe gestern keine Veränderung feststellen können. Ich "dachte" der 60s Verbindungsabbruch/-wiederaufbau wird durch die FHEM Seite initiiert und nicht von der SPS Seite. Aber ist halt nur meine Vermutung, die ich nicht unmittelbar verifizieren kann.

Gruß Wolfram
Titel: Antw:Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: SoT2079 am 02 November 2016, 12:51:57
Moin, auch wenn das Thema schon ein paar Tage alt ist würde ich gerne mit einklinken da ich ein identisches Problem habe.

Ich nutze das Modul ModbusAttr um auf meine Klimaanlage zu kommen.
Läuft auch soweit nur habe ich recht genau alle 7 Sekunden einen Abbruch der Verbindung und ich weiß nicht wo es dran liegen könnte.
Ich hatte schon mal die Intervalzeiten verändert, die Modbus ID geändert, Poll Verzögerung eingebaut.
Kann vielleicht jemand in den Logfiles oder meiner Config was erkennen?


Das Logfile vom Device, (warum zeigt er da eigentlich so wenig auch wenn ich in dem Logfile verbose 5 anschalte?)
Code Auswählen

2016-11-02_12:17:00 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:17:00 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:17:07 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:17:07 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:17:14 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:17:14 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:17:21 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:17:21 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:17:28 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:17:28 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:17:35 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:17:35 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:17:42 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:17:42 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:17:45 OG_Spielzimmer_Klima Spielzimmer_Lamelle: Lamelle_schwing
2016-11-02_12:17:45 OG_Spielzimmer_Klima Spielzimmer_Betrieb: Aus
2016-11-02_12:17:45 OG_Spielzimmer_Klima Spielzimmer_Ist: 24.3
2016-11-02_12:17:45 OG_Spielzimmer_Klima Spielzimmer_Soll: 21
2016-11-02_12:17:45 OG_Spielzimmer_Klima Spielzimmer_Modus: Kühlen
2016-11-02_12:17:46 OG_Spielzimmer_Klima Spielzimmer_Luefter: Lüfter_1
2016-11-02_12:18:02 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:18:02 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:18:09 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:18:09 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:18:16 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:18:16 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:18:23 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:18:23 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:18:30 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:18:30 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:18:37 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:18:37 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:18:44 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:18:44 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:18:45 OG_Spielzimmer_Klima Spielzimmer_Lamelle: Lamelle_schwing
2016-11-02_12:18:45 OG_Spielzimmer_Klima Spielzimmer_Betrieb: Aus
2016-11-02_12:18:45 OG_Spielzimmer_Klima Spielzimmer_Ist: 24.7
2016-11-02_12:18:45 OG_Spielzimmer_Klima Spielzimmer_Soll: 21
2016-11-02_12:18:45 OG_Spielzimmer_Klima Spielzimmer_Modus: Kühlen
2016-11-02_12:18:46 OG_Spielzimmer_Klima Spielzimmer_Luefter: Lüfter_1
2016-11-02_12:18:53 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:18:53 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:19:00 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:19:00 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:19:07 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:19:07 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:19:14 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:19:14 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:19:21 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:19:21 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:19:28 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:19:28 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:19:35 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:19:35 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:19:42 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:19:42 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:19:45 OG_Spielzimmer_Klima Spielzimmer_Lamelle: Lamelle_schwing
2016-11-02_12:19:45 OG_Spielzimmer_Klima Spielzimmer_Betrieb: Aus
2016-11-02_12:19:45 OG_Spielzimmer_Klima Spielzimmer_Ist: 24.3
2016-11-02_12:19:45 OG_Spielzimmer_Klima Spielzimmer_Soll: 21
2016-11-02_12:19:45 OG_Spielzimmer_Klima Spielzimmer_Modus: Kühlen
2016-11-02_12:19:46 OG_Spielzimmer_Klima Spielzimmer_Luefter: Lüfter_1
2016-11-02_12:19:53 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:19:53 OG_Spielzimmer_Klima CONNECTED
2016-11-02_12:20:00 OG_Spielzimmer_Klima DISCONNECTED
2016-11-02_12:20:00 OG_Spielzimmer_Klima CONNECTED



Das globale Logfile

Code Auswählen

2016.11.02 12:17:00 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:17:00 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:17:00 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:17:07 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:17:07 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:17:07 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:17:14 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:17:14 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:17:14 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:17:21 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:17:21 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:17:21 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:17:22 3: CUL_HM set EG_KUECHE_HEIZUNG statusRequest
2016.11.02 12:17:28 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:17:28 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:17:28 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:17:35 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:17:35 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:17:35 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:17:40 3: CUL_HM set 1OG_Flur_Licht off
2016.11.02 12:17:42 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:17:42 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:17:42 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:17:42 3: CUL_HM set CUL_HM_HM_CC_VD_203B93 getConfig
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: update timer modified: will call GetUpdate in 60.0 seconds at 2016-11-02 12:18:45
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate called
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate objects from attributes: h49157 h49152 h49154 h49156 h49153 h49155
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate full object list: h49152 h49153 h49154 h49155 h49156 h49157
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate check h49152 => Spielzimmer_Betrieb, poll = 1, last = 1478085405.52222
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Betrieb
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate check h49153 => Spielzimmer_Modus, poll = 1, last = 1478085405.90238
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Modus
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate check h49154 => Spielzimmer_Luefter, poll = 1, last = 1478085406.01294
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Luefter
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate check h49155 => Spielzimmer_Lamelle, poll = 1, last = 1478085405.40434
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Lamelle
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate check h49156 => Spielzimmer_Soll, poll = 1, last = 1478085405.75994
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Soll
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate check h49157 => Spielzimmer_Ist, poll = 1, last = 1478085405.64146
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Ist
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate tries to combine read commands
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate cannot combine Spielzimmer_Betrieb / h49152 with Spielzimmer_Modus / h49153, span would be 2
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate cannot combine Spielzimmer_Modus / h49153 with Spielzimmer_Luefter / h49154, span would be 2
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate cannot combine Spielzimmer_Luefter / h49154 with Spielzimmer_Lamelle / h49155, span would be 2
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate cannot combine Spielzimmer_Lamelle / h49155 with Spielzimmer_Soll / h49156, span would be 2
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate cannot combine Spielzimmer_Soll / h49156 with Spielzimmer_Ist / h49157, span would be 2
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: Send called with h 49155 len 1 / span 1 to id 1, queue has 0 requests
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49155 (Spielzimmer_Lamelle), len / span 1 : 008b000000060103c0030001 pdu 03c0030001
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: sends 008b000000060103c0030001 (fcode 3 to 1, tid 139 for Spielzimmer_Lamelle (49155), len 1)
2016.11.02 12:17:45 5: SW: 008b000000060103c0030001
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: Send called with h 49152 len 1 / span 1 to id 1, queue has 0 requests
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49152 (Spielzimmer_Betrieb), len / span 1 : 0051000000060103c0000001 pdu 03c0000001
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: Send called with h 49157 len 1 / span 1 to id 1, queue has 1 requests
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49157 (Spielzimmer_Ist), len / span 1 : 0025000000060103c0050001 pdu 03c0050001
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: Send called with h 49156 len 1 / span 1 to id 1, queue has 2 requests
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49156 (Spielzimmer_Soll), len / span 1 : 00ba000000060103c0040001 pdu 03c0040001
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: Send called with h 49153 len 1 / span 1 to id 1, queue has 3 requests
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49153 (Spielzimmer_Modus), len / span 1 : 000a000000060103c0010001 pdu 03c0010001
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: Send called with h 49154 len 1 / span 1 to id 1, queue has 4 requests
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49154 (Spielzimmer_Luefter), len / span 1 : 0054000000060103c0020001 pdu 03c0020001
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: raw read: 008b00000005010302000a
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseFrames got: 008b00000005010302000a
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 139, data 02000a expect 3 from 1, tid 139 for module OG_Spielzimmer_Klima
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseObj called with 000a and start 49155
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Lamelle, unpack=n, expr=, format=, map=1:Lamelle_1, 2:Lamelle_2, 3:Lamelle_3, 4:Lamelle_4, 10:Lamelle_schwing
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Lamelle maps value 10 with 1:Lamelle_1, 2:Lamelle_2, 3:Lamelle_3, 4:Lamelle_4, 10:Lamelle_schwing
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Lamelle assigns Lamelle_schwing
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: CheckDelay commDelay for OG_Spielzimmer_Klima not over, try again in 0.0256829261779785
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: sends 0051000000060103c0000001 (fcode 3 to 1, tid 81 for Spielzimmer_Betrieb (49152), len 1)
2016.11.02 12:17:45 5: SW: 0051000000060103c0000001
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: raw read: 0051000000050103020000
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseFrames got: 0051000000050103020000
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 81, data 020000 expect 3 from 1, tid 81 for module OG_Spielzimmer_Klima
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseObj called with 0000 and start 49152
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Betrieb, unpack=n, expr=, format=, map=0:Aus, 1:An
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Betrieb maps value 0 with 0:Aus, 1:An
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Betrieb assigns Aus
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: CheckDelay commDelay for OG_Spielzimmer_Klima not over, try again in 0.0567877292633057
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: sends 0025000000060103c0050001 (fcode 3 to 1, tid 37 for Spielzimmer_Ist (49157), len 1)
2016.11.02 12:17:45 5: SW: 0025000000060103c0050001
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: raw read: 00250000000501030200f3
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseFrames got: 00250000000501030200f3
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 37, data 0200f3 expect 3 from 1, tid 37 for module OG_Spielzimmer_Klima
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseObj called with 00f3 and start 49157
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Ist, unpack=n, expr=$val / 10, format=, map=
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Ist evaluates 243 with expr $val / 10
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Ist assigns 24.3
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: CheckDelay commDelay for OG_Spielzimmer_Klima not over, try again in 0.0551600456237793
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: sends 00ba000000060103c0040001 (fcode 3 to 1, tid 186 for Spielzimmer_Soll (49156), len 1)
2016.11.02 12:17:45 5: SW: 00ba000000060103c0040001
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: raw read: 00ba0000000501030200d2
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseFrames got: 00ba0000000501030200d2
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 186, data 0200d2 expect 3 from 1, tid 186 for module OG_Spielzimmer_Klima
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseObj called with 00d2 and start 49156
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Soll, unpack=n, expr=$val / 10, format=, map=
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Soll evaluates 210 with expr $val / 10
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Soll assigns 21
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: CheckDelay commDelay for OG_Spielzimmer_Klima not over, try again in 0.0567319393157959
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: sends 000a000000060103c0010001 (fcode 3 to 1, tid 10 for Spielzimmer_Modus (49153), len 1)
2016.11.02 12:17:45 5: SW: 000a000000060103c0010001
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: raw read: 000a000000050103020004
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseFrames got: 000a000000050103020004
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 10, data 020004 expect 3 from 1, tid 10 for module OG_Spielzimmer_Klima
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseObj called with 0004 and start 49153
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Modus, unpack=n, expr=, format=, map=0:Auto, 1:Heizen, 2:Entfeuchten, 3:Lüften, 4:Kühlen
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Modus maps value 4 with 0:Auto, 1:Heizen, 2:Entfeuchten, 3:Lüften, 4:Kühlen
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Modus assigns Kühlen
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: CheckDelay commDelay for OG_Spielzimmer_Klima not over, try again in 0.0569558143615723
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: sends 0054000000060103c0020001 (fcode 3 to 1, tid 84 for Spielzimmer_Luefter (49154), len 1)
2016.11.02 12:17:45 5: SW: 0054000000060103c0020001
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: raw read: 0054000000050103020001
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseFrames got: 0054000000050103020001
2016.11.02 12:17:45 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 84, data 020001 expect 3 from 1, tid 84 for module OG_Spielzimmer_Klima
2016.11.02 12:17:45 5: OG_Spielzimmer_Klima: ParseObj called with 0001 and start 49154
2016.11.02 12:17:46 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Luefter, unpack=n, expr=, format=, map=1:Lüfter_1, 2:Lüfter_2, 3:Lüfter_3, 4:Lüfter_4
2016.11.02 12:17:46 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Luefter maps value 1 with 1:Lüfter_1, 2:Lüfter_2, 3:Lüfter_3, 4:Lüfter_4
2016.11.02 12:17:46 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Luefter assigns Lüfter_1
2016.11.02 12:17:46 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:18:01 3: SCC1: Unknown code A0D59841032065AF1123406012100::-70.5:SCC1, help me!
2016.11.02 12:18:01 3: CUL_HM set 1OG_Kueche_Fenster getConfig
2016.11.02 12:18:02 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:18:02 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:18:02 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:18:09 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:18:09 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:18:09 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:18:16 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:18:16 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:18:16 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:18:21 3: CUL_HM set 1OG_Flur_Licht off
2016.11.02 12:18:22 3: CUL_HM set 2OG_Flur_Licht pct 0 0 30
2016.11.02 12:18:23 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:18:23 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:18:23 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:18:30 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:18:30 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:18:30 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:18:37 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:18:37 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:18:37 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:18:44 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:18:44 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:18:44 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: update timer modified: will call GetUpdate in 60.0 seconds at 2016-11-02 12:19:45
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate called
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate objects from attributes: h49157 h49152 h49154 h49156 h49153 h49155
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate full object list: h49152 h49153 h49154 h49155 h49156 h49157
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate check h49152 => Spielzimmer_Betrieb, poll = 1, last = 1478085465.52696
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Betrieb
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate check h49153 => Spielzimmer_Modus, poll = 1, last = 1478085465.88039
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Modus
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate check h49154 => Spielzimmer_Luefter, poll = 1, last = 1478085466.00694
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Luefter
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate check h49155 => Spielzimmer_Lamelle, poll = 1, last = 1478085465.40911
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Lamelle
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate check h49156 => Spielzimmer_Soll, poll = 1, last = 1478085465.76305
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Soll
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate check h49157 => Spielzimmer_Ist, poll = 1, last = 1478085465.64546
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Ist
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate tries to combine read commands
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate cannot combine Spielzimmer_Betrieb / h49152 with Spielzimmer_Modus / h49153, span would be 2
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate cannot combine Spielzimmer_Modus / h49153 with Spielzimmer_Luefter / h49154, span would be 2
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate cannot combine Spielzimmer_Luefter / h49154 with Spielzimmer_Lamelle / h49155, span would be 2
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate cannot combine Spielzimmer_Lamelle / h49155 with Spielzimmer_Soll / h49156, span would be 2
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate cannot combine Spielzimmer_Soll / h49156 with Spielzimmer_Ist / h49157, span would be 2
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: Send called with h 49155 len 1 / span 1 to id 1, queue has 0 requests
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49155 (Spielzimmer_Lamelle), len / span 1 : 001c000000060103c0030001 pdu 03c0030001
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: sends 001c000000060103c0030001 (fcode 3 to 1, tid 28 for Spielzimmer_Lamelle (49155), len 1)
2016.11.02 12:18:45 5: SW: 001c000000060103c0030001
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: Send called with h 49152 len 1 / span 1 to id 1, queue has 0 requests
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49152 (Spielzimmer_Betrieb), len / span 1 : 0031000000060103c0000001 pdu 03c0000001
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: Send called with h 49157 len 1 / span 1 to id 1, queue has 1 requests
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49157 (Spielzimmer_Ist), len / span 1 : 00c8000000060103c0050001 pdu 03c0050001
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: Send called with h 49156 len 1 / span 1 to id 1, queue has 2 requests
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49156 (Spielzimmer_Soll), len / span 1 : 0020000000060103c0040001 pdu 03c0040001
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: Send called with h 49153 len 1 / span 1 to id 1, queue has 3 requests
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49153 (Spielzimmer_Modus), len / span 1 : 006b000000060103c0010001 pdu 03c0010001
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: Send called with h 49154 len 1 / span 1 to id 1, queue has 4 requests
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49154 (Spielzimmer_Luefter), len / span 1 : 0081000000060103c0020001 pdu 03c0020001
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: raw read: 001c00000005010302000a
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseFrames got: 001c00000005010302000a
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 28, data 02000a expect 3 from 1, tid 28 for module OG_Spielzimmer_Klima
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseObj called with 000a and start 49155
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Lamelle, unpack=n, expr=, format=, map=1:Lamelle_1, 2:Lamelle_2, 3:Lamelle_3, 4:Lamelle_4, 10:Lamelle_schwing
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Lamelle maps value 10 with 1:Lamelle_1, 2:Lamelle_2, 3:Lamelle_3, 4:Lamelle_4, 10:Lamelle_schwing
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Lamelle assigns Lamelle_schwing
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: CheckDelay commDelay for OG_Spielzimmer_Klima not over, try again in 0.056708812713623
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: sends 0031000000060103c0000001 (fcode 3 to 1, tid 49 for Spielzimmer_Betrieb (49152), len 1)
2016.11.02 12:18:45 5: SW: 0031000000060103c0000001
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: raw read: 0031000000050103020000
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseFrames got: 0031000000050103020000
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 49, data 020000 expect 3 from 1, tid 49 for module OG_Spielzimmer_Klima
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseObj called with 0000 and start 49152
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Betrieb, unpack=n, expr=, format=, map=0:Aus, 1:An
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Betrieb maps value 0 with 0:Aus, 1:An
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Betrieb assigns Aus
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: CheckDelay commDelay for OG_Spielzimmer_Klima not over, try again in 0.0290017127990723
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: sends 00c8000000060103c0050001 (fcode 3 to 1, tid 200 for Spielzimmer_Ist (49157), len 1)
2016.11.02 12:18:45 5: SW: 00c8000000060103c0050001
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: raw read: 00c80000000501030200f7
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseFrames got: 00c80000000501030200f7
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 200, data 0200f7 expect 3 from 1, tid 200 for module OG_Spielzimmer_Klima
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseObj called with 00f7 and start 49157
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Ist, unpack=n, expr=$val / 10, format=, map=
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Ist evaluates 247 with expr $val / 10
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Ist assigns 24.7
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: CheckDelay commDelay for OG_Spielzimmer_Klima not over, try again in 0.0487027168273926
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: sends 0020000000060103c0040001 (fcode 3 to 1, tid 32 for Spielzimmer_Soll (49156), len 1)
2016.11.02 12:18:45 5: SW: 0020000000060103c0040001
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: raw read: 00200000000501030200d2
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseFrames got: 00200000000501030200d2
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 32, data 0200d2 expect 3 from 1, tid 32 for module OG_Spielzimmer_Klima
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseObj called with 00d2 and start 49156
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Soll, unpack=n, expr=$val / 10, format=, map=
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Soll evaluates 210 with expr $val / 10
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Soll assigns 21
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: CheckDelay commDelay for OG_Spielzimmer_Klima not over, try again in 0.0546097755432129
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: sends 006b000000060103c0010001 (fcode 3 to 1, tid 107 for Spielzimmer_Modus (49153), len 1)
2016.11.02 12:18:45 5: SW: 006b000000060103c0010001
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: raw read: 006b000000050103020004
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseFrames got: 006b000000050103020004
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 107, data 020004 expect 3 from 1, tid 107 for module OG_Spielzimmer_Klima
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseObj called with 0004 and start 49153
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Modus, unpack=n, expr=, format=, map=0:Auto, 1:Heizen, 2:Entfeuchten, 3:Lüften, 4:Kühlen
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Modus maps value 4 with 0:Auto, 1:Heizen, 2:Entfeuchten, 3:Lüften, 4:Kühlen
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Modus assigns Kühlen
2016.11.02 12:18:45 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:18:45 4: OG_Spielzimmer_Klima: CheckDelay commDelay for OG_Spielzimmer_Klima not over, try again in 0.0569288730621338
2016.11.02 12:18:46 4: OG_Spielzimmer_Klima: sends 0081000000060103c0020001 (fcode 3 to 1, tid 129 for Spielzimmer_Luefter (49154), len 1)
2016.11.02 12:18:46 5: SW: 0081000000060103c0020001
2016.11.02 12:18:46 5: OG_Spielzimmer_Klima: raw read: 0081000000050103020001
2016.11.02 12:18:46 5: OG_Spielzimmer_Klima: ParseFrames got: 0081000000050103020001
2016.11.02 12:18:46 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 129, data 020001 expect 3 from 1, tid 129 for module OG_Spielzimmer_Klima
2016.11.02 12:18:46 5: OG_Spielzimmer_Klima: ParseObj called with 0001 and start 49154
2016.11.02 12:18:46 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Luefter, unpack=n, expr=, format=, map=1:Lüfter_1, 2:Lüfter_2, 3:Lüfter_3, 4:Lüfter_4
2016.11.02 12:18:46 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Luefter maps value 1 with 1:Lüfter_1, 2:Lüfter_2, 3:Lüfter_3, 4:Lüfter_4
2016.11.02 12:18:46 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Luefter assigns Lüfter_1
2016.11.02 12:18:46 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:18:53 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:18:53 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:18:53 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:18:57 3: CUL_HM set Wetter getConfig
2016.11.02 12:19:00 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:19:00 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:19:00 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:19:07 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:19:07 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:19:07 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:19:14 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:19:14 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:19:14 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:19:21 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:19:21 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:19:21 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:19:28 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:19:28 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:19:28 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:19:35 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:19:35 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:19:35 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:19:42 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:19:42 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:19:42 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:19:44 3: CUL_HM set EG_BAD_HEIZUNG getConfig
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: update timer modified: will call GetUpdate in 60.0 seconds at 2016-11-02 12:20:45
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate called
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate objects from attributes: h49157 h49152 h49154 h49156 h49153 h49155
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate full object list: h49152 h49153 h49154 h49155 h49156 h49157
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate check h49152 => Spielzimmer_Betrieb, poll = 1, last = 1478085525.54866
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Betrieb
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate check h49153 => Spielzimmer_Modus, poll = 1, last = 1478085525.95376
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Modus
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate check h49154 => Spielzimmer_Luefter, poll = 1, last = 1478085526.07149
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Luefter
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate check h49155 => Spielzimmer_Lamelle, poll = 1, last = 1478085525.43105
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Lamelle
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate check h49156 => Spielzimmer_Soll, poll = 1, last = 1478085525.80574
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Soll
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate check h49157 => Spielzimmer_Ist, poll = 1, last = 1478085525.68787
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: GetUpdate will request Spielzimmer_Ist
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate tries to combine read commands
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate cannot combine Spielzimmer_Betrieb / h49152 with Spielzimmer_Modus / h49153, span would be 2
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate cannot combine Spielzimmer_Modus / h49153 with Spielzimmer_Luefter / h49154, span would be 2
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate cannot combine Spielzimmer_Luefter / h49154 with Spielzimmer_Lamelle / h49155, span would be 2
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate cannot combine Spielzimmer_Lamelle / h49155 with Spielzimmer_Soll / h49156, span would be 2
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate cannot combine Spielzimmer_Soll / h49156 with Spielzimmer_Ist / h49157, span would be 2
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: GetUpdate: combine for h is 1
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: Send called with h 49155 len 1 / span 1 to id 1, queue has 0 requests
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49155 (Spielzimmer_Lamelle), len / span 1 : 00f0000000060103c0030001 pdu 03c0030001
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: sends 00f0000000060103c0030001 (fcode 3 to 1, tid 240 for Spielzimmer_Lamelle (49155), len 1)
2016.11.02 12:19:45 5: SW: 00f0000000060103c0030001
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: Send called with h 49152 len 1 / span 1 to id 1, queue has 0 requests
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49152 (Spielzimmer_Betrieb), len / span 1 : 00de000000060103c0000001 pdu 03c0000001
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: Send called with h 49157 len 1 / span 1 to id 1, queue has 1 requests
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49157 (Spielzimmer_Ist), len / span 1 : 00f9000000060103c0050001 pdu 03c0050001
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: Send called with h 49156 len 1 / span 1 to id 1, queue has 2 requests
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49156 (Spielzimmer_Soll), len / span 1 : 009a000000060103c0040001 pdu 03c0040001
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: Send called with h 49153 len 1 / span 1 to id 1, queue has 3 requests
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49153 (Spielzimmer_Modus), len / span 1 : 00b9000000060103c0010001 pdu 03c0010001
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: Send called with h 49154 len 1 / span 1 to id 1, queue has 4 requests
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: Send queues fcode 3 for h 49154 (Spielzimmer_Luefter), len / span 1 : 00b8000000060103c0020001 pdu 03c0020001
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: raw read: 00f000000005010302000a
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseFrames got: 00f000000005010302000a
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 240, data 02000a expect 3 from 1, tid 240 for module OG_Spielzimmer_Klima
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseObj called with 000a and start 49155
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Lamelle, unpack=n, expr=, format=, map=1:Lamelle_1, 2:Lamelle_2, 3:Lamelle_3, 4:Lamelle_4, 10:Lamelle_schwing
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Lamelle maps value 10 with 1:Lamelle_1, 2:Lamelle_2, 3:Lamelle_3, 4:Lamelle_4, 10:Lamelle_schwing
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Lamelle assigns Lamelle_schwing
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: CheckDelay commDelay for OG_Spielzimmer_Klima not over, try again in 0.0566258430480957
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: sends 00de000000060103c0000001 (fcode 3 to 1, tid 222 for Spielzimmer_Betrieb (49152), len 1)
2016.11.02 12:19:45 5: SW: 00de000000060103c0000001
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: raw read: 00de000000050103020000
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseFrames got: 00de000000050103020000
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 222, data 020000 expect 3 from 1, tid 222 for module OG_Spielzimmer_Klima
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseObj called with 0000 and start 49152
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Betrieb, unpack=n, expr=, format=, map=0:Aus, 1:An
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Betrieb maps value 0 with 0:Aus, 1:An
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Betrieb assigns Aus
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: CheckDelay commDelay for OG_Spielzimmer_Klima not over, try again in 0.0570189952850342
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: sends 00f9000000060103c0050001 (fcode 3 to 1, tid 249 for Spielzimmer_Ist (49157), len 1)
2016.11.02 12:19:45 5: SW: 00f9000000060103c0050001
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: raw read: 00f90000000501030200f3
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseFrames got: 00f90000000501030200f3
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 249, data 0200f3 expect 3 from 1, tid 249 for module OG_Spielzimmer_Klima
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseObj called with 00f3 and start 49157
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Ist, unpack=n, expr=$val / 10, format=, map=
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Ist evaluates 243 with expr $val / 10
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Ist assigns 24.3
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: CheckDelay commDelay for OG_Spielzimmer_Klima not over, try again in 0.0564279556274414
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: sends 009a000000060103c0040001 (fcode 3 to 1, tid 154 for Spielzimmer_Soll (49156), len 1)
2016.11.02 12:19:45 5: SW: 009a000000060103c0040001
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: raw read: 009a0000000501030200d2
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseFrames got: 009a0000000501030200d2
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 154, data 0200d2 expect 3 from 1, tid 154 for module OG_Spielzimmer_Klima
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseObj called with 00d2 and start 49156
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Soll, unpack=n, expr=$val / 10, format=, map=
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Soll evaluates 210 with expr $val / 10
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Soll assigns 21
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: CheckDelay commDelay for OG_Spielzimmer_Klima not over, try again in 0.0547990798950195
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: sends 00b9000000060103c0010001 (fcode 3 to 1, tid 185 for Spielzimmer_Modus (49153), len 1)
2016.11.02 12:19:45 5: SW: 00b9000000060103c0010001
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: raw read: 00b9000000050103020004
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseFrames got: 00b9000000050103020004
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 185, data 020004 expect 3 from 1, tid 185 for module OG_Spielzimmer_Klima
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseObj called with 0004 and start 49153
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Modus, unpack=n, expr=, format=, map=0:Auto, 1:Heizen, 2:Entfeuchten, 3:Lüften, 4:Kühlen
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Modus maps value 4 with 0:Auto, 1:Heizen, 2:Entfeuchten, 3:Lüften, 4:Kühlen
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Modus assigns Kühlen
2016.11.02 12:19:45 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:19:45 4: OG_Spielzimmer_Klima: CheckDelay commDelay for OG_Spielzimmer_Klima not over, try again in 0.0566627979278564
2016.11.02 12:19:46 4: OG_Spielzimmer_Klima: sends 00b8000000060103c0020001 (fcode 3 to 1, tid 184 for Spielzimmer_Luefter (49154), len 1)
2016.11.02 12:19:46 5: SW: 00b8000000060103c0020001
2016.11.02 12:19:46 5: OG_Spielzimmer_Klima: raw read: 00b8000000050103020001
2016.11.02 12:19:46 5: OG_Spielzimmer_Klima: ParseFrames got: 00b8000000050103020001
2016.11.02 12:19:46 4: OG_Spielzimmer_Klima: ParseFrames: fcode 3 from 1, tid 184, data 020001 expect 3 from 1, tid 184 for module OG_Spielzimmer_Klima
2016.11.02 12:19:46 5: OG_Spielzimmer_Klima: ParseObj called with 0001 and start 49154
2016.11.02 12:19:46 5: OG_Spielzimmer_Klima: ParseObj ObjInfo: reading=Spielzimmer_Luefter, unpack=n, expr=, format=, map=1:Lüfter_1, 2:Lüfter_2, 3:Lüfter_3, 4:Lüfter_4
2016.11.02 12:19:46 5: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Luefter maps value 1 with 1:Lüfter_1, 2:Lüfter_2, 3:Lüfter_3, 4:Lüfter_4
2016.11.02 12:19:46 4: OG_Spielzimmer_Klima: ParseObj for Spielzimmer_Luefter assigns Lüfter_1
2016.11.02 12:19:46 5: OG_Spielzimmer_Klima: ParseFrames done, reply to fCode 3, 6 readings
2016.11.02 12:19:53 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:19:53 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:19:53 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)
2016.11.02 12:19:59 3: CUL_HM set EG_KUECHE_HEIZUNG getConfig
2016.11.02 12:20:00 1: 192.168.2.11:502 disconnected, waiting to reappear (OG_Spielzimmer_Klima)
2016.11.02 12:20:00 4: HttpUtils url=http://192.168.2.11:502/
2016.11.02 12:20:00 1: 192.168.2.11:502 reappeared (OG_Spielzimmer_Klima)


und mein Ausschnitt aus der fhem.cfg

Code Auswählen

define OG_Spielzimmer_Klima ModbusAttr 1 60 192.168.2.11:502 TCP
attr OG_Spielzimmer_Klima userattr dev-h-defPoll obj-h49152-hint obj-h49152-map obj-h49152-name obj-h49152-poll obj-h49152-polldelay obj-h49152-reading obj-h49152-set obj-h49153-hint obj-h49153-map obj-h49153-name obj-h49153-poll obj-h49153-polldelay obj-h49153-reading obj-h49153-set obj-h49154-hint obj-h49154-map obj-h49154-name obj-h49154-poll obj-h49154-polldelay obj-h49154-reading obj-h49154-set obj-h49155-hint obj-h49155-map obj-h49155-name obj-h49155-poll obj-h49155-polldelay obj-h49155-reading obj-h49155-set obj-h49156-expr obj-h49156-hint obj-h49156-max obj-h49156-min obj-h49156-name obj-h49156-poll obj-h49156-polldelay obj-h49156-reading obj-h49156-set obj-h49156-setexpr obj-h49157-expr obj-h49157-name obj-h49157-poll obj-h49157-polldelay obj-h49157-reading stateFormat verbose webCmd
attr OG_Spielzimmer_Klima obj-h49152-hint Aus,An
attr OG_Spielzimmer_Klima obj-h49152-map 0:Aus, 1:An
attr OG_Spielzimmer_Klima obj-h49152-name Spielzimmer_Betrieb
attr OG_Spielzimmer_Klima obj-h49152-poll 1
attr OG_Spielzimmer_Klima obj-h49152-polldelay 30
attr OG_Spielzimmer_Klima obj-h49152-reading Spielzimmer_Betrieb
attr OG_Spielzimmer_Klima obj-h49152-set 1
attr OG_Spielzimmer_Klima obj-h49153-hint Auto,Heizen,Entfeuchten,Lüften,Kühlen
attr OG_Spielzimmer_Klima obj-h49153-map 0:Auto, 1:Heizen, 2:Entfeuchten, 3:Lüften, 4:Kühlen
attr OG_Spielzimmer_Klima obj-h49153-name Spielzimmer_Modus
attr OG_Spielzimmer_Klima obj-h49153-poll 1
attr OG_Spielzimmer_Klima obj-h49153-polldelay 30
attr OG_Spielzimmer_Klima obj-h49153-reading Spielzimmer_Modus
attr OG_Spielzimmer_Klima obj-h49153-set 1
attr OG_Spielzimmer_Klima obj-h49154-hint Lüfter_1,Lüfter_2,Lüfter_3,Lüfter_4
attr OG_Spielzimmer_Klima obj-h49154-map 1:Lüfter_1, 2:Lüfter_2, 3:Lüfter_3, 4:Lüfter_4
attr OG_Spielzimmer_Klima obj-h49154-name Spielzimmer_Luefter
attr OG_Spielzimmer_Klima obj-h49154-poll 1
attr OG_Spielzimmer_Klima obj-h49154-polldelay 30
attr OG_Spielzimmer_Klima obj-h49154-reading Spielzimmer_Luefter
attr OG_Spielzimmer_Klima obj-h49154-set 1
attr OG_Spielzimmer_Klima obj-h49155-hint Lamelle_1,Lamelle_2,Lamelle_3,Lamelle_4,Lamelle_schwing
attr OG_Spielzimmer_Klima obj-h49155-map 1:Lamelle_1, 2:Lamelle_2, 3:Lamelle_3, 4:Lamelle_4, 10:Lamelle_schwing
attr OG_Spielzimmer_Klima obj-h49155-name Spielzimmer_Lamelle
attr OG_Spielzimmer_Klima obj-h49155-poll 1
attr OG_Spielzimmer_Klima obj-h49155-polldelay 30
attr OG_Spielzimmer_Klima obj-h49155-reading Spielzimmer_Lamelle
attr OG_Spielzimmer_Klima obj-h49155-set 1
attr OG_Spielzimmer_Klima obj-h49156-expr $val / 10
attr OG_Spielzimmer_Klima obj-h49156-hint 18.0,18.5,19.0,19.5,20.0,20.5,21.0,21.5,22.0,22.5,23.0,23.5,24.0,24.5,25.0,25.5,26.0,26.5,27.0,27.5,28.0,28.5,29.0,29.5,30.0
attr OG_Spielzimmer_Klima obj-h49156-max 30
attr OG_Spielzimmer_Klima obj-h49156-min 18
attr OG_Spielzimmer_Klima obj-h49156-name Spielzimmer_Soll
attr OG_Spielzimmer_Klima obj-h49156-poll 1
attr OG_Spielzimmer_Klima obj-h49156-polldelay 30
attr OG_Spielzimmer_Klima obj-h49156-reading Spielzimmer_Soll
attr OG_Spielzimmer_Klima obj-h49156-set 1
attr OG_Spielzimmer_Klima obj-h49156-setexpr $val * 10
attr OG_Spielzimmer_Klima obj-h49157-expr $val / 10
attr OG_Spielzimmer_Klima obj-h49157-name Spielzimmer_Ist
attr OG_Spielzimmer_Klima obj-h49157-poll 1
attr OG_Spielzimmer_Klima obj-h49157-polldelay 30
attr OG_Spielzimmer_Klima obj-h49157-reading Spielzimmer_Ist
attr OG_Spielzimmer_Klima room OG_z_Klima
attr OG_Spielzimmer_Klima stateFormat Ist: Spielzimmer_Ist °C, Soll: Spielzimmer_Soll °C
attr OG_Spielzimmer_Klima verbose 5
attr OG_Spielzimmer_Klima webCmd Spielzimmer_Betrieb:Spielzimmer_Soll:Spielzimmer_Modus:Spielzimmer_Luefter:Spielzimmer_Lamelle


Fhem läuft auf einem Raspberry B, update all habe ich gestern noch ausgeführt weil ich dachte es hilft vielleicht.
Die Gegenstelle ist von Stulz ein CompTrol Interface 4WEB.
Ein Auszug aus der Anleitung

6. MODBUS Modbus ist ein Kommunikationsprotokoll. Es ist als Master/Slave-System aufgebaut, bei dem ein Master (GLT/SPS) mit mehreren Slaves (CompTrol Interface 4Web) verbunden werden kann. Die von der CompTrol Interface 4Web unterstützte Betriebsart ist Modbus TCP, dieses läuft in einem LAN über den Port 502. Es werden 16-Bit Variablen (short, binary) übertragen. Folgende Modbus-Funktionen werden von der CompTrol Interface 4Web unterstützt: • 03 Read Holding Registers • 06 Write Single Register • 16 Write Multiple Registers • 23 Read/Write Multiple Registers Weitere Details zur Modbus-Spezifikation finden Sie unter www.modbus.org.
Achtung! Es sind immer folgende Mindestzeiten für das Polling einzuhalten: 1 Gerät = 4200ms, 2 Geräte = 4800 ms, 3 Geräte = 5400 ms, ab 4 = n*600 ms


Im Moment spreche ich ja nur ein Gerät an von den 4 die es mal werden, aber auch dann müsste ich mit einem Interval von 60 Sekunden doch hinkommen.
Ich stelle das mal noch auf 300 Sekunden hoch und schaue ob es was bringt.


Bin für jede Hilfe dankbar, falls noch Informationen fehlen gerne drauf hinweisen.

Gruß Karsten
Titel: Antw:Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: twix am 02 Dezember 2016, 16:22:20
Hallo,

ich habe das gleiche Problem mit meinem per ModbusAttr angebundenem Solarlog1000.
Die Werte werden korrekt ausgelesen, aber das Log quillt über.

Irgendwann fing das an und mein System ist merklich blockiert.

Code Auswählen

2016.12.02 16:12:32 1: 192.168.99.35:502 disconnected, waiting to reappear (solarlog)
2016.12.02 16:12:32 1: 192.168.99.35:502 reappeared (solarlog)
2016.12.02 16:13:31 1: 192.168.99.35:502 disconnected, waiting to reappear (solarlog)
2016.12.02 16:13:32 1: 192.168.99.35:502 reappeared (solarlog)
2016.12.02 16:14:02 1: 192.168.99.35:502 disconnected, waiting to reappear (solarlog)
2016.12.02 16:14:02 1: 192.168.99.35:502 reappeared (solarlog)
2016.12.02 16:14:32 1: 192.168.99.35:502 disconnected, waiting to reappear (solarlog)
2016.12.02 16:14:36 1: 192.168.99.35:502 reappeared (solarlog)
2016.12.02 16:15:06 1: 192.168.99.35:502 disconnected, waiting to reappear (solarlog)
2016.12.02 16:15:06 1: 192.168.99.35:502 reappeared (solarlog)
2016.12.02 16:16:32 1: 192.168.99.35:502 disconnected, waiting to reappear (solarlog)

Hatte den Solarlog vorher mit ModBusTCP angebunden mit dem gleichen Problem.
Titel: Antw:Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: StefanStrobel am 04 Dezember 2016, 11:19:28
Hallo,

ich schau mir das mal an.
Neue Versionen poste ich dann unter https://forum.fhem.de/index.php/topic,25315.405.html

Gruss
    Stefan
Titel: Antw:Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: wopl am 04 Dezember 2016, 15:16:32
Sehe jetzt erst die neuen Posts:

Auf meiner Wago880 wurden die Disconnects durch die SPS initiiert. Konnte ich dort hochsetzen. Jetzt wird die Verbindung stabil 1h gehalten und dann kurz unterbrochen.

Gruß Wolfram
Titel: Antw:Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: StefanStrobel am 04 Dezember 2016, 18:01:18
Hallo,

Auch in meiner Testumgebung kommen disconnects immer vom Modbus-Slave.
Leider kann ich die Logs auch im Modbus-Modul nicht deaktivieren. Die kommen von DevIo.
Ich werde aber mal nachfragen, ob Rudi das evt. konfigurierbar machen kann.

Gruss
   Stefan

Titel: Antw:Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: twix am 04 Dezember 2016, 21:37:03
Hallo,

es hat bei mir erst in den letzten 1-2 Wochen angefangen. Ich dachte erst an ein Netzwerkproblem aber das war es nicht.
Am Solarlog selber gab es keine Änderung.
Hilft es wenn ich detailierte Logs liefere?
Titel: Antw:Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: StefanStrobel am 04 Dezember 2016, 22:14:04
Hallo Twix,

In diesem Fall erwarte ich von Logs keine weiteren Erkenntnisse.
Die Disconnected Meldungen etc. sind schon ziemlich eindeutig.
Ich habe das auch mit einer älteren Version des Modbus-Moduls nochmal getestet und da ist es das gleiche Verhalten.
Das ist sicher ein Timeout auf Slave-Seite, der die Verbindung beendet, wenn länger keine Abfrage kam.
Bei einem meiner Geräte ist das nach ca. 100 Sekunden der Fall.
DevIO macht dann diese Meldung und versucht sofort die Verbindung wieder aufzubauen. Das ist auch weiter nicht bedenklich. Aber die Meldungen stören natürlich. Daher würde ich da ansetzen.
Vielleicht hast Du in der Zeit vor zwei Wochen in einem höheren Intervall Werte abgefragt?

Gruss
   Stefan
Titel: Antw:Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: twix am 05 Dezember 2016, 11:46:12
Hallo Stefan,

bin jetzt von 120 sekunden Polling auf 30 runter.

Seit dem kommt die Meldung exakt alle 3 Minuten:
016.12.05 11:33:08 1: 192.168.99.35:502 disconnected, waiting to reappear (solarlog)
2016.12.05 11:33:08 1: 192.168.99.35:502 reappeared (solarlog)
2016.12.05 11:36:08 1: 192.168.99.35:502 disconnected, waiting to reappear (solarlog)
2016.12.05 11:36:08 1: 192.168.99.35:502 reappeared (solarlog)
2016.12.05 11:39:08 1: 192.168.99.19:1000 disconnected, waiting to reappear (HMLAN1)
2016.12.05 11:39:08 1: HMLAN_Parse: HMLAN1 new condition disconnected
2016.12.05 11:39:08 1: 192.168.99.35:502 disconnected, waiting to reappear (solarlog)
2016.12.05 11:39:08 1: 192.168.99.35:502 reappeared (solarlog)
2016.12.05 11:40:08 1: HMLAN_Parse: HMLAN1 new condition init
2016.12.05 11:40:08 1: 192.168.99.19:1000 reappeared (HMLAN1)
2016.12.05 11:40:08 1: HMLAN_Parse: HMLAN1 new condition ok
2016.12.05 11:42:08 1: 192.168.99.35:502 disconnected, waiting to reappear (solarlog)
2016.12.05 11:42:08 1: 192.168.99.35:502 reappeared (solarlog)

Ab und zu nimmt er anscheinend den HMLAN auch mit und das System fühlt sich zäh an.
MfG
Titel: Antw:Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: StefanStrobel am 05 Dezember 2016, 22:15:17
Hallo Twix,

Das Modbus-Modul kümmert sich nicht selbst um TCP-Verbindungen sondern nutzt dazu das selbe zentrale Fhem-Modul (DevIO) wie die meisten Fhem-Module. DevIO erzeugt auch die Meldungen und baut die Verbindung wieder auf. Das sollte keine Auswirkungen auf die Performance haben. Ich halte es auch für abwegig, dass ein Modul die Verbindung eines anderen Moduls "mitnimmt".

Wenn Du genau wissen möchtest, wer die Verbindungen schließt, dann solltest Du mit Wireshark o.ä. zusehen. Das würde ich in Deinem Fall empfehlen.

Wenn Dein System sich träge anfühlt, dann kannst Du mit anderen Modulen überwachen, welche Geräte in Fhem wie viel Zeit verbrauchen.

Rudi war übrigens so freundlich und hat DevIO erweitert, so dass ich die Meldungen in DevIO jetzt auf ein höheres Loglevel bringen kann.

Gruß
    Stefan
Titel: Antw:Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: twix am 06 Dezember 2016, 10:27:43
Hallo Stefan,

danke für deine Bemühungen.

Der HMLAN verabscheidet sich nur, wenn der solarlog abgefragt wird.
Wenn ich die solarlog Config auskommentiere ist alles ok.
Daher vermutete ich, das da ein Zusammenhang besteht.

Gruß,
Rainer.
Titel: Antw:Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: StefanStrobel am 06 Dezember 2016, 18:16:29
Das ist natürlich seltsam.
Ich würde da wirklich mal den Wireshark bemühen und ansehen was hier übers Netz geht und wer hier TCP-Verbindungen beendet.
In meinen Beobachtungen kommt das FIN von den Slaves und damit kann Fhem nichts daran ändern.
Das erklärt natürlich noch nicht warum Dein HMLAN die Verbindung schließt und dann auch noch nur wenn Solarlog läuft. Aber auch hier würde eine Beobachtung mit Wireshark wichtige Erkenntnisse liefern.

Du kannst natürlich auch erst mal eine alte Version vom Modbus-Modul einspielen (z.B. aus dem Fhem SVN) und verifizieren, ob es damit auch passiert (ich gehe davon aus).
Dann kannst Du noch testweise eine alte Version von DevIO nehmen. Da wäre ja am ehesten der relevante Code. Wenn es so ist wie ich vermute und Deine Disconnects auch mit den alten Versionen auftreten, dann muss das Problem außerhalb von Fhem liegen.

Dann könntest Du natürlich auch noch statt Fhem einen anderen Modbus-Master testen und dabei beobachten, ob und wann Verbindungen geschlossen und neu aufgebaut werden. Von Modbustools für Windows gibt es glaube ich eine kostenlose Testversion.
Das Ergebnis fände ichauch spannend.

Ich hoffe das hilft Dir weiter.

Gruß
    Stefan

Titel: Antw:Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: twix am 08 Dezember 2016, 10:52:01
Hallo Stefan,

ich habe mal einen Mitschnitt gemacht.

1. Kontaktaufnahme
2. Werte werden abgerufen (alle 30 Sekunden)
3. ?
4. Reset der Verbindung und Werte abrufen

Kannst Du daraus was erkennen??

Gruß,
Rainer.
Titel: Antw:Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: StefanStrobel am 08 Dezember 2016, 21:07:00
Hallo Rainer,

soweit ich das in dem kleinen Ausschnitt des dritten Bildes beurteilen kann, sendet solarlog ein FIN an gandlaf.
Das ist das Flag zum Beenden der Verbindung. Also kommt das von Solarlog ...

Übrigens scheint das Droppen der Verbindung bei Homematik-Geräten im Netz ein Problem zu sein, das auch andere haben:
https://forum.fhem.de/index.php/topic,62102.0.html
bzw.
https://forum.fhem.de/index.php/topic,62073.0.html

Gruss
    Stefan
Titel: Antw:Modbus: disconnected, waiting to reappear / reappeared
Beitrag von: Deinjo am 05 März 2017, 12:54:23
Hallo,

@Twix: Konntest Du das Problem nun final beseitigen? Ich hab nämlich das gleiche Problem mit einem Solarlog200.

Bei mir sieht der Log so aus:
Code Auswählen
2017.03.04 12:00:54.412 1: 192.168.178.20:502 disconnected, waiting to reappear (SolarLogServer)
2017.03.04 12:00:54.854 1: 192.168.178.20:502 reappeared (SolarLogServer)
2017.03.04 12:01:55.550 1: 192.168.178.20:502 disconnected, waiting to reappear (SolarLogServer)
2017.03.04 12:01:55.568 1: 192.168.178.20:502 reappeared (SolarLogServer)
2017.03.04 12:02:56.337 1: 192.168.178.20:502 disconnected, waiting to reappear (SolarLogServer)
2017.03.04 12:02:56.355 1: 192.168.178.20:502 reappeared (SolarLogServer)
2017.03.04 12:03:57.257 1: 192.168.178.20:502 disconnected, waiting to reappear (SolarLogServer)
2017.03.04 12:03:57.274 1: 192.168.178.20:502 reappeared (SolarLogServer)
2017.03.04 12:04:58.017 1: 192.168.178.20:502 disconnected, waiting to reappear (SolarLogServer)
2017.03.04 12:04:58.035 1: 192.168.178.20:502 reappeared (SolarLogServer)
2017.03.04 12:05:58.757 1: 192.168.178.20:502 disconnected, waiting to reappear (SolarLogServer)
2017.03.04 12:05:58.775 1: 192.168.178.20:502 reappeared (SolarLogServer)
2017.03.04 12:06:59.558 1: 192.168.178.20:502 disconnected, waiting to reappear (SolarLogServer)
2017.03.04 12:06:59.578 1: 192.168.178.20:502 reappeared (SolarLogServer)
2017.03.04 12:08:00.375 1: 192.168.178.20:502 disconnected, waiting to reappear (SolarLogServer)
2017.03.04 12:08:00.393 1: 192.168.178.20:502 reappeared (SolarLogServer)
2017.03.04 12:09:01.364 1: 192.168.178.20:502 disconnected, waiting to reappear (SolarLogServer)
2017.03.04 12:09:01.383 1: 192.168.178.20:502 reappeared (SolarLogServer)
2017.03.04 12:10:02.068 1: 192.168.178.20:502 disconnected, waiting to reappear (SolarLogServer)
2017.03.04 12:10:02.085 1: 192.168.178.20:502 reappeared (SolarLogServer)
...
Als recht genau alle 61s.
Zwischendurch sind selten auch mal Sprünge von mehreren Minuten.


Bei mir fing das auch irgendwann an.
Hab zwischenzeitlich mal an den Attributen "updateInterval" der Readings rumgestellt. Bin mir aber nicht sicher ob es da direkt einen zusammenhang gibt.

Gruß aus Dortmund
Jörg
Nur Text | Text mit Bildern