Skip to content
New issue

Have a question about this project? Sign up for a free GitHub account to open an issue and contact its maintainers and the community.

By clicking “Sign up for GitHub”, you agree to our terms of service and privacy statement. We’ll occasionally send you account related emails.

Already on GitHub? Sign in to your account

Z2M crash: zh:ember:uart:ash: Frame(s) in progress cancelled in [1313131313131313131313131313131313131 #25860

Open
Sjorsa opened this issue Jan 16, 2025 · 0 comments
Labels
problem Something isn't working

Comments

@Sjorsa
Copy link

Sjorsa commented Jan 16, 2025

What happened?

I have a fresh install of Z2M. Z2M crashes after a couple minutes, with the main error being zh:ember:uart:ash: Frame(s) in progress cancelled in [1313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131ac102029b7b7e]

I have a brand new Sonoff Dongle E adapter, flashed with ncp-uart-hw-v7.4.5.0-zbdonglee-115200.gbl.

What did you expect to happen?

No response

How to reproduce it (minimal and precise)

No response

Zigbee2MQTT version

2.0.0 commit: 060ae99

Adapter firmware version

7.4.5 [GA]

Adapter

Sonoff ZBDongle-E Zigbee 3.0 USB Dongle

Setup

Docker

Debug log

zigbee2mqtt  | Starting Zigbee2MQTT without watchdog.
zigbee2mqtt  | [2025-01-16 22:04:58] info:      z2m: Logging to console, file (filename: log.log)
zigbee2mqtt  | [2025-01-16 22:04:58] info:      z2m: Starting Zigbee2MQTT version 2.0.0 (commit #060ae99cff715cc9ef6a0cfa7cae0cdcb17f0c8a)
zigbee2mqtt  | [2025-01-16 22:04:58] info:      z2m: Starting zigbee-herdsman (3.2.1)
zigbee2mqtt  | [2025-01-16 22:04:58] info:      zh:ember: Using default stack config.
zigbee2mqtt  | [2025-01-16 22:04:58] info:      zh:ember: ======== Ember Adapter Starting ========
zigbee2mqtt  | [2025-01-16 22:04:58] info:      zh:ember:ezsp: ======== EZSP starting ========
zigbee2mqtt  | [2025-01-16 22:04:58] info:      zh:ember:uart:ash: ======== ASH Adapter reset ========
zigbee2mqtt  | [2025-01-16 22:04:58] info:      zh:ember:uart:ash: RTS/CTS config is off, enabling software flow control.
zigbee2mqtt  | [2025-01-16 22:04:58] info:      zh:ember:uart:ash: Serial port opened
zigbee2mqtt  | [2025-01-16 22:04:58] info:      zh:ember:uart:ash: ======== ASH starting ========
zigbee2mqtt  | [2025-01-16 22:05:00] info:      zh:ember:uart:ash: ======== ASH Adapter reset ========
zigbee2mqtt  | [2025-01-16 22:05:00] info:      zh:ember:uart:ash: ======== ASH starting ========
zigbee2mqtt  | [2025-01-16 22:05:03] info:      zh:ember:uart:ash: ======== ASH Adapter reset ========
zigbee2mqtt  | [2025-01-16 22:05:03] info:      zh:ember:uart:ash: ======== ASH starting ========
zigbee2mqtt  | [2025-01-16 22:05:05] info:      zh:ember:uart:ash: ======== ASH Adapter reset ========
zigbee2mqtt  | [2025-01-16 22:05:05] info:      zh:ember:uart:ash: ======== ASH starting ========
zigbee2mqtt  | [2025-01-16 22:05:06] info:      zh:ember:uart:ash: ======== ASH connected ========
zigbee2mqtt  | [2025-01-16 22:05:06] info:      zh:ember:uart:ash: ======== ASH started ========
zigbee2mqtt  | [2025-01-16 22:05:06] info:      zh:ember:ezsp: ======== EZSP started ========
zigbee2mqtt  | [2025-01-16 22:05:06] info:      zh:ember: Adapter EZSP protocol version (13) lower than Host. Switched.
zigbee2mqtt  | [2025-01-16 22:05:06] info:      zh:ember: Adapter version info: {"ezsp":13,"revision":"7.4.5 [GA]","build":0,"major":7,"minor":4,"patch":5,"special":0,"type":170}
zigbee2mqtt  | [2025-01-16 22:05:07] info:      zh:ember: [STACK STATUS] Network up.
zigbee2mqtt  | [2025-01-16 22:05:07] info:      zh:ember: [INIT TC] Adapter network matches config.
zigbee2mqtt  | [2025-01-16 22:05:07] info:      zh:ember: [CONCENTRATOR] Started source route discovery. 1248ms until next broadcast.
zigbee2mqtt  | [2025-01-16 22:05:07] info:      z2m: zigbee-herdsman started (resumed)
zigbee2mqtt  | [2025-01-16 22:05:07] info:      z2m: Coordinator firmware version: '{"meta":{"build":0,"ezsp":13,"major":7,"minor":4,"patch":5,"revision":"7.4.5 [GA]","special":0,"type":170},"type":"EmberZNet"}'
zigbee2mqtt  | [2025-01-16 22:05:07] info:      z2m: Currently 0 devices are joined.
zigbee2mqtt  | [2025-01-16 22:05:07] info:      z2m: Connecting to MQTT server at mqtt://10.0.0.2:1883
zigbee2mqtt  | [2025-01-16 22:05:07] info:      z2m: Connected to MQTT server
zigbee2mqtt  | [2025-01-16 22:05:07] info:      z2m:mqtt: MQTT publish: topic 'zigbee2mqtt/bridge/state', payload '{"state":"online"}'
zigbee2mqtt  | [2025-01-16 22:05:07] info:      z2m: Started frontend on port 8080
zigbee2mqtt  | [2025-01-16 22:05:07] info:      z2m: Zigbee2MQTT started!
zigbee2mqtt  | [2025-01-16 22:07:55] info:      z2m: Zigbee: allowing new devices to join.
zigbee2mqtt  | [2025-01-16 22:07:59] warning:   zh:ember:uart:ash: Frame(s) in progress cancelled in [1313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131313131ac102029b7b7e]
zigbee2mqtt  | [2025-01-16 22:07:59] error:     zh:ember:uart:ash: Received unexpected reset from adapter, with reason=RESET_POWERON.
zigbee2mqtt  | [2025-01-16 22:07:59] error:     zh:ember:uart:ash: ASH disconnected: ASH_ERROR_NCP_RESET | Adapter status: ASH_NCP_FATAL_ERROR
zigbee2mqtt  | [2025-01-16 22:07:59] error:     zh:ember:uart:ash: Error while parsing received frame, status=HOST_FATAL_ERROR.
zigbee2mqtt  | [2025-01-16 22:07:59] error:     zh:ember: Adapter fatal error: HOST_FATAL_ERROR
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash: ASH COUNTERS since last clear:
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   Total frames: RX=37, TX=75
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   Cancelled   : RX=1, TX=0
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   DATA frames : RX=35, TX=35
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   DATA bytes  : RX=298, TX=373
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   Retry frames: RX=0, TX=0
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   ACK frames  : RX=0, TX=36
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   NAK frames  : RX=0, TX=0
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   nRdy frames : RX=0, TX=0
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   CRC errors      : RX=0
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   Comm errors     : RX=0
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   Length < minimum: RX=0
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   Length > maximum: RX=0
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   Bad controls    : RX=0
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   Bad lengths     : RX=0
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   Bad ACK numbers : RX=0
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   Out of buffers  : RX=0
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   Retry dupes     : RX=0
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   Out of sequence : RX=0
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash:   ACK timeouts    : RX=0
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash: Port closed.
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:uart:ash: ======== ASH stopped ========
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember:ezsp: ======== EZSP stopped ========
zigbee2mqtt  | [2025-01-16 22:07:59] info:      zh:ember: ======== Ember Adapter Stopped ========
zigbee2mqtt  | [2025-01-16 22:07:59] error:     z2m: Adapter disconnected, stopping
zigbee2mqtt  | [2025-01-16 22:07:59] info:      z2m:mqtt: MQTT publish: topic 'zigbee2mqtt/bridge/state', payload '{"state":"offline"}'
zigbee2mqtt  | [2025-01-16 22:07:59] info:      z2m: Disconnecting from MQTT server
zigbee2mqtt  | [2025-01-16 22:07:59] info:      z2m: Stopping zigbee-herdsman...
zigbee2mqtt  | [2025-01-16 22:07:59] info:      z2m: Stopped zigbee-herdsman
zigbee2mqtt  | [2025-01-16 22:07:59] info:      z2m: Stopped Zigbee2MQTT
@Sjorsa Sjorsa added the problem Something isn't working label Jan 16, 2025
Sign up for free to join this conversation on GitHub. Already have an account? Sign in to comment
Labels
problem Something isn't working
Projects
None yet
Development

No branches or pull requests

1 participant