AES - HM-SEC-SC-2 - RESPONSE TIMEOUT:RegisterRead

Begonnen von borum, 22 August 2020, 18:25:09

Vorheriges Thema - Nächstes Thema

borum

Hallo zusammen,

ich habe vor eine Weile mit AES an meinem threeStateSensor (Fensterkontakt) ein paar Versuche durch gespielt um mich in die Verschlüsselung einzuarbeiten, was auch soweit funktioniert hat.
Leider jetzt ein paar Monate später wollte ich meinen Versuchskontakt für etwas anderes nutzen und bekomme ihn leider nicht mehr richtig gepaired und bin mir natürlich auch nicht mehr sicher wie der letzte Zustand von dem HM-SEC-SC-2 war bevor ich ihn weg gelegt habe.

Aktuell bekomme ich auch nach allen Werkseinstellungen am Device entweder "CMDs_done_Errors:1" oder "RESPONSE TIMEOUT:RegisterRead" als Meldung.

Auch nach vielen Bemühungen des Forum bin ich leider nicht weiter gekommen und hoffe ihr habe noch ein Idee!

Die List Ausgabe vom Device ist.

--------------------------------------------------------------------------------

Internals:
   CFGFN     
   CUL1_MSGCNT 48
   CUL1_RAWMSG A1A2AA0104E184FF1123402020009000A000B000C00100114060000::-52.5:CUL1
   CUL1_RSSI  -52.5
   CUL1_TIME  2020-08-22 18:06:41
   DEF        4E184F
   FUUID      5f4136ce-f33f-5a4e-fd47-a7762f6f9559685f
   IODev      CUL1
   LASTInputDev CUL1
   MSGCNT     48
   NAME       HM_4E184F
   NOTIFYDEV  global
   NR         2604
   STATE      RESPONSE TIMEOUT:RegisterRead
   TYPE       CUL_HM
   chanNo     01
   lastMsg    No:2A - t:10 s:4E184F d:F11234 02020009000A000B000C00100114060000
   protCmdDel 38
   protLastRcv 2020-08-22 18:06:41
   protRcv    43 last_at:2020-08-22 18:06:41
   protResndFail 16 last_at:2020-08-22 18:06:47
   protSnd    49 last_at:2020-08-22 18:06:41
   protState  CMDs_done_Errors:1
   rssi_at_CUL1 cnt:49 min:-55 max:-41.5 avg:-48.31 lst:-52.5
   READINGS:
     2020-08-22 18:06:41   Activity        alive
     2020-08-22 17:54:52   CommandAccepted yes
     2020-08-22 18:06:41   D-firmware      2.4
     2020-08-22 18:06:41   D-serialNr      NEQ1110758
     2020-08-22 18:06:41   PairedTo        0x000000
     2020-08-22 17:19:29   R-cyclicInfoMsg off
     2020-08-22 17:19:29   R-pairCentral   0x000000
     2020-08-22 17:19:29   R-transmDevTryMax 6
     2020-08-22 18:06:41   RegL_00.         00:00 02:00 09:00 0A:00 0B:00 0C:00 10:01 14:06
     2020-08-22 17:54:52   aesCommToDev    ok
     2020-08-22 17:54:52   aesKeyNbr       00
     2020-08-22 18:05:29   battery         ok
     2020-08-22 18:05:29   contact         open (to broadcast)
     2020-08-22 18:06:47   state           RESPONSE TIMEOUT:RegisterRead
     2020-08-22 18:05:29   trigger_cnt     1
     RegL_01.:
       VAL       
   helper:
     HM_CMDNR   43
     PONtest    1
     cSnd       01F112344E184F00040000000000,01F112344E184F01040000000001
     getCfgList all
     getCfgListNo ,4
     mId        002F
     peerFriend peerAct,peerVirt
     peerOpt    4:threeStateSensor
     regLst     0,1,4p
     rxType     4
     supp_Pair_Rep 0
     expert:
       def        1
       det        1
       raw        1
       tpl        0
     io:
       newChn     +4E184F,00,01,00
       nextSend   1598112401.90248
       prefIO     
       rxt        0
       vccu       
       p:
         4E184F
         00
         01
         00
     mRssi:
       mNo        2A
       io:
         CUL1:
           -46.5
           -46.5
     prt:
       bErr       0
       sProc      0
       helper:
         prt:
           rspWait:
     q:
       qReqConf   00
       qReqStat   
     regCollect:
     role:
       chn        1
       dev        1
     rpt:
       IO         CUL1
       flg        A
       ts         1598112401.80305
       ack:
         HASH(0x44a64a8)
         2A8002F112344E184F00
     rssi:
       at_CUL1:
         avg        -48.3163265306123
         cnt        49
         lst        -52.5
         max        -41.5
         min        -55
     shadowReg:
     tmpl:
   role:
Attributes:
   IODev      CUL1
   IOgrp      VCCU:CUL1
   actCycle   028:00
   actStatus  alive
   autoReadReg 4_reqStatus
   expert     3_allReg+raw
   firmware   2.4
   model      HM-SEC-SC-2
   room       CUL_HM
   serialNr   NEQ1110758
   subType    threeStateSensor

--------------------------------------------------------------------------------

Danke schon mal

Grüße
Borum

frank

1. das device ist nicht gepairt
2. dein fhem ist nicht up-to-date.
FHEM: 6.0(SVN) => Pi3(buster)
IO: CUL433|CUL868|HMLAN|HMUSB2|HMUART
CUL_HM: CC-TC|CC-VD|SEC-SD|SEC-SC|SEC-RHS|Sw1PBU-FM|Sw1-FM|Dim1TPBU-FM|Dim1T-FM|ES-PMSw1-Pl
IT: ITZ500|ITT1500|ITR1500|GRR3500
WebUI [HMdeviceTools.js (hm.js)]: https://forum.fhem.de/index.php/topic,106959.0.html

borum

Hallo Frank,

das dachte ich mir schon da ich bei "PairedTo 0x000000" stehen habe, leider weiß ich nicht wieso das so ist nach dem ich mehrfach das Device gelöscht habe und entweder mit "hmPairForSec" oder mit hmPairSerial das Device neu registriert  habe und dies leider nicht richtig funktioniert.

Das mit der Firmware weiß ich, hoffe aber das dies nicht das Problem ist, da ich noch 12 weitere Kontakte ohne Probleme am laufen habe und ich nicht gerne ohne weitere Test neue Firmware einspiele da ich sonst immer in irgendwelche neuen Probleme rein laufe.

Grüße
Borum

frank

ich meinte die fhem software updaten, nicht die firmware vom device.
das ist aber wahrscheinlich nicht dein problem.

eher schon der cul.
wenn der nicht die tsculfw hat, kann die kommunikation schwierig sein. vor allem, wenn auch noch aes im spiel ist.

sniffe die raw messages vom pairen, wie im wiki beschrieben.
FHEM: 6.0(SVN) => Pi3(buster)
IO: CUL433|CUL868|HMLAN|HMUSB2|HMUART
CUL_HM: CC-TC|CC-VD|SEC-SD|SEC-SC|SEC-RHS|Sw1PBU-FM|Sw1-FM|Dim1TPBU-FM|Dim1T-FM|ES-PMSw1-Pl
IT: ITZ500|ITT1500|ITR1500|GRR3500
WebUI [HMdeviceTools.js (hm.js)]: https://forum.fhem.de/index.php/topic,106959.0.html

borum

Folgende Messages bekomme ich beim pairing.


2020.08.23 08:48:32.356 5: CUL/RAW: /A1A1284004E184F0000002400B14E4551313131303735388081010135

2020.08.23 08:48:32.357 4: CUL_Parse: CUL1 A 1A 12 8400 4E184F 000000 2400B14E4551313131303735388081010135 -47.5
2020.08.23 08:48:32.362 5: CUL1: dispatch A1A1284004E184F0000002400B14E45513131313037353880810101::-47.5:CUL1
2020.08.23 08:48:32.364 2: CUL_HM Unknown device HM_4E184F is now defined
2020.08.23 08:48:32.381 2: autocreate: define HM_4E184F CUL_HM 4E184F
2020.08.23 08:48:32.419 2: autocreate: define FileLog_HM_4E184F FileLog ./log/HM_4E184F-%Y.log HM_4E184F
2020.08.23 08:48:33.041 3: Device HM_4E184F added to ActionDetector with 028:00 time
2020.08.23 08:48:33.047 3: CUL_HM pair: HM_4E184F threeStateSensor, model HM-SEC-SC-2 serialNr


Danach ist das Gerät im FHEM angelegt mit den bekannten Problemen.


2020.08.23 08:55:17.220 5: CUL/RAW: /A1A1384004E184F0000002400B14E4551313131303735388081010137

2020.08.23 08:55:17.221 4: CUL_Parse: CUL1 A 1A 13 8400 4E184F 000000 2400B14E4551313131303735388081010137 -46.5
2020.08.23 08:55:17.225 5: CUL1: dispatch A1A1384004E184F0000002400B14E45513131313037353880810101::-46.5:CUL1
2020.08.23 08:55:17.288 3: Device HM_4E184F added to ActionDetector with 028:00 time
2020.08.23 08:55:17.295 3: CUL_HM set HM_4E184F getConfig
2020.08.23 08:55:17.296 5: CUL1 sending As103BA001F112344E184F00050000000000
2020.08.23 08:55:17.296 5: CUL 4E184F dly:28ms
2020.08.23 08:55:17.325 5: SW: As103BA001F112344E184F00050000000000
2020.08.23 08:55:17.478 5: CUL/RAW: /A0A3B80024E184FF112340036

2020.08.23 08:55:17.479 4: CUL_Parse: CUL1 A 0A 3B 8002 4E184F F11234 0036 -47
2020.08.23 08:55:17.479 5: CUL1: dispatch A0A3B80024E184FF1123400::-47:CUL1
2020.08.23 08:55:17.482 5: CUL1 sending As133CA001F112344E184F000802010AF10B120C34
2020.08.23 08:55:17.483 5: CUL 4E184F dly:96ms
2020.08.23 08:55:17.580 5: SW: As133CA001F112344E184F000802010AF10B120C34


Testweise habe ich noch 2 andere Fensterkontakte angemeldet welches ohne Probleme funktioniert hat, nur dieser macht Probleme.

frank

2020.08.23 08:55:17.580 5: SW: As133CA001F112344E184F000802010AF10B120C34
wie geht es weiter?
hier fängt das pairen erst an.

kein device löschen, sondern immer drüber pairen.
drückst du auch oft genug das knöpfchen?
FHEM: 6.0(SVN) => Pi3(buster)
IO: CUL433|CUL868|HMLAN|HMUSB2|HMUART
CUL_HM: CC-TC|CC-VD|SEC-SD|SEC-SC|SEC-RHS|Sw1PBU-FM|Sw1-FM|Dim1TPBU-FM|Dim1T-FM|ES-PMSw1-Pl
IT: ITZ500|ITT1500|ITR1500|GRR3500
WebUI [HMdeviceTools.js (hm.js)]: https://forum.fhem.de/index.php/topic,106959.0.html

borum

Was auch seltsam ist, das wenn ich den Knopf kurz betätige die LED dauerhaft an bleibt, manchmal grün und manchmal orange.
Erst nach reset (5 sek drücken) geht sie aus bzw. nach reset (2x 5 sek drücken) und wenn ich dann wieder kurz betätige bleibt sie wieder an.


2020.08.23 10:27:12.660 5: CUL/RAW: /A1A0B84004E184F0000002400B14E4551313131303735388081010130

2020.08.23 10:27:12.661 4: CUL_Parse: CUL1 A 1A 0B 8400 4E184F 000000 2400B14E4551313131303735388081010130 -50
2020.08.23 10:27:12.662 5: CUL1: dispatch A1A0B84004E184F0000002400B14E45513131313037353880810101::-50:CUL1
2020.08.23 10:27:12.701 3: Device HM_4E184F added to ActionDetector with 028:00 time
2020.08.23 10:27:12.704 3: CUL_HM pair: HM_4E184F threeStateSensor, model HM-SEC-SC-2 serialNr NEQ1110758
2020.08.23 10:27:12.708 5: CUL_HM HM_4E184F protEvent:CMDs_pending pending:1
2020.08.23 10:27:12.708 5: CUL_HM HM_4E184F protEvent:CMDs_pending pending:2
2020.08.23 10:27:12.709 5: CUL_HM HM_4E184F protEvent:CMDs_pending pending:3
2020.08.23 10:27:12.713 5: CUL_HM HM_4E184F protEvent:CMDs_pending pending:4
2020.08.23 10:27:12.713 5: CUL_HM HM_4E184F protEvent:CMDs_pending pending:5
2020.08.23 10:27:12.714 5: CUL_HM HM_4E184F protEvent:CMDs_pending pending:6
2020.08.23 10:27:12.714 3: CUL_HM set HM_4E184F getConfig
2020.08.23 10:27:12.714 5: CUL1 sending As1033A001F112344E184F00050000000000
2020.08.23 10:27:12.715 5: CUL 4E184F dly:46ms
2020.08.23 10:27:12.762 5: SW: As1033A001F112344E184F00050000000000
2020.08.23 10:27:12.764 5: CUL_HM HM_4E184F protEvent:CMDs_processing... pending:5
2020.08.23 10:27:12.915 5: CUL/RAW: /A0A3380024E184FF11234002E

2020.08.23 10:27:12.915 4: CUL_Parse: CUL1 A 0A 33 8002 4E184F F11234 002E -51
2020.08.23 10:27:12.916 5: CUL1: dispatch A0A3380024E184FF1123400::-51:CUL1
2020.08.23 10:27:12.919 5: CUL1 sending As1334A001F112344E184F000802010AF10B120C34
2020.08.23 10:27:12.920 5: CUL 4E184F dly:96ms
2020.08.23 10:27:13.017 5: SW: As1334A001F112344E184F000802010AF10B120C34
2020.08.23 10:27:13.019 5: CUL_HM HM_4E184F protEvent:CMDs_processing... pending:4




2020.08.23 10:28:29.201 4: CUL_Parse: CUL1 A 0C 1A 8470 540978 000000 01043629 -53.5
2020.08.23 10:28:29.203 5: CUL1: dispatch A0C1A8470540978000000010436::-53.5:CUL1
2020.08.23 10:28:32.289 5: CUL/RAW: /A1A0C84004E184F0000002400B14E455131313130373538808101012E

2020.08.23 10:28:32.290 4: CUL_Parse: CUL1 A 1A 0C 8400 4E184F 000000 2400B14E455131313130373538808101012E -51
2020.08.23 10:28:32.292 5: CUL1: dispatch A1A0C84004E184F0000002400B14E45513131313037353880810101::-51:CUL1
2020.08.23 10:28:32.389 3: Device HM_4E184F added to ActionDetector with 028:00 time
2020.08.23 10:28:32.394 5: CUL_HM HM_4E184F protEvent:CMDs_pending pending:1
2020.08.23 10:28:32.395 5: CUL_HM HM_4E184F protEvent:CMDs_pending pending:2
2020.08.23 10:28:32.396 5: CUL_HM HM_4E184F protEvent:CMDs_pending pending:3
2020.08.23 10:28:32.396 3: CUL_HM set HM_4E184F getConfig
2020.08.23 10:28:32.397 5: CUL1 sending As1034A001F112344E184F00040000000000
2020.08.23 10:28:32.399 5: SW: As1034A001F112344E184F00040000000000
2020.08.23 10:28:32.401 5: CUL_HM HM_4E184F protEvent:CMDs_processing... pending:2
2020.08.23 10:28:32.470 5: CUL/RAW: /A0699FF0EB52430B9

2020.08.23 10:28:32.470 4: CUL_Parse: CUL1 A 06 99 FF0E B52430 B9  -109.5
2020.08.23 10:28:32.471 5: CUL1: dispatch A0699FF0EB52430
2020.08.23 10:28:32.480 3: CUL1: Unknown code A0699FF0EB52430, help me!
2020.08.23 10:28:32.565 5: CUL/RAW: /A1A34A0104E184FF1123402020009000A000B000C001001140600002F

2020.08.23 10:28:32.566 4: CUL_Parse: CUL1 A 1A 34 A010 4E184F F11234 02020009000A000B000C001001140600002F -50.5
2020.08.23 10:28:32.567 5: CUL1: dispatch A1A34A0104E184FF1123402020009000A000B000C00100114060000::-50.5:CUL1
2020.08.23 10:28:32.573 5: CUL1 sending As0A348002F112344E184F00
2020.08.23 10:28:32.574 5: CUL 4E184F dly:93ms
2020.08.23 10:28:32.667 5: SW: As0A348002F112344E184F00
2020.08.23 10:28:32.669 5: CUL_HM HM_4E184F protEvent:CMDs_processing... pending:2
2020.08.23 10:28:32.670 5: CUL_HM HM_4E184F sent ACK:2
2020.08.23 10:28:32.670 5: CUL1 sending As1035A001F112344E184F01040000000001
2020.08.23 10:28:32.671 5: SW: As1035A001F112344E184F01040000000001
2020.08.23 10:28:32.673 5: CUL_HM HM_4E184F protEvent:CMDs_processing... pending:1
2020.08.23 10:28:36.864 5: CUL_HM HM_4E184F protEvent:CMDs_done_Errors:1
2020.08.23 10:28:41.071 5: CUL/RAW: /A14E4A45F454441F112349E51F5000638009C093101FE


frank

2020.08.23 10:28:32.480 3: CUL1: Unknown code A0699FF0EB52430, help me!
hier empfängt der cul eine message von HMIP!

eventuell stört hmip das device?
ist hmip von dir?

längere led phasen können schon vorkommen. natürlich nicht unendlich.
batterien mal erneuern?
FHEM: 6.0(SVN) => Pi3(buster)
IO: CUL433|CUL868|HMLAN|HMUSB2|HMUART
CUL_HM: CC-TC|CC-VD|SEC-SD|SEC-SC|SEC-RHS|Sw1PBU-FM|Sw1-FM|Dim1TPBU-FM|Dim1T-FM|ES-PMSw1-Pl
IT: ITZ500|ITT1500|ITR1500|GRR3500
WebUI [HMdeviceTools.js (hm.js)]: https://forum.fhem.de/index.php/topic,106959.0.html

borum

Woran erkennst du das das ein hmip Gerät ist?

Bei gibt es nur Pi3/ FHEM / CUL (V 1.66 CUL868) / Phoscon GW (Pi4)

Neue Batterien habe ich versucht, leider das gleiche verhalten.

frank

FHEM: 6.0(SVN) => Pi3(buster)
IO: CUL433|CUL868|HMLAN|HMUSB2|HMUART
CUL_HM: CC-TC|CC-VD|SEC-SD|SEC-SC|SEC-RHS|Sw1PBU-FM|Sw1-FM|Dim1TPBU-FM|Dim1T-FM|ES-PMSw1-Pl
IT: ITZ500|ITT1500|ITR1500|GRR3500
WebUI [HMdeviceTools.js (hm.js)]: https://forum.fhem.de/index.php/topic,106959.0.html

borum

Achso..

Habe jetzt das Update auf die neueste FHEM Version gemacht, beim Sensor brachte es keine Verbesserung, leider habe ich neue Probleme bekomme das einige meiner Scripte (notifys) jetzt aktiviert werden trotzdem sie nicht vom Trigger gestartet wurden.
Gab es in den letzten Versionen Syntax Anpassungen oder sowas, hatte etwas ähnliches schon einmal gehabt nach einem Update und habe lange gesucht bis ich die Änderungen gefunden habe.

MadMax-FHEM

#11
Zitat von: borum am 23 August 2020, 12:51:13
Habe jetzt das Update auf die neueste FHEM Version gemacht, beim Sensor brachte es keine Verbesserung, leider habe ich neue Probleme bekomme das einige meiner Scripte (notifys) jetzt aktiviert werden trotzdem sie nicht vom Trigger gestartet wurden.

Sie wurden (verm.) sehr wohl vom Trigger bzw. eher vom Event gestartet/aktiviert!

ABER: deine RegEx bzgl. Trigger war wohl "zu lasch"... ;)

Zitat von: borum am 23 August 2020, 12:51:13
Gab es in den letzten Versionen Syntax Anpassungen oder sowas, hatte etwas ähnliches schon einmal gehabt nach einem Update und habe lange gesucht bis ich die Änderungen gefunden habe.

Ja, es wurde etwas geändert.
Es kommen Events die "Ähnlichkeit" mit bereits vorhandenen haben...
...und wenn die RegEx "zu lasch"/"großzügig" war/ist -> Trigger!

Ich schau mal, ob ich einen passenden Link finde...
...ansonsten mal im Forum suchen.

EDIT: https://forum.fhem.de/index.php/topic,113365.msg1076617.html#msg1076617

Gruß, Joachim
FHEM PI3B+ Bullseye: HM-CFG-USB, 40x HM, ZWave-USB, 13x ZWave, EnOcean-PI, 15x EnOcean, HUE/deCONZ, CO2, ESP-Multisensor, Shelly, alexa-fhem, ...
FHEM PI2 Buster: HM-CFG-USB, 25x HM, ZWave-USB, 4x ZWave, EnOcean-PI, 3x EnOcean, Shelly, ha-bridge, ...
FHEM PI3 Buster (Test)

borum

Nach deinem Tip das die Probleme von einer nicht zu genauen RegEx der Trigger/Events kommen könnte, habe ich (hoffentlich keinen vergessen) alle notify/watchdog angeschaut und gegebenen falls diese genauer verfasst.
Aktuell sieht es ganz gut aus..

Meiner Vermutung nach lag es an den 4 Kanal Fernbedienungen welche vorher von mir nur mit "4KanalAlarmFunkfernbedienung4_Btn_04:*" überwacht wurde und jetzt mit "4KanalAlarmFunkfernbedienung4_Btn_04:Short.*".

Vielen Dank dafür!

Leider hatte das Update nach wie vor keine Besserung an meinem HM-SEC-SC-2 gebracht, hat jemand noch eine Idee was mit dem Sensor sein kann?







frank

ohne raw messages kann man ja gar nicht beurteilen, was sich tut.

bisher hast du den fk scheinbar im open zustand angesprochen.
häng doch mal den magneten an das device, sodass der fk closed ist. vielleicht reagiert er dann anders.  :)



in einem sniff sendet der cul 2 messages innerhalb von 4ms an den fk. das könnte ihn eventuell auch in diesen freeze zustand bringen.

2020.08.23 10:28:32.290 4: CUL_Parse: CUL1 A 1A 0C 8400 4E184F 000000 2400B14E455131313130373538808101012E -51
2020.08.23 10:28:32.399 5: SW: As1034A001F112344E184F00040000000000
2020.08.23 10:28:32.566 4: CUL_Parse: CUL1 A 1A 34 A010 4E184F F11234 02020009000A000B000C001001140600002F -50.5
2020.08.23 10:28:32.667 5: SW: As0A348002F112344E184F00
2020.08.23 10:28:32.671 5: SW: As1035A001F112344E184F01040000000001


solche "doppelschüsse" könnten mit der tsculfw für den cul eventuell vermieden werden.


von aes ist überhaupt nichts zu sehen.
das device antwortet zunächst auf die ersten befehle, und verstummt dann.

ohne timingfähige firmware, bleibt es trotzdem spekulation.
FHEM: 6.0(SVN) => Pi3(buster)
IO: CUL433|CUL868|HMLAN|HMUSB2|HMUART
CUL_HM: CC-TC|CC-VD|SEC-SD|SEC-SC|SEC-RHS|Sw1PBU-FM|Sw1-FM|Dim1TPBU-FM|Dim1T-FM|ES-PMSw1-Pl
IT: ITZ500|ITT1500|ITR1500|GRR3500
WebUI [HMdeviceTools.js (hm.js)]: https://forum.fhem.de/index.php/topic,106959.0.html

borum

Kann ich bei den Messages noch weitere Details aktivieren um mehr Informationen zu bekommen?

Mit Magnet Kontakt oder ohne macht es keinen Unterschied.