Help Please the wife is losing faith! ZHA/Zigbee router devices becoming Unknown

dmulcahey · April 13, 2021, 11:49pm

Post a listing of the manufactures and models of all devices that show as routers on the device pages.

bdb1 · April 14, 2021, 12:21am

I think this is what I have. Largely it’s the bulbs that are dropping off I think. The odd switch but given there are way more bulbs that may explain why it’s mainly them.

GLEDOPTO - GL-C-007, GL-S-003Z, GL-S-007Z, GL-G-001ZS, GL-B-008Z
Tuya Repeater TS0207
Feibit FNB56-SKT1EHG1.2
ptvo.switch
Lumi - Lumi-plug, lumi.ctrl_ln1.aq1, lumi.ctrl_ln2.aq1, lumi.relay.c2acn01
Sunricher ZG9101SAC-HP
Owon WSP404
Philips 1743530P7

code-in-progress · April 14, 2021, 12:36am

Thanks for jumping in @dmulcahey. Much appreciated.

dmulcahey · April 14, 2021, 1:12am

In the visualization what are the bulbs connected to?

bdb1 · April 14, 2021, 1:30am

I assume you mean the ones that are failing? So one of them is connected to 6 other routers. 3 are green links, one is green and one is orange. See picture below. Also see that it thinks it’s connected but does not turn off individually.

Is ther a way to isolate so you can see a list of things they are actually connected to vs. having to zoom in and out?

dmulcahey · April 14, 2021, 1:45am

Not really… let’s do this. Turn debug logging on for Zigpy, the radio lib for your stick and ZHA. Then try to control the lights that fail and get me the logs.

What coordinator do you have?

bdb1 · April 14, 2021, 1:49am

I am running Conbee II and ZHA.

Is this what you want in the config? If so I already have it there.

logger:
default: info
logs:
asyncio: debug
homeassistant.components.zha: debug
zigpy: debug
bellows: debug
zigpy_xbee: debug
zigpy_deconz: debug

bdb1 · April 14, 2021, 1:53am

Here are the logs. Also See at the very top of this thread some other logs.

PS will remove the xbee line now.


2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x124b0021001a00ef000244a90104010a00010b0018d101000000e2450709280200
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x124b000900020022ef
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] APS data request response: [2, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, 239]
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0e4c000700a600
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_CONFIRM|2: 166>, 0]
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_confirm (0,)
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x044c0007000000
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x044c0013000c0022ef0244a901010000000000
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] APS data confirm response for request with id 239: 00
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Request id: 0xef 'aps_data_confirm' for <DeconzAddressEndpoint address_mode=ADDRESS_MODE.NWK address=0xa944 endpoint=1>, status: 0x00
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0e4d000700aa00
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_INDICATION|2: 170>, 0]
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_indication (1, 1)
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x174d000800010001
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x174d002a00230022020000010213740b040119000c00010401007e110a010100000000afff1b8df700c7
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] APS data indication response: [35, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x0000>, 1, <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x7413>, 11, 260, 25, b'\x01\x04\x01\x00~\x11\n\x01\x01\x00\x00\x00', 0, 175, 255, 27, 141, 247, 0, -57]
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy.zcl] [0x7413:11:0x0019] ZCL deserialize: <ZCLHeader frame_control=<FrameControl frame_type=CLUSTER_COMMAND manufacturer_specific=False is_reply=False disable_default_response=False> manufacturer=None tsn=4 command_id=1>
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy.zcl] [0x7413:11:0x0019] ZCL request 0x0001: [0, 4478, 266, 1, None]
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy.zcl] [0x7413:11:0x0019] OTA query_next_image handler for 'FeiBit FNB56-SKT1EHG1.2': field_control=0, manufacture_id=4478, image_type=266, current_file_version=1, hardware_version=None
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy.zcl] [0x7413:11:0x0019] No OTA image is available
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.zigbee.application] Sending Zigbee request with tsn 4 under 240 request id, data: b'19040298'
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] 'aps_data_indication' response from <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x7413>, ep: 11, profile: 0x0104, cluster_id: 0x0019, data: b'010401007e110a0101000000'
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_request (19, 240, 0, <DeconzAddressEndpoint address_mode=2 address=0x7413 endpoint=11>, 260, 25, 1, b'\x19\x04\x02\x98', 2, 0)
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x124e001a001300f0000213740b04011900010400190402980200
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x124e000900020022f0
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] APS data request response: [2, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, 240]
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0e4f000700a600
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_CONFIRM|2: 166>, 0]
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_confirm (0,)
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x044f0007000000
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x044f0013000c0022f00213740b010000000000
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] APS data confirm response for request with id 240: 00
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Request id: 0xf0 'aps_data_confirm' for <DeconzAddressEndpoint address_mode=ADDRESS_MODE.NWK address=0x7413 endpoint=11>, status: 0x00
2021-04-14 13:52:05 DEBUG (MainThread) [homeassistant.components.zha.entity] light.master_downlight_1: polling current state
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.zigbee.application] Sending Zigbee request with tsn 241 under 242 request id, data: b'00f1000000'
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_request (20, 242, 0, <DeconzAddressEndpoint address_mode=2 address=0x471A endpoint=11>, 260, 6, 1, b'\x00\xf1\x00\x00\x00', 2, 0)
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x1250001b001400f200021a470b0401060001050000f10000000200
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x1250000900020022f2
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] APS data request response: [2, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, 242]
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0e51000700a600
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_CONFIRM|2: 166>, 0]
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_confirm (0,)
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x04510007000000
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x04510013000c0022f2021a470b010000000000
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] APS data confirm response for request with id 242: 00
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Request id: 0xf2 'aps_data_confirm' for <DeconzAddressEndpoint address_mode=ADDRESS_MODE.NWK address=0x471a endpoint=11>, status: 0x00
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0e52000700aa00
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_INDICATION|2: 170>, 0]
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_indication (1, 1)
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x1752000800010001
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x17520026001f002202000001021a470b04010600080018f101000000100000afff1b8df700c2
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] APS data indication response: [31, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x0000>, 1, <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x471a>, 11, 260, 6, b'\x18\xf1\x01\x00\x00\x00\x10\x00', 0, 175, 255, 27, 141, 247, 0, -62]
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy.zcl] [0x471a:11:0x0006] ZCL deserialize: <ZCLHeader frame_control=<FrameControl frame_type=GLOBAL_COMMAND manufacturer_specific=False is_reply=True disable_default_response=True> manufacturer=None tsn=241 command_id=Command.Read_Attributes_rsp>
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] 'aps_data_indication' response from <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x471a>, ep: 11, profile: 0x0104, cluster_id: 0x0006, data: b'18f1010000001000'
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.zigbee.application] Sending Zigbee request with tsn 243 under 244 request id, data: b'00f3000000'
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_request (20, 244, 0, <DeconzAddressEndpoint address_mode=2 address=0x471A endpoint=11>, 260, 8, 1, b'\x00\xf3\x00\x00\x00', 2, 0)
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x1253001b001400f400021a470b0401080001050000f30000000200
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x1253000900020022f4
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] APS data request response: [2, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, 244]
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0e54000700a600
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_CONFIRM|2: 166>, 0]
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_confirm (0,)
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x04540007000000
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x04540013000c0022f4021a470b010000000000
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] APS data confirm response for request with id 244: 00
2021-04-14 13:52:05 DEBUG (MainThread) [zigpy_deconz.api] Request id: 0xf4 'aps_data_confirm' for <DeconzAddressEndpoint address_mode=ADDRESS_MODE.NWK address=0x471a endpoint=11>, status: 0x00
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0e55000700aa00
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_INDICATION|2: 170>, 0]
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_indication (1, 1)
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x1755000800010001
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x17550026001f002202000001021a470b04010800080018f30100000020fe00afff1b8df700c6
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.api] APS data indication response: [31, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x0000>, 1, <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x471a>, 11, 260, 8, b'\x18\xf3\x01\x00\x00\x00 \xfe', 0, 175, 255, 27, 141, 247, 0, -58]
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy.zcl] [0x471a:11:0x0008] ZCL deserialize: <ZCLHeader frame_control=<FrameControl frame_type=GLOBAL_COMMAND manufacturer_specific=False is_reply=True disable_default_response=True> manufacturer=None tsn=243 command_id=Command.Read_Attributes_rsp>
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.api] 'aps_data_indication' response from <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x471a>, ep: 11, profile: 0x0104, cluster_id: 0x0008, data: b'18f30100000020fe'
2021-04-14 13:52:06 DEBUG (MainThread) [homeassistant.components.zha.core.channels.base] [0x471A:11:0x0008]: received attribute: 0 update with value: 254
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.zigbee.application] Sending Zigbee request with tsn 245 under 246 request id, data: b'00f50008000700030004000240'
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_request (28, 246, 0, <DeconzAddressEndpoint address_mode=2 address=0x471A endpoint=11>, 260, 768, 1, b'\x00\xf5\x00\x08\x00\x07\x00\x03\x00\x04\x00\x02@', 2, 0)
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x12560023001c00f600021a470b04010003010d0000f500080007000300040002400200
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x1256000900020022f6
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.api] APS data request response: [2, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, 246]
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0e57000700a600
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_CONFIRM|2: 166>, 0]
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_confirm (0,)
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x04570007000000
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x04570013000c0022f6021a470b010000000000
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.api] APS data confirm response for request with id 246: 00
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.api] Request id: 0xf6 'aps_data_confirm' for <DeconzAddressEndpoint address_mode=ADDRESS_MODE.NWK address=0x471a endpoint=11>, status: 0x00
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0e58000700aa00
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_INDICATION|2: 170>, 0]
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_indication (1, 1)
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x1758000800010001
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x1758003d0036002202000001021a470b040100031f0018f501080000300207000021900103000021dd2404000021910d024000200000afff1b8df700c7
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.api] APS data indication response: [54, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x0000>, 1, <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x471a>, 11, 260, 768, b'\x18\xf5\x01\x08\x00\x000\x02\x07\x00\x00!\x90\x01\x03\x00\x00!\xdd$\x04\x00\x00!\x91\r\x02@\x00 \x00', 0, 175, 255, 27, 141, 247, 0, -57]
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy.zcl] [0x471a:11:0x0300] ZCL deserialize: <ZCLHeader frame_control=<FrameControl frame_type=GLOBAL_COMMAND manufacturer_specific=False is_reply=True disable_default_response=True> manufacturer=None tsn=245 command_id=Command.Read_Attributes_rsp>
2021-04-14 13:52:06 DEBUG (MainThread) [zigpy_deconz.api] 'aps_data_indication' response from <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x471a>, ep: 11, profile: 0x0104, cluster_id: 0x0300, data: b'18f501080000300207000021900103000021dd2404000021910d0240002000'
2021-04-14 13:52:06 DEBUG (MainThread) [homeassistant.components.zha.core.channels.base] [0x7791:11:0x0006]: command failed: 'off' args: '()' kwargs '{}' exception: ''
2021-04-14 13:52:06 DEBUG (MainThread) [homeassistant.components.zha.entity] light.jack_downlight_3: turned off: 
2021-04-14 13:52:07 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x1c59000c0005000217d5ffc9
2021-04-14 13:52:08 DEBUG (MainThread) [homeassistant.components.zha.core.channels.base] [0x7791:11:0x0006]: command failed: 'on' args: '()' kwargs '{}' exception: ''
2021-04-14 13:52:08 DEBUG (MainThread) [homeassistant.components.zha.entity] light.jack_downlight_3: turned on: {'on_off': TimeoutError()}

dmulcahey · April 14, 2021, 1:53am

If you have a conbee you can remove the xbee line from the config.

dmulcahey · April 14, 2021, 1:55am

Was this always an issue or did it start recently?

Is the firmware on your stick current?

Did you add any devices to the mesh around the time this started?

bdb1 · April 14, 2021, 2:07am


2021-04-14 14:01:56 DEBUG (MainThread) [zigpy.zcl] [0xa32f:1:0x000a] ZCL deserialize: <ZCLHeader frame_control=<FrameControl frame_type=GLOBAL_COMMAND manufacturer_specific=False is_reply=False disable_default_response=True> manufacturer=None tsn=79 command_id=Command.Read_Attributes>
2021-04-14 14:01:56 DEBUG (MainThread) [zigpy.zcl] [0xa32f:1:0x000a] ZCL request 0x0000: [[0]]
2021-04-14 14:01:56 DEBUG (MainThread) [zigpy_deconz.zigbee.application] Sending Zigbee request with tsn 79 under 195 request id, data: b'184f01000000e294090928'
2021-04-14 14:01:56 DEBUG (MainThread) [zigpy_deconz.api] 'aps_data_indication' response from <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0xa32f>, ep: 1, profile: 0x0104, cluster_id: 0x000a, data: b'104f000000'
2021-04-14 14:01:56 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_request (26, 195, 0, <DeconzAddressEndpoint address_mode=2 address=0xA32F endpoint=1>, 260, 10, 1, b'\x18O\x01\x00\x00\x00\xe2\x94\t\t(', 2, 0)
2021-04-14 14:01:56 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x12d90021001a00c300022fa30104010a00010b00184f01000000e2940909280200
2021-04-14 14:01:56 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x12d9000900020022c3
2021-04-14 14:01:56 DEBUG (MainThread) [zigpy_deconz.api] APS data request response: [2, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, 195]
2021-04-14 14:01:56 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0eda000700a600
2021-04-14 14:01:56 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_CONFIRM|2: 166>, 0]
2021-04-14 14:01:56 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_confirm (0,)
2021-04-14 14:01:56 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x04da0007000000
2021-04-14 14:01:56 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x04da0013000c0022c3022fa301010000000000
2021-04-14 14:01:56 DEBUG (MainThread) [zigpy_deconz.api] APS data confirm response for request with id 195: 00
2021-04-14 14:01:56 DEBUG (MainThread) [zigpy_deconz.api] Request id: 0xc3 'aps_data_confirm' for <DeconzAddressEndpoint address_mode=ADDRESS_MODE.NWK address=0xa32f endpoint=1>, status: 0x00
2021-04-14 14:02:01 DEBUG (MainThread) [zigpy_deconz.zigbee.application] Sending Zigbee request with tsn 196 under 197 request id, data: b'01c400'
2021-04-14 14:02:01 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_request (18, 197, 0, <DeconzAddressEndpoint address_mode=2 address=0x7791 endpoint=11>, 260, 6, 1, b'\x01\xc4\x00', 2, 0)
2021-04-14 14:02:01 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x12db0019001200c5000291770b0401060001030001c4000200
2021-04-14 14:02:01 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x12db000900020022c5
2021-04-14 14:02:01 DEBUG (MainThread) [zigpy_deconz.api] APS data request response: [2, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, 197]
2021-04-14 14:02:01 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0edc000700a600
2021-04-14 14:02:01 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_CONFIRM|2: 166>, 0]
2021-04-14 14:02:01 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_confirm (0,)
2021-04-14 14:02:01 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x04dc0007000000
2021-04-14 14:02:01 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x04dc0013000c0022c50291770b010000000000
2021-04-14 14:02:01 DEBUG (MainThread) [zigpy_deconz.api] APS data confirm response for request with id 197: 00
2021-04-14 14:02:01 DEBUG (MainThread) [zigpy_deconz.api] Request id: 0xc5 'aps_data_confirm' for <DeconzAddressEndpoint address_mode=ADDRESS_MODE.NWK address=0x7791 endpoint=11>, status: 0x00
2021-04-14 14:02:01 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x1cdd000c0005000217d5ffc7
2021-04-14 14:02:02 DEBUG (MainThread) [zigpy_deconz.zigbee.application] Sending Zigbee request with tsn 198 under 199 request id, data: b'01c601'
2021-04-14 14:02:02 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_request (18, 199, 0, <DeconzAddressEndpoint address_mode=2 address=0x7791 endpoint=11>, 260, 6, 1, b'\x01\xc6\x01', 2, 0)
2021-04-14 14:02:02 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x12dd0019001200c7000291770b0401060001030001c6010200
2021-04-14 14:02:02 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x12dd000900020022c7
2021-04-14 14:02:02 DEBUG (MainThread) [zigpy_deconz.api] APS data request response: [2, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, 199]
2021-04-14 14:02:02 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0ede000700a600
2021-04-14 14:02:02 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_CONFIRM|2: 166>, 0]
2021-04-14 14:02:02 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_confirm (0,)
2021-04-14 14:02:02 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x04de0007000000
2021-04-14 14:02:02 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x04de0013000c0022c70291770b010000000000
2021-04-14 14:02:02 DEBUG (MainThread) [zigpy_deconz.api] APS data confirm response for request with id 199: 00
2021-04-14 14:02:02 DEBUG (MainThread) [zigpy_deconz.api] Request id: 0xc7 'aps_data_confirm' for <DeconzAddressEndpoint address_mode=ADDRESS_MODE.NWK address=0x7791 endpoint=11>, status: 0x00
2021-04-14 14:02:06 DEBUG (MainThread) [homeassistant.components.zha.core.channels.base] [0x7791:11:0x0006]: command failed: 'off' args: '()' kwargs '{}' exception: ''
2021-04-14 14:02:06 DEBUG (MainThread) [homeassistant.components.zha.entity] light.jack_downlight_3: turned off: 
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0edf000700aa00
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_INDICATION|2: 170>, 0]
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_indication (1, 1)
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x17df000800010001
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x17df0026001f002202000001026da50204010204080008190a000029dc0600afff0b91f700c3
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] APS data indication response: [31, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x0000>, 1, <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0xa56d>, 2, 260, 1026, b'\x08\x19\n\x00\x00)\xdc\x06', 0, 175, 255, 11, 145, 247, 0, -61]
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy.zcl] [0xa56d:2:0x0402] ZCL deserialize: <ZCLHeader frame_control=<FrameControl frame_type=GLOBAL_COMMAND manufacturer_specific=False is_reply=True disable_default_response=False> manufacturer=None tsn=25 command_id=Command.Report_Attributes>
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy.zcl] [0xa56d:2:0x0402] ZCL request 0x000a: [[Attribute(attrid=0, value=<TypeValue type=int16s, value=1756>)]]
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy.zcl] [0xa56d:2:0x0402] Attribute report received: measured_value=1756
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.zigbee.application] Sending Zigbee request with tsn 25 under 200 request id, data: b'18190b0a00'
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] 'aps_data_indication' response from <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0xa56d>, ep: 2, profile: 0x0104, cluster_id: 0x0402, data: b'08190a000029dc06'
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_request (20, 200, 0, <DeconzAddressEndpoint address_mode=2 address=0xA56D endpoint=2>, 260, 1026, 1, b'\x18\x19\x0b\n\x00', 2, 0)
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x12e0001b001400c800026da5020401020401050018190b0a000200
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x12e0000900020022c8
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] APS data request response: [2, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, 200]
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0ee1000700a600
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_CONFIRM|2: 166>, 0]
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_confirm (0,)
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x04e10007000000
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x04e10013000c0022c8026da502010000000000
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] APS data confirm response for request with id 200: 00
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] Request id: 0xc8 'aps_data_confirm' for <DeconzAddressEndpoint address_mode=ADDRESS_MODE.NWK address=0xa56d endpoint=2>, status: 0x00
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0ee2000700aa00
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_INDICATION|2: 170>, 0]
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_indication (1, 1)
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x17e2000800010001
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x17e20023001c0022020000010244a90104010a000500103800000000afbf0b91f700ba
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] APS data indication response: [28, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x0000>, 1, <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0xa944>, 1, 260, 10, b'\x108\x00\x00\x00', 0, 175, 191, 11, 145, 247, 0, -70]
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy.zcl] [0xa944:1:0x000a] ZCL deserialize: <ZCLHeader frame_control=<FrameControl frame_type=GLOBAL_COMMAND manufacturer_specific=False is_reply=False disable_default_response=True> manufacturer=None tsn=56 command_id=Command.Read_Attributes>
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy.zcl] [0xa944:1:0x000a] ZCL request 0x0000: [[0]]
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.zigbee.application] Sending Zigbee request with tsn 56 under 201 request id, data: b'183801000000e29f090928'
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] 'aps_data_indication' response from <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0xa944>, ep: 1, profile: 0x0104, cluster_id: 0x000a, data: b'1038000000'
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_request (26, 201, 0, <DeconzAddressEndpoint address_mode=2 address=0xA944 endpoint=1>, 260, 10, 1, b'\x188\x01\x00\x00\x00\xe2\x9f\t\t(', 2, 0)
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x12e30021001a00c9000244a90104010a00010b00183801000000e29f0909280200
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x12e3000900020022c9
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] APS data request response: [2, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, 201]
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0ee4000700a600
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_CONFIRM|2: 166>, 0]
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_confirm (0,)
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x04e40007000000
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x04e40013000c0022c90244a901010000000000
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] APS data confirm response for request with id 201: 00
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] Request id: 0xc9 'aps_data_confirm' for <DeconzAddressEndpoint address_mode=ADDRESS_MODE.NWK address=0xa944 endpoint=1>, status: 0x00
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x1ce5000c0005000217d5ffc9
2021-04-14 14:02:07 DEBUG (MainThread) [homeassistant.components.zha.core.channels.base] [0x7791:11:0x0006]: command failed: 'on' args: '()' kwargs '{}' exception: ''
2021-04-14 14:02:07 DEBUG (MainThread) [homeassistant.components.zha.entity] light.jack_downlight_3: turned on: {'on_off': TimeoutError()}
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x0ee6000700aa00
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] Device state changed response: [<DeviceState.128|APSDE_DATA_REQUEST_SLOTS_AVAILABLE|APSDE_DATA_INDICATION|2: 170>, 0]
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] Command Command.aps_data_indication (1, 1)
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Send: 0x17e5000800010001
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x17e50044003d00220200000102af96010401000026001c5f11290a01ff421d0121a90b0328170421a81305211c00062401000000000a21000064100000afd70b91f700bd
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] APS data indication response: [61, <DeviceState.APSDE_DATA_REQUEST_SLOTS_AVAILABLE|2: 34>, <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x0000>, 1, <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x96af>, 1, 260, 0, b'\x1c_\x11)\n\x01\xffB\x1d\x01!\xa9\x0b\x03(\x17\x04!\xa8\x13\x05!\x1c\x00\x06$\x01\x00\x00\x00\x00\n!\x00\x00d\x10\x00', 0, 175, 215, 11, 145, 247, 0, -67]
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy.zcl] [0x96af:1:0x0000] ZCL deserialize: <ZCLHeader frame_control=<FrameControl frame_type=GLOBAL_COMMAND manufacturer_specific=True is_reply=True disable_default_response=True> manufacturer=4447 tsn=41 command_id=Command.Report_Attributes>
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy.zcl] [0x96af:1:0x0000] ZCL request 0x000a: [[Attribute(attrid=65281, value=<TypeValue type=CharacterString, value=!�(!�!>)]]
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy.zcl] [0x96af:1:0x0000] Attribute report received: 65281=!�(!�!
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy.zcl] [0x96af:1:0x0001] Voltage mV: [Min]:2820 < [RAW]:2985 < [Max]:3100, Battery Percent: 59.0
2021-04-14 14:02:07 DEBUG (MainThread) [zigpy_deconz.api] 'aps_data_indication' response from <DeconzAddress address_mode=ADDRESS_MODE.NWK address=0x96af>, ep: 1, profile: 0x0104, cluster_id: 0x0000, data: b'1c5f11290a01ff421d0121a90b0328170421a81305211c00062401000000000a210000641000'
2021-04-14 14:02:08 DEBUG (MainThread) [zigpy_deconz.uart] Frame received: 0x1ce6000c00050002af96d7bd

dmulcahey · April 14, 2021, 3:17pm

First thing to try is to remove the tuya repeaters from the network and see if things get better over the next day or 2 as the network stabilizes after the device removal(s)

bdb1 · April 14, 2021, 8:46pm

Thanks David I will try this. Other than the fact these are one of the most recent additions is there any other reason for removing the Tuya repeaters? Should I restart all devices afterwards to help speed up the network repairing itself?

One other question. I have 6 Aqara v2 gateways in my house could these affect things? These have been in place for a while. None are connected to my Zigbee network (mostly because I don’t know how), but do have Zigbee in them. See them here

dmulcahey · April 14, 2021, 9:01pm

Tuya is notorious for not following the specs. I picked a few of these up to test them but I wouldn’t be shocked if they’re an issue.

bdb1 · April 14, 2021, 9:09pm

OK cool, thanks. Love the form factor. Any other ideas for repeaters. I have quite a long house so really need repeaters I think, though to be fair I’m not sure how to tell.

What did your tests tell you?

dmulcahey · April 14, 2021, 9:33pm

I haven’t done it yet. They’re sitting in a box atm…

dmulcahey · April 16, 2021, 12:10pm

Have you given this a try?

bdb1 · April 16, 2021, 7:50pm

Hi David

Thanks for following up.

Yes but with mixed results so far. I am trying re-pairing and resetting devices. I am still having devices all working one day getting RSSI of 255 then the next dropped off.

It would be great to be able to see what devices they are connected to un a table or something but ZHA does not provide this.

paddy0174 · April 16, 2021, 9:44pm

That should be here: Configuration -> Integrations -> ZHA -> configure -> Visualization.

bdb1 · April 17, 2021, 3:14am

Thanks David. The visualization is OK and I am aware of this. Problem is you have toi zoom in and out etc. It would be good to simply see what a device is connected to. This way I can see if there are some common devices that are causing this,