Kwikset lock not updating codes

[sandcrab]

Here are the debug logs.... i used attic-door-lock as the test one... I FIRST unlocked it via hubitat to PROVE the mesh is working and the device is reachable. It unlocked instantly.

then i tried to add a NEW code from the device panel. Code #9. It didnt add it to the lock sucessfully. here are the logs.

dev:1082019-05-10 03:18:17.113 pm info2nd-Fridge power is 141 watts

dev:702019-05-10 03:18:16.808 pm infoLiving-Plug power is 21 watts

dev:702019-05-10 03:17:56.801 pm infoLiving-Plug power is 20 watts

dev:3532019-05-10 03:17:43.997 pm infoAttic-Door-Lock battery is 100%

dev:3532019-05-10 03:17:43.995 pm debugBatteryReport: BatteryReport(batteryLevel:100)

dev:3532019-05-10 03:17:43.988 pm debugparse: zw device: 36, command: 9881, payload: 00 80 03 64 , isMulticast: false

dev:5172019-05-10 03:17:33.388 pm debugReliable Attic-Door-Lock.markAsLocked()

app:1382019-05-10 03:17:33.350 pm debugReliable Attic-Door-Lock:setting locked

app:1382019-05-10 03:17:33.346 pm debugAttic-Door-Lock:locked detected

dev:3532019-05-10 03:17:33.267 pm infoAttic-Door-Lock is locked

dev:3532019-05-10 03:17:33.264 pm debugDoorLockOperationReport: DoorLockOperationReport(doorCondition:0, doorLockMode:255, insideDoorHandlesMode:0, lockTimeoutMinutes:254, lockTimeoutSeconds:254, outsideDoorHandlesMode:0)

dev:3532019-05-10 03:17:33.248 pm debugparse: zw device: 36, command: 9881, payload: 00 62 03 FF 00 00 FE FE , isMulticast: false

app:1382019-05-10 03:17:31.107 pm debugAttic-Door-Lock:refreshing

dev:1082019-05-10 03:17:27.121 pm info2nd-Fridge power is 142 watts

dev:1082019-05-10 03:17:17.108 pm info2nd-Fridge power is 144 watts

dev:702019-05-10 03:17:16.787 pm infoLiving-Plug power is 21 watts

dev:682019-05-10 03:17:14.859 pm infoFront-Door-Sensor temperature is 73.85°F

dev:982019-05-10 03:16:58.026 pm infoBed3-Door battery is 65%

dev:702019-05-10 03:16:56.795 pm infoLiving-Plug power is 20 watts

dev:3532019-05-10 03:16:52.824 pm infolast code 30 fetched, fetch complete

dev:3532019-05-10 03:16:52.815 pm debugno changes to codeNumber:30, code:null, codeMap:[:]

dev:3532019-05-10 03:16:52.804 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:30, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:52.797 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 1E 00 , isMulticast: false

dev:3532019-05-10 03:16:51.945 pm debugfetchLockCode- 30

dev:3532019-05-10 03:16:51.943 pm tracetrying to fetch code:30

dev:3532019-05-10 03:16:51.940 pm infocode:29 fetched

dev:3532019-05-10 03:16:51.934 pm debugno changes to codeNumber:29, code:null, codeMap:[:]

dev:3532019-05-10 03:16:51.923 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:29, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:51.916 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 1D 00 , isMulticast: false

dev:3532019-05-10 03:16:51.203 pm debugfetchLockCode- 29

dev:3532019-05-10 03:16:51.200 pm tracetrying to fetch code:29

dev:3532019-05-10 03:16:51.197 pm infocode:28 fetched

dev:3532019-05-10 03:16:51.189 pm debugno changes to codeNumber:28, code:null, codeMap:[:]

dev:3532019-05-10 03:16:51.177 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:28, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:51.170 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 1C 00 , isMulticast: false

dev:3532019-05-10 03:16:50.477 pm debugfetchLockCode- 28

dev:3532019-05-10 03:16:50.475 pm tracetrying to fetch code:28

dev:3532019-05-10 03:16:50.472 pm infocode:27 fetched

dev:3532019-05-10 03:16:50.467 pm debugno changes to codeNumber:27, code:null, codeMap:[:]

dev:3532019-05-10 03:16:50.457 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:27, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:50.450 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 1B 00 , isMulticast: false

dev:3532019-05-10 03:16:49.708 pm debugfetchLockCode- 27

dev:3532019-05-10 03:16:49.705 pm tracetrying to fetch code:27

dev:3532019-05-10 03:16:49.703 pm infocode:26 fetched

dev:3532019-05-10 03:16:49.696 pm debugno changes to codeNumber:26, code:null, codeMap:[:]

dev:3532019-05-10 03:16:49.685 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:26, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:49.678 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 1A 00 , isMulticast: false

dev:3532019-05-10 03:16:48.873 pm debugfetchLockCode- 26

dev:3532019-05-10 03:16:48.870 pm tracetrying to fetch code:26

dev:3532019-05-10 03:16:48.867 pm infocode:25 fetched

dev:3532019-05-10 03:16:48.861 pm debugno changes to codeNumber:25, code:null, codeMap:[:]

dev:3532019-05-10 03:16:48.850 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:25, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:48.837 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 19 00 , isMulticast: false

dev:3532019-05-10 03:16:48.148 pm debugfetchLockCode- 25

dev:3532019-05-10 03:16:48.146 pm tracetrying to fetch code:25

dev:3532019-05-10 03:16:48.142 pm infocode:24 fetched

dev:3532019-05-10 03:16:48.129 pm debugno changes to codeNumber:24, code:null, codeMap:[:]

dev:3532019-05-10 03:16:48.118 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:24, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:48.106 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 18 00 , isMulticast: false

dev:3532019-05-10 03:16:47.385 pm debugfetchLockCode- 24

dev:3532019-05-10 03:16:47.382 pm tracetrying to fetch code:24

dev:3532019-05-10 03:16:47.379 pm infocode:23 fetched

dev:3532019-05-10 03:16:47.374 pm debugno changes to codeNumber:23, code:null, codeMap:[:]

dev:3532019-05-10 03:16:47.365 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:23, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:47.357 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 17 00 , isMulticast: false

dev:1082019-05-10 03:16:47.072 pm info2nd-Fridge power is 142 watts

dev:3532019-05-10 03:16:46.697 pm debugfetchLockCode- 23

dev:3532019-05-10 03:16:46.694 pm tracetrying to fetch code:23

dev:3532019-05-10 03:16:46.692 pm infocode:22 fetched

dev:3532019-05-10 03:16:46.685 pm debugno changes to codeNumber:22, code:null, codeMap:[:]

dev:3532019-05-10 03:16:46.675 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:22, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:46.668 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 16 00 , isMulticast: false

dev:3532019-05-10 03:16:45.866 pm debugfetchLockCode- 22

dev:3532019-05-10 03:16:45.863 pm tracetrying to fetch code:22

dev:3532019-05-10 03:16:45.860 pm infocode:21 fetched

dev:3532019-05-10 03:16:45.853 pm debugno changes to codeNumber:21, code:null, codeMap:[:]

dev:3532019-05-10 03:16:45.842 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:21, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:45.829 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 15 00 , isMulticast: false

dev:3532019-05-10 03:16:45.139 pm debugfetchLockCode- 21

dev:3532019-05-10 03:16:45.136 pm tracetrying to fetch code:21

dev:3532019-05-10 03:16:45.133 pm infocode:20 fetched

dev:3532019-05-10 03:16:45.128 pm debugno changes to codeNumber:20, code:null, codeMap:[:]

dev:3532019-05-10 03:16:45.117 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:20, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:45.104 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 14 00 , isMulticast: false

dev:3532019-05-10 03:16:44.357 pm debugfetchLockCode- 20

dev:3532019-05-10 03:16:44.354 pm tracetrying to fetch code:20

dev:3532019-05-10 03:16:44.351 pm infocode:19 fetched

dev:3532019-05-10 03:16:44.345 pm debugno changes to codeNumber:19, code:null, codeMap:[:]

dev:3532019-05-10 03:16:44.334 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:19, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:44.322 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 13 00 , isMulticast: false

dev:3532019-05-10 03:16:43.523 pm debugfetchLockCode- 19

dev:3532019-05-10 03:16:43.521 pm tracetrying to fetch code:19

dev:3532019-05-10 03:16:43.518 pm infocode:18 fetched

dev:3532019-05-10 03:16:43.513 pm debugno changes to codeNumber:18, code:null, codeMap:[:]

dev:3532019-05-10 03:16:43.502 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:18, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:43.491 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 12 00 , isMulticast: false

dev:3532019-05-10 03:16:42.798 pm debugfetchLockCode- 18

dev:3532019-05-10 03:16:42.795 pm tracetrying to fetch code:18

dev:3532019-05-10 03:16:42.792 pm infocode:17 fetched

dev:3532019-05-10 03:16:42.786 pm debugno changes to codeNumber:17, code:null, codeMap:[:]

dev:3532019-05-10 03:16:42.776 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:17, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:42.739 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 11 00 , isMulticast: false

dev:3532019-05-10 03:16:42.050 pm debugfetchLockCode- 17

dev:3532019-05-10 03:16:42.047 pm tracetrying to fetch code:17

dev:3532019-05-10 03:16:42.044 pm infocode:16 fetched

dev:3532019-05-10 03:16:42.039 pm debugno changes to codeNumber:16, code:null, codeMap:[:]

dev:3532019-05-10 03:16:42.030 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:16, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:42.004 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 10 00 , isMulticast: false

dev:3532019-05-10 03:16:41.241 pm debugfetchLockCode- 16

dev:3532019-05-10 03:16:41.239 pm tracetrying to fetch code:16

dev:3532019-05-10 03:16:41.236 pm infocode:15 fetched

dev:3532019-05-10 03:16:41.231 pm debugno changes to codeNumber:15, code:null, codeMap:[:]

dev:3532019-05-10 03:16:41.221 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:15, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:41.197 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 0F 00 , isMulticast: false

dev:3532019-05-10 03:16:40.532 pm debugfetchLockCode- 15

dev:3532019-05-10 03:16:40.529 pm tracetrying to fetch code:15

dev:3532019-05-10 03:16:40.526 pm infocode:14 fetched

dev:3532019-05-10 03:16:40.519 pm debugno changes to codeNumber:14, code:null, codeMap:[:]

dev:3532019-05-10 03:16:40.509 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:14, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:40.474 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 0E 00 , isMulticast: false

dev:3532019-05-10 03:16:39.779 pm debugfetchLockCode- 14

dev:3532019-05-10 03:16:39.776 pm tracetrying to fetch code:14

dev:3532019-05-10 03:16:39.773 pm infocode:13 fetched

dev:3532019-05-10 03:16:39.768 pm debugno changes to codeNumber:13, code:null, codeMap:[:]

dev:3532019-05-10 03:16:39.759 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:13, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:39.737 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 0D 00 , isMulticast: false

dev:3532019-05-10 03:16:39.076 pm debugfetchLockCode- 13

dev:3532019-05-10 03:16:39.073 pm tracetrying to fetch code:13

dev:3532019-05-10 03:16:39.070 pm infocode:12 fetched

dev:3532019-05-10 03:16:39.064 pm debugno changes to codeNumber:12, code:null, codeMap:[:]

dev:3532019-05-10 03:16:39.055 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:12, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:39.031 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 0C 00 , isMulticast: false

dev:3532019-05-10 03:16:38.334 pm debugfetchLockCode- 12

dev:3532019-05-10 03:16:38.330 pm tracetrying to fetch code:12

dev:3532019-05-10 03:16:38.327 pm infocode:11 fetched

dev:3532019-05-10 03:16:38.321 pm debugno changes to codeNumber:11, code:null, codeMap:[:]

dev:3532019-05-10 03:16:38.309 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:11, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:38.286 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 0B 00 , isMulticast: false

dev:3532019-05-10 03:16:37.561 pm debugfetchLockCode- 11

dev:3532019-05-10 03:16:37.559 pm tracetrying to fetch code:11

dev:3532019-05-10 03:16:37.550 pm debugno changes to codeNumber:9, code:null, codeMap:[:]

dev:3532019-05-10 03:16:37.533 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:9, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:37.479 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 09 00 , isMulticast: false

dev:1082019-05-10 03:16:37.141 pm info2nd-Fridge power is 141 watts

dev:692019-05-10 03:16:35.315 pm infoBed1-Door battery is 38%

dev:1312019-05-10 03:16:28.762 pm info2nd-Freezer adjusted temperature is 4.20°F [sensor value -5.80]

dev:5132019-05-10 03:16:28.160 pm infoOffice-Door-Sensor adjusted temperature is 71.15°F [sensor value 71.15]

dev:702019-05-10 03:16:16.759 pm infoLiving-Plug power is 21 watts

dev:702019-05-10 03:15:56.756 pm infoLiving-Plug power is 20 watts

dev:3532019-05-10 03:15:34.317 pm debugsetCode- 9

dev:992019-05-10 03:15:11.143 pm infoBed3-Plug power is 22 watts

dev:5172019-05-10 03:15:09.934 pm debugReliable Attic-Door-Lock.markAsUnlocked()

app:1382019-05-10 03:15:09.875 pm debugReliable Attic-Door-Lock:setting unlocked

app:1382019-05-10 03:15:09.871 pm debugAttic-Door-Lock:unlocked detected

dev:3532019-05-10 03:15:09.707 pm infoAttic-Door-Lock was unlocked via command [digital][25]

dev:3532019-05-10 03:15:09.704 pm debugalarmv2.AlarmReport: AlarmReport(alarmLevel:1, alarmType:25, eventParameter:[], numberOfEventParameters:0, zensorNetSourceNodeId:0, zwaveAlarmEvent:0, zwaveAlarmStatus:0, zwaveAlarmType:0)

dev:3532019-05-10 03:15:09.620 pm debugparse: zw device: 36, command: 9881, payload: 00 71 05 19 01 , isMulticast: false

[sandcrab]

Also, I have three hubitat hubs, all three in different states, with the same problem. I could see maybe 1 home is bad RF , but three with bad RF? Not likely. All of the kwikset locks have similar setups. All on exterior doors, All have a GE Zwave plus switch within 2-3 feet of the lock, and all locks respond instantly to lock/unlock commands so they seem to be reachable successful. All other zwave devices work just fine. These locks worked perfectly with Iris for 4 years and then Smart things for 3 months.

[mike.maxwell]

can you just highlight the lock in the logs and screenshot again?, that way I don't have to try and sort through all the other log output, thanks.

[sandcrab]

dev:3532019-05-10 03:17:43.997 pm infoAttic-Door-Lock battery is 100%

dev:3532019-05-10 03:17:43.995 pm debugBatteryReport: BatteryReport(batteryLevel:100)

dev:3532019-05-10 03:17:43.988 pm debugparse: zw device: 36, command: 9881, payload: 00 80 03 64 , isMulticast: false

dev:3532019-05-10 03:17:33.267 pm infoAttic-Door-Lock is locked

dev:3532019-05-10 03:17:33.264 pm debugDoorLockOperationReport: DoorLockOperationReport(doorCondition:0, doorLockMode:255, insideDoorHandlesMode:0, lockTimeoutMinutes:254, lockTimeoutSeconds:254, outsideDoorHandlesMode:0)

dev:3532019-05-10 03:17:33.248 pm debugparse: zw device: 36, command: 9881, payload: 00 62 03 FF 00 00 FE FE , isMulticast: false

dev:3532019-05-10 03:16:52.824 pm infolast code 30 fetched, fetch complete

dev:3532019-05-10 03:16:52.815 pm debugno changes to codeNumber:30, code:null, codeMap:[:]

dev:3532019-05-10 03:16:52.804 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:30, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:52.797 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 1E 00 , isMulticast: false

dev:3532019-05-10 03:16:51.945 pm debugfetchLockCode- 30

dev:3532019-05-10 03:16:51.943 pm tracetrying to fetch code:30

dev:3532019-05-10 03:16:51.940 pm infocode:29 fetched

dev:3532019-05-10 03:16:51.934 pm debugno changes to codeNumber:29, code:null, codeMap:[:]

dev:3532019-05-10 03:16:51.923 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:29, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:51.916 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 1D 00 , isMulticast: false

dev:3532019-05-10 03:16:51.203 pm debugfetchLockCode- 29

dev:3532019-05-10 03:16:51.200 pm tracetrying to fetch code:29

dev:3532019-05-10 03:16:51.197 pm infocode:28 fetched

dev:3532019-05-10 03:16:51.189 pm debugno changes to codeNumber:28, code:null, codeMap:[:]

dev:3532019-05-10 03:16:51.177 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:28, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:51.170 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 1C 00 , isMulticast: false

dev:3532019-05-10 03:16:50.477 pm debugfetchLockCode- 28

dev:3532019-05-10 03:16:50.475 pm tracetrying to fetch code:28

dev:3532019-05-10 03:16:50.472 pm infocode:27 fetched

dev:3532019-05-10 03:16:50.467 pm debugno changes to codeNumber:27, code:null, codeMap:[:]

dev:3532019-05-10 03:16:50.457 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:27, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:50.450 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 1B 00 , isMulticast: false

dev:3532019-05-10 03:16:49.708 pm debugfetchLockCode- 27

dev:3532019-05-10 03:16:49.705 pm tracetrying to fetch code:27

dev:3532019-05-10 03:16:49.703 pm infocode:26 fetched

dev:3532019-05-10 03:16:49.696 pm debugno changes to codeNumber:26, code:null, codeMap:[:]

dev:3532019-05-10 03:16:49.685 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:26, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:49.678 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 1A 00 , isMulticast: false

dev:3532019-05-10 03:16:48.873 pm debugfetchLockCode- 26

dev:3532019-05-10 03:16:48.870 pm tracetrying to fetch code:26

dev:3532019-05-10 03:16:48.867 pm infocode:25 fetched

dev:3532019-05-10 03:16:48.861 pm debugno changes to codeNumber:25, code:null, codeMap:[:]

dev:3532019-05-10 03:16:48.850 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:25, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:48.837 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 19 00 , isMulticast: false

dev:3532019-05-10 03:16:48.148 pm debugfetchLockCode- 25

dev:3532019-05-10 03:16:48.146 pm tracetrying to fetch code:25

dev:3532019-05-10 03:16:48.142 pm infocode:24 fetched

dev:3532019-05-10 03:16:48.129 pm debugno changes to codeNumber:24, code:null, codeMap:[:]

dev:3532019-05-10 03:16:48.118 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:24, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:48.106 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 18 00 , isMulticast: false

dev:3532019-05-10 03:16:47.385 pm debugfetchLockCode- 24

dev:3532019-05-10 03:16:47.382 pm tracetrying to fetch code:24

dev:3532019-05-10 03:16:47.379 pm infocode:23 fetched

dev:3532019-05-10 03:16:47.374 pm debugno changes to codeNumber:23, code:null, codeMap:[:]

dev:3532019-05-10 03:16:47.365 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:23, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:47.357 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 17 00 , isMulticast: false

dev:3532019-05-10 03:16:46.697 pm debugfetchLockCode- 23

dev:3532019-05-10 03:16:46.694 pm tracetrying to fetch code:23

dev:3532019-05-10 03:16:46.692 pm infocode:22 fetched

dev:3532019-05-10 03:16:46.685 pm debugno changes to codeNumber:22, code:null, codeMap:[:]

dev:3532019-05-10 03:16:46.675 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:22, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:46.668 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 16 00 , isMulticast: false

dev:3532019-05-10 03:16:45.866 pm debugfetchLockCode- 22

dev:3532019-05-10 03:16:45.863 pm tracetrying to fetch code:22

dev:3532019-05-10 03:16:45.860 pm infocode:21 fetched

dev:3532019-05-10 03:16:45.853 pm debugno changes to codeNumber:21, code:null, codeMap:[:]

dev:3532019-05-10 03:16:45.842 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:21, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:45.829 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 15 00 , isMulticast: false

dev:3532019-05-10 03:16:45.139 pm debugfetchLockCode- 21

dev:3532019-05-10 03:16:45.136 pm tracetrying to fetch code:21

dev:3532019-05-10 03:16:45.133 pm infocode:20 fetched

dev:3532019-05-10 03:16:45.128 pm debugno changes to codeNumber:20, code:null, codeMap:[:]

dev:3532019-05-10 03:16:45.117 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:20, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:45.104 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 14 00 , isMulticast: false

dev:3532019-05-10 03:16:44.357 pm debugfetchLockCode- 20

dev:3532019-05-10 03:16:44.354 pm tracetrying to fetch code:20

dev:3532019-05-10 03:16:44.351 pm infocode:19 fetched

dev:3532019-05-10 03:16:44.345 pm debugno changes to codeNumber:19, code:null, codeMap:[:]

dev:3532019-05-10 03:16:44.334 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:19, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:44.322 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 13 00 , isMulticast: false

dev:3532019-05-10 03:16:43.523 pm debugfetchLockCode- 19

dev:3532019-05-10 03:16:43.521 pm tracetrying to fetch code:19

dev:3532019-05-10 03:16:43.518 pm infocode:18 fetched

dev:3532019-05-10 03:16:43.513 pm debugno changes to codeNumber:18, code:null, codeMap:[:]

dev:3532019-05-10 03:16:43.502 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:18, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:43.491 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 12 00 , isMulticast: false

dev:3532019-05-10 03:16:42.798 pm debugfetchLockCode- 18

dev:3532019-05-10 03:16:42.795 pm tracetrying to fetch code:18

dev:3532019-05-10 03:16:42.792 pm infocode:17 fetched

dev:3532019-05-10 03:16:42.786 pm debugno changes to codeNumber:17, code:null, codeMap:[:]

dev:3532019-05-10 03:16:42.776 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:17, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:42.739 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 11 00 , isMulticast: false

dev:3532019-05-10 03:16:42.050 pm debugfetchLockCode- 17

dev:3532019-05-10 03:16:42.047 pm tracetrying to fetch code:17

dev:3532019-05-10 03:16:42.044 pm infocode:16 fetched

dev:3532019-05-10 03:16:42.039 pm debugno changes to codeNumber:16, code:null, codeMap:[:]

dev:3532019-05-10 03:16:42.030 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:16, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:42.004 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 10 00 , isMulticast: false

dev:3532019-05-10 03:16:41.241 pm debugfetchLockCode- 16

dev:3532019-05-10 03:16:41.239 pm tracetrying to fetch code:16

dev:3532019-05-10 03:16:41.236 pm infocode:15 fetched

dev:3532019-05-10 03:16:41.231 pm debugno changes to codeNumber:15, code:null, codeMap:[:]

dev:3532019-05-10 03:16:41.221 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:15, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:41.197 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 0F 00 , isMulticast: false

dev:3532019-05-10 03:16:40.532 pm debugfetchLockCode- 15

dev:3532019-05-10 03:16:40.529 pm tracetrying to fetch code:15

dev:3532019-05-10 03:16:40.526 pm infocode:14 fetched

dev:3532019-05-10 03:16:40.519 pm debugno changes to codeNumber:14, code:null, codeMap:[:]

dev:3532019-05-10 03:16:40.509 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:14, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:40.474 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 0E 00 , isMulticast: false

dev:3532019-05-10 03:16:39.779 pm debugfetchLockCode- 14

dev:3532019-05-10 03:16:39.776 pm tracetrying to fetch code:14

dev:3532019-05-10 03:16:39.773 pm infocode:13 fetched

dev:3532019-05-10 03:16:39.768 pm debugno changes to codeNumber:13, code:null, codeMap:[:]

dev:3532019-05-10 03:16:39.759 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:13, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:39.737 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 0D 00 , isMulticast: false

dev:3532019-05-10 03:16:39.076 pm debugfetchLockCode- 13

dev:3532019-05-10 03:16:39.073 pm tracetrying to fetch code:13

dev:3532019-05-10 03:16:39.070 pm infocode:12 fetched

dev:3532019-05-10 03:16:39.064 pm debugno changes to codeNumber:12, code:null, codeMap:[:]

dev:3532019-05-10 03:16:39.055 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:12, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:39.031 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 0C 00 , isMulticast: false

dev:3532019-05-10 03:16:38.334 pm debugfetchLockCode- 12

dev:3532019-05-10 03:16:38.330 pm tracetrying to fetch code:12

dev:3532019-05-10 03:16:38.327 pm infocode:11 fetched

dev:3532019-05-10 03:16:38.321 pm debugno changes to codeNumber:11, code:null, codeMap:[:]

dev:3532019-05-10 03:16:38.309 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:11, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:38.286 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 0B 00 , isMulticast: false

dev:3532019-05-10 03:16:37.561 pm debugfetchLockCode- 11

dev:3532019-05-10 03:16:37.559 pm tracetrying to fetch code:11

dev:3532019-05-10 03:16:37.550 pm debugno changes to codeNumber:9, code:null, codeMap:[:]

dev:3532019-05-10 03:16:37.533 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:9, userIdStatus:0, userCode:null)

dev:3532019-05-10 03:16:37.479 pm debugparse: zw device: 36, command: 9881, payload: 00 63 03 09 00 , isMulticast: false

dev:3532019-05-10 03:15:34.317 pm debugsetCode- 9

dev:3532019-05-10 03:15:09.707 pm infoAttic-Door-Lock was unlocked via command [digital][25]

dev:3532019-05-10 03:15:09.704 pm debugalarmv2.AlarmReport: AlarmReport(alarmLevel:1, alarmType:25, eventParameter:[], numberOfEventParameters:0, zensorNetSourceNodeId:0, zwaveAlarmEvent:0, zwaveAlarmStatus:0, zwaveAlarmType:0)

dev:3532019-05-10 03:15:09.620 pm debugparse: zw device: 36, command: 9881, payload: 00 71 05 19 01 , isMulticast: false

[mike.maxwell]

are you clicking Get Codes in the driver?
also tell me exactly what you typed into each field of the set code command.

[sandcrab]

I have sent you the logs several times, so here is VIDEO of me following your instructions. This is not the user, me, not following your instructions. this is your software bugs.

[sandcrab]

https://drive.google.com/open?id=139267gBXXNVxHofqo5JQmIxJOIuz0hNP

[sandcrab]

dev:4812019-05-13 12:20:44.035 pm debugno changes to codeNumber:23, code:, codeMap:[:]

dev:4812019-05-13 12:20:44.024 pm debugUserCodeReport- cmd: UserCodeReport(userIdentifier:23, userIdStatus:255, userCode:)

dev:4812019-05-13 12:20:43.961 pm debugparse: zw device: 3B, command: 9881, payload: 00 63 03 17 FF , isMulticast: false

dev:4812019-05-13 12:20:40.660 pm debugsetCode- 23

[mike.maxwell]

The lock is receiving the command and responding with a status of FF (255), this response value is not defined in the Z-Wave specification for this command class, what exactly do you suggest we do with this response?
Currently we're ignoring it, since the lock didn't accept the code you entered, and yet it accepted many others...
I personally own 3 910 locks, two of which are in production, one is in development, none of them have ever generated a status of FF when sent a lock code...

[sandcrab]

These are 912 locks and not 910, that should not make a difference hopefully. In regards to the Z-wave specifications of these locks, i am not an expert so i would not have a clue what code FF means or what dataset that needs to be processed. All i know as a user, this isnt working. It isnt working at three of my houses with the same model locks. It works sometimes but other times it isnt working.

Any help with updating your device driver code to fully support these common kwikset locks would be great. I dont have access to the resources you do to work on the source code of the zwave drivers nor i have access to api documentation libraries to understand the needed changes. All i know is this isnt working with hubitat but worked great with smartthings and flawlessly with iris. cant you "borrow" some knowledge from their implementation?

[CurtisZM]

sandcrab

I have a 914 lock and the LCM app does not work. I cannot add or remove from LCM. It fails out. I removed all the codes (from device screen), factory reset with still the same outcome using LCM.

I can add or delete the codes from the device screen with no issues.

[mike.maxwell]

If you are able to add any codes at all, then the issue doesn't reside with the driver, software doesn't work like that.
I don't have any idea what FF means either, and since I don't we treat it as a failure to update the code.
If you wish to loan me the lock, I can look at what it's doing, at the least I'll be able to see if its an issue with the lock or not.
Other than that, there's nothing that I can do here.

[mike.maxwell]

Have you read the LCM tutorial?
https://docs.hubitat.com/index.php?title=Lock_Code_Manager

[sandcrab]

I have 10 of these locks and i keep 3 spares. If you contact me via PM or email, i will be glad to ship you one of my spare locks for you to lab out and see if you can generate a similar problem. I am appreciative we are working towards a solution.

[CurtisZM]

Yes.

My Issue:
Kwikset 910/912 Lock = List of supported devices. My 914 & 916 are not on the supported devices on Hubitat.

Sorry I missed that. Thanks Mike.

[mike.maxwell]

They should still work, but not being on the list just means we haven't actually tested it.

[sandcrab]

I have an additional question, all of my locks have zwave modules, but i see kwikset also have a zigbee module. Is that supported under the LCM and Hubitat? I am asking because i love hubitat other then this one really really really annoying problem, and if i need to swap the zwave module for zigbee i might be willing to make that investment if it is supported fully same as the zwave module is supported fully.

[cuboy29]

yes.. see this thread

Kiwkset Lock - Zwave to Zigbee Conversion

MORE info please! Which model lock was it? I have two Kwikset 910's and a Kwikset 912. All 3 locks are 3-5 years old so are not zwave plus. I've heard they can be switched over but have never seen a module for one. Link to the module you purchased? Thanks

[SmartHomePrimer]

You might try a dedicated extender first. It's a less expensive option and from this thread you can see that a lot of users are finally heeding @bobbyD 's advice, and have been pleasantly surprised at the results.