Trouble getting status of Linear Linear WD500Z Dimmer

[gregor2004ua]

I am having issues with Linear WD500Z-1.
First:
When changing the level of this switch to 100% the status still shows the original value. Then when i change the value to lets say 50%, the status changes to 100%. And again, if I change the value again to lets say 0%, the status changes now to 50%. Looks like the switch reports the last value, instead of current. So, the switch is controlled properly and changes the light level, but the status reported is wrong.

Second thing I noticed:
When I go into the switch configuration in Z-way expert UI, it does not show any associations. For my other switch I see group 1 association and my RaZberry is in it. For this Linear switch though, I do not see any associations, so i cannot add RaZberry into group 1.

Has anyone else experienced anything similar? I am trying to figure out if this is a faulty switch or if Razberry does not support it at all.
What dimmer switches are you successfully using?

Any advice is greatly appreciated.

[pofs]

First - need to see the log to know what device is actually sending. Could be either a bug in device or a bug in UI.

Or it could be that device has SwitchMultilevel version >= 2, and factory-default dimming duration is rather long to not change value yet when Get request arrives after Set. Try issuing a Set command with zero duration specified:

Code: Select all

http://ip:8083/ZWaveAPI/Run/devices[x].SwitchMultilevel.Set(y,0)

(where x is device id and y is level from 0 to 100) and see if it updates correctly in UI.

Second - see if Association command class has passed the interview.

[gregor2004ua]

Here is the log of when I set the level to 50 and then to 99.
The exact commands I ran are:
http://192.168.1.9:8083/ZWaveAPI/Run/de ... .Set(50,0)
http://192.168.1.9:8083/ZWaveAPI/Run/de ... .Set(99,0)

Code: Select all

[2015-03-17 22:52:47.193] [I] [zway] Adding job: SwitchMultilevel Set
[2015-03-17 22:52:47.195] [I] [zway] Adding job: SwitchMultilevel Get
[2015-03-17 22:52:47.197] [D] [zway] SENDING (cb 0x4e): ( 01 0A 00 13 03 03 26 01 32 25 4E 98 )
[2015-03-17 22:52:47.200] [D] [zway] RECEIVED ACK
[2015-03-17 22:52:47.204] [D] [zway] RECEIVED: ( 01 04 01 13 01 E8 )
[2015-03-17 22:52:47.205] [D] [zway] SENT ACK
[2015-03-17 22:52:47.206] [D] [zway] Delivered to Z-Wave stack
[2015-03-17 22:52:47.220] [D] [zway] RECEIVED: ( 01 07 00 13 4E 00 00 02 A7 )
[2015-03-17 22:52:47.221] [D] [zway] SENT ACK
[2015-03-17 22:52:47.223] [I] [zway] Job 0x13 (SwitchMultilevel Set): Delivered
[2015-03-17 22:52:47.224] [D] [zway] SETDATA devices.3.data.lastPacketInfo.delivered = True
[2015-03-17 22:52:47.226] [D] [zway] SETDATA devices.3.data.lastPacketInfo.packetLength = 6 (0x00000006)
[2015-03-17 22:52:47.227] [D] [zway] SETDATA devices.3.data.lastPacketInfo.deliveryTime = 16 (0x00000010)
[2015-03-17 22:52:47.228] [D] [zway] SETDATA devices.3.data.lastPacketInfo = **********
[2015-03-17 22:52:47.231] [D] [zway] SendData Response with callback 0x4e received: received by recipient
[2015-03-17 22:52:47.232] [D] [zway] SETDATA devices.3.data.lastSend = 77313938 (0x049bb792)
[2015-03-17 22:52:47.234] [D] [zway] Job 0x13 (SwitchMultilevel Set): success
[2015-03-17 22:52:47.235] [I] [zway] Removing job: SwitchMultilevel Set
[2015-03-17 22:52:47.298] [D] [zway] SENDING (cb 0x4f): ( 01 09 00 13 03 02 26 02 25 4F AA )
[2015-03-17 22:52:47.301] [D] [zway] RECEIVED ACK
[2015-03-17 22:52:47.305] [D] [zway] RECEIVED: ( 01 04 01 13 01 E8 )
[2015-03-17 22:52:47.306] [D] [zway] SENT ACK
[2015-03-17 22:52:47.307] [D] [zway] Delivered to Z-Wave stack
[2015-03-17 22:52:47.321] [D] [zway] RECEIVED: ( 01 07 00 13 4F 00 00 02 A6 )
[2015-03-17 22:52:47.322] [D] [zway] SENT ACK
[2015-03-17 22:52:47.323] [I] [zway] Job 0x13 (SwitchMultilevel Get): Delivered
[2015-03-17 22:52:47.325] [D] [zway] SETDATA devices.3.data.lastPacketInfo.delivered = True
[2015-03-17 22:52:47.326] [D] [zway] SETDATA devices.3.data.lastPacketInfo.packetLength = 5 (0x00000005)
[2015-03-17 22:52:47.328] [D] [zway] SETDATA devices.3.data.lastPacketInfo.deliveryTime = 15 (0x0000000f)
[2015-03-17 22:52:47.329] [D] [zway] SETDATA devices.3.data.lastPacketInfo = **********
[2015-03-17 22:52:47.331] [D] [zway] SendData Response with callback 0x4f received: received by recipient
[2015-03-17 22:52:47.333] [D] [zway] SETDATA devices.3.data.lastSend = 77313946 (0x049bb79a)
[2015-03-17 22:52:47.334] [D] [zway] Job 0x13 (SwitchMultilevel Get): success
[2015-03-17 22:52:47.336] [I] [zway] Removing job: SwitchMultilevel Get
[2015-03-17 22:52:47.337] [D] [zway] RECEIVED: ( 01 09 00 04 00 03 03 26 03 60 B7 )
[2015-03-17 22:52:47.339] [D] [zway] SENT ACK
[2015-03-17 22:52:47.341] [D] [zway] SETDATA devices.3.data.lastReceived = 0 (0x00000000)
[2015-03-17 22:52:47.342] [D] [zway] SETDATA devices.3.instances.0.commandClasses.38.data.level = 96 (0x00000060)
[2015-03-17 22:52:52.562] [I] [zway] Adding job: SwitchMultilevel Set
[2015-03-17 22:52:52.563] [I] [zway] Adding job: SwitchMultilevel Get
[2015-03-17 22:52:52.567] [D] [zway] SENDING (cb 0x50): ( 01 0A 00 13 03 03 26 01 63 25 50 D7 )
[2015-03-17 22:52:52.570] [D] [zway] RECEIVED ACK
[2015-03-17 22:52:52.575] [D] [zway] RECEIVED: ( 01 04 01 13 01 E8 )
[2015-03-17 22:52:52.576] [D] [zway] SENT ACK
[2015-03-17 22:52:52.577] [D] [zway] Delivered to Z-Wave stack
[2015-03-17 22:52:52.591] [D] [zway] RECEIVED: ( 01 07 00 13 50 00 00 02 B9 )
[2015-03-17 22:52:52.592] [D] [zway] SENT ACK
[2015-03-17 22:52:52.593] [I] [zway] Job 0x13 (SwitchMultilevel Set): Delivered
[2015-03-17 22:52:52.594] [D] [zway] SETDATA devices.3.data.lastPacketInfo.delivered = True
[2015-03-17 22:52:52.596] [D] [zway] SETDATA devices.3.data.lastPacketInfo.packetLength = 6 (0x00000006)
[2015-03-17 22:52:52.598] [D] [zway] SETDATA devices.3.data.lastPacketInfo.deliveryTime = 15 (0x0000000f)
[2015-03-17 22:52:52.599] [D] [zway] SETDATA devices.3.data.lastPacketInfo = **********
[2015-03-17 22:52:52.602] [D] [zway] SendData Response with callback 0x50 received: received by recipient
[2015-03-17 22:52:52.604] [D] [zway] SETDATA devices.3.data.lastSend = 77314458 (0x049bb99a)
[2015-03-17 22:52:52.605] [D] [zway] Job 0x13 (SwitchMultilevel Set): success
[2015-03-17 22:52:52.606] [I] [zway] Removing job: SwitchMultilevel Set
[2015-03-17 22:52:52.670] [D] [zway] SENDING (cb 0x51): ( 01 09 00 13 03 02 26 02 25 51 B4 )
[2015-03-17 22:52:52.673] [D] [zway] RECEIVED ACK
[2015-03-17 22:52:52.677] [D] [zway] RECEIVED: ( 01 04 01 13 01 E8 )
[2015-03-17 22:52:52.678] [D] [zway] SENT ACK
[2015-03-17 22:52:52.680] [D] [zway] Delivered to Z-Wave stack
[2015-03-17 22:52:52.693] [D] [zway] RECEIVED: ( 01 07 00 13 51 00 00 02 B8 )
[2015-03-17 22:52:52.694] [D] [zway] SENT ACK
[2015-03-17 22:52:52.695] [I] [zway] Job 0x13 (SwitchMultilevel Get): Delivered
[2015-03-17 22:52:52.697] [D] [zway] SETDATA devices.3.data.lastPacketInfo.delivered = True
[2015-03-17 22:52:52.698] [D] [zway] SETDATA devices.3.data.lastPacketInfo.packetLength = 5 (0x00000005)
[2015-03-17 22:52:52.700] [D] [zway] SETDATA devices.3.data.lastPacketInfo.deliveryTime = 15 (0x0000000f)
[2015-03-17 22:52:52.702] [D] [zway] SETDATA devices.3.data.lastPacketInfo = **********
[2015-03-17 22:52:52.703] [D] [zway] SendData Response with callback 0x51 received: received by recipient
[2015-03-17 22:52:52.705] [D] [zway] SETDATA devices.3.data.lastSend = 77314466 (0x049bb9a2)
[2015-03-17 22:52:52.706] [D] [zway] Job 0x13 (SwitchMultilevel Get): success
[2015-03-17 22:52:52.707] [I] [zway] Removing job: SwitchMultilevel Get
[2015-03-17 22:52:52.711] [D] [zway] RECEIVED: ( 01 09 00 04 00 03 03 26 03 35 E2 )
[2015-03-17 22:52:52.712] [D] [zway] SENT ACK
[2015-03-17 22:52:52.713] [D] [zway] SETDATA devices.3.data.lastReceived = 0 (0x00000000)
[2015-03-17 22:52:52.715] [D] [zway] SETDATA devices.3.instances.0.commandClasses.38.data.level = 53 (0x00000035)
[2015-03-17 22:53:07.375] [D] [zway] Job 0x13: deleted from queue
[2015-03-17 22:53:07.469] [D] [zway] Job 0x13: deleted from queue
[2015-03-17 22:53:12.714] [D] [zway] Job 0x13: deleted from queue
[2015-03-17 22:53:12.800] [D] [zway] Job 0x13: deleted from queue

[gregor2004ua]

Or it could be that device has SwitchMultilevel version >= 2, and factory-default dimming duration is rather long to not change value yet when Get request arrives after Set. Try issuing a Set command with zero duration specified:

Here is the interview results:
Command Class
Basic, SwitchMultilevel, SwitchAll, SceneActivation, SceneActuatorConf, Configuration, ManufacturerSpecific, PowerLevel, Version,

When I click on SwitchMultilevel I see this:
/: None (07.03.2015)
supported: true (07.03.2015)
version: 1 (07.03.2015)
security: false (07.03.2015)
interviewDone: true (07.03.2015)
interviewCounter: 9 (07.03.2015)
level: 99 (22:50)
startChange: None (07.03.2015)
stopChange: None (07.03.2015)

I guess you are referring to the version above, which in this case is 1.

When I issue the Set command with 0 duration I still see the same behavior in the UI. The previous value is displayed as current.

[gregor2004ua]

First - need to see the log to know what device is actually sending. Could be either a bug in device or a bug in UI.

Or it could be that device has SwitchMultilevel version >= 2, and factory-default dimming duration is rather long to not change value yet when Get request arrives after Set. Try issuing a Set command with zero duration specified:

Code: Select all

http://ip:8083/ZWaveAPI/Run/devices[x].SwitchMultilevel.Set(y,0)

(where x is device id and y is level from 0 to 100) and see if it updates correctly in UI.

Second - see if Association command class has passed the interview.

Above I have tried to answer all of your questions. Thank you very much for your insight, hope you can help me resolve this mystery.

[gregor2004ua]

Ohh, and by the way, my notifications are getting flooded with this message:
Type: debug
Timestamp: 4/03/15-20:13
Message:
Status report requested

Do not know if its in any way related to the issue with the switch.

[pofs]

Looks like it really has some internal hard-coded delay despite of being v1, so when Get command arrives, it reports intermediate value (it is slightly different from the previous value, which suggests change is in progress).

Manual says device supports Association, but I don't see it in your commands list (and neither in xml file for this device). Can you please show NIF for the device? You may use the following command to see it:

Code: Select all

http://ip:8083/ZWaveAPI/Run/devices[x].data.nodeInfoFrame

If there's no Association (0x85/133) in NIF, you'll need to inject it, in order to maintain associations.

[gregor2004ua]

Looks like it really has some internal hard-coded delay despite of being v1, so when Get command arrives, it reports intermediate value (it is slightly different from the previous value, which suggests change is in progress).

Manual says device supports Association, but I don't see it in your commands list (and neither in xml file for this device). Can you please show NIF for the device? You may use the following command to see it:

Code: Select all

http://ip:8083/ZWaveAPI/Run/devices[x].data.nodeInfoFrame

If there's no Association (0x85/133) in NIF, you'll need to inject it, in order to maintain associations.

Here is the response:

Code: Select all

{
invalidateTime: 1425599936,
updateTime: 1426033111,
type: "binary",
value: [
38,
43,
44,
39,
115,
112,
134,
114
]
}

Seems like there is no association, how would I inject it?

Thank you very much for your help.

[pofs]

Try calling

Code: Select all

http://ip:8083/JS/Run/zway.devices[x].data.nodeInfoFrame=zway.devices[x].data.nodeInfoFrame.value.concat(0x85)

and then force re-interview of the device.

In case Association is just not in NIF, it will work. In case device doesn't support associations, it won't

[gregor2004ua]

Try calling

Code: Select all

http://ip:8083/JS/Run/zway.devices[x].data.nodeInfoFrame=zway.devices[x].data.nodeInfoFrame.value.concat(0x85)

and then force re-interview of the device.

In case Association is just not in NIF, it will work. In case device doesn't support associations, it won't

After running:

Code: Select all

http://ip:8083/JS/Run/zway.devices[x].data.nodeInfoFrame=zway.devices[x].data.nodeInfoFrame.value.concat(0x85)

The response was:

Code: Select all

&+,'sp†r…

Then by checking the command classes:
http://192.168.1.9:8083/JS/Run/zway.dev ... eInfoFrame
i got :

Code: Select all

{
invalidateTime: 1425599936,
updateTime: 1426721474,
type: "binary",
value: [
38,
43,
44,
39,
115,
112,
134,
114,
133
]
}

And after forcing interview:
Interview-Status
Device interview stage is not complete
+ .++ +++++++.

In Interview Results, I see the button to force interview for Association but it doesnt do anything.

Here are the logs of running interview for Association:
[2015-03-18 19:44:18.031] [D] [zway] Job 0x13: deleted from queue
[2015-03-18 19:46:33.419] [zway] Adding job: Association Groupings Get
[2015-03-18 19:46:33.429] [D] [zway] SENDING (cb 0x40): ( 01 09 00 13 03 02 85 05 25 40 01 )
[2015-03-18 19:46:33.432] [D] [zway] RECEIVED ACK
[2015-03-18 19:46:33.436] [D] [zway] RECEIVED: ( 01 04 01 13 01 E8 )
[2015-03-18 19:46:33.438] [D] [zway] SENT ACK
[2015-03-18 19:46:33.439] [D] [zway] Delivered to Z-Wave stack
[2015-03-18 19:46:33.452] [D] [zway] RECEIVED: ( 01 07 00 13 40 00 00 02 A9 )
[2015-03-18 19:46:33.453] [D] [zway] SENT ACK
[2015-03-18 19:46:33.455] [zway] Job 0x13 (Association Groupings Get): Delivered
[2015-03-18 19:46:33.456] [D] [zway] SETDATA devices.3.data.lastPacketInfo.delivered = True
[2015-03-18 19:46:33.458] [D] [zway] SETDATA devices.3.data.lastPacketInfo.packetLength = 5 (0x00000005)
[2015-03-18 19:46:33.459] [D] [zway] SETDATA devices.3.data.lastPacketInfo.deliveryTime = 16 (0x00000010)
[2015-03-18 19:46:33.461] [D] [zway] SETDATA devices.3.data.lastPacketInfo = **********
[2015-03-18 19:46:33.463] [D] [zway] SendData Response with callback 0x40 received: received by recipient
[2015-03-18 19:46:33.464] [D] [zway] SETDATA devices.3.data.lastSend = 172471 (0x0002a1b7)
[2015-03-18 19:46:33.465] [D] [zway] Job 0x13 (Association Groupings Get): success
[2015-03-18 19:46:33.467] [zway] Removing job: Association Groupings Get
[2015-03-18 19:46:53.557] [D] [zway] Job 0x13: deleted from queue


Can it be a faulty switch?

I really appreciate your help.