C8 migration problems

1 - ? Is different from * (Quesrion), Also the report show crons with 6 fields (including the ?) but as far as I know cron only defines 5. What is the 6th one?

2 - I will see what happens after midnight but 9pm off has already failed

OK, it's now 7:30am on 6/4
All 5 scheduled off's failed - guest rm bulb, LR bulb, DR bulb, kitchen torchier and led outlets.

Again, the on's all respond immediately so I simply can't blame comm or repeater issues. Besides, if it was a comm issue, the logs would show an off event when the device was still physiclly on. None of the 6 missed off events appear in the log suggesting that they were never triggered or processed.

The front door device even has seperate on and off apps; the on triggers, the off doesn't

Bottom line, the on's seem to work, most of the off's fail
I don't understand this one bit
It would an incredible lot of work to abandon hubitat in favor of something else - it would mean resetging 26 devices.

There must be some explanation for this problem and a way to fix it, bit I'll never figure it out without help.

Look at your events log and post the events around that time

dev:2332023-06-03 07:34:21.806 AMinfoLiving Room Sengled was turned off manual
dev:92023-06-03 07:34:06.337 AMinfoKitchen Torchiere was turned off [digital] manual
dev:92023-06-03 07:33:41.331 AMinfoupdated...
dev:92023-06-03 07:33:41.067 AMinfoupdated...
dev:1372023-06-03 07:33:05.635 AMinfoKitchen 4' LED Sengled was turned off [digital] manual
dev:1362023-06-03 07:31:56.071 AMinfoGuest Room Torchiere was turned off manual
dev:1362023-06-03 07:30:13.281 AMinfoupdated...
dev:722023-06-03 07:30:00.529 AMinfoKitchen Hot Water (Sengled) was turned on [digital]
app:622023-06-03 07:30:00.172 AMinfoTurn On Kitchen Hot Water (Sengled) at 7:30 AM Turn On
dev:2362023-06-03 05:57:48.069 AMinfoBedroom Floor Fan is off [physical]
dev:1682023-06-03 05:49:45.542 AMinfoBedroom Annex Fan is off [physical]
dev:122023-06-03 02:15:00.896 AMinfoDining Room Sengled was turned off manual
dev:212023-06-03 12:44:02.998 AMinfoSengled-North-3 was turned off
dev:202023-06-03 12:44:02.958 AMinfoSengled-North-2 was turned off
dev:42023-06-03 12:44:02.927 AMinfoSengled-North-1 was turned off
dev:192023-06-03 12:44:02.515 AMinfoPico-1 North button 5 was pushed
dev:72023-06-03 12:44:02.503 AMinforcvd: DEVICE,2,4,4
dev:72023-06-03 12:44:02.279 AMinforcvd: DEVICE,2,4,3
dev:212023-06-03 12:30:16.032 AMinfoSengled-North-3 level was set to 10%
dev:42023-06-03 12:30:15.992 AMinfoSengled-North-1 level was set to 10%
dev:202023-06-03 12:30:15.942 AMinfoSengled-North-2 level was set to 10%
dev:202023-06-03 12:30:11.040 AMinfoSengled-North-2 level was set to 64%
dev:42023-06-03 12:30:11.040 AMinfoSengled-North-1 level was set to 64%
dev:212023-06-03 12:30:11.040 AMinfoSengled-North-3 level was set to 64%
dev:192023-06-03 12:30:10.386 AMinfoPico-1 North button 3 was pushed
dev:72023-06-03 12:30:10.367 AMinforcvd: DEVICE,2,3,4
dev:72023-06-03 12:30:10.184 AMinforcvd: DEVICE,2,3,3
dev:722023-06-03 12:15:00.533 AMinfoKitchen Hot Water (Sengled) was turned off [digital]
app:622023-06-03 12:15:00.276 AMinfoTurn On Kitchen Hot Water (Sengled) at 7:30 AM anti-Turn On
dev:372023-06-03 12:01:00.501 AMinfoBedroom Lamp was turned off [digital]
app:852023-06-03 12:01:00.254 AMinfoTurn On Bedroom Lamp at sunset -40 anti-Turn On
dev:392023-06-03 11:38:47.440 PMinfoSengled-Center-2 is off
dev:232023-06-03 11:36:37.787 PMinfoSengled-Center-1 is off
dev:252023-06-03 11:35:52.683 PMinfoSengled-Center-3 is off
dev:252023-06-03 11:35:50.349 PMinfoSengled-Center-3 is off
dev:252023-06-03 11:35:48.745 PMinfoSengled-Center-3 is off
dev:252023-06-03 11:35:47.169 PMinfoSengled-Center-3 is off
dev:362023-06-03 09:38:58.323 PMinfoFront Door was turned off [digital] manual
dev:352023-06-03 09:38:58.288 PMinforcvd: OUTPUT,3,1,0.00
dev:272023-06-03 09:31:44.353 PMinfoSengled-South-2 was turned off
dev:282023-06-03 09:31:44.216 PMinfoSengled-South-1 was turned off
dev:262023-06-03 09:31:44.117 PMinfoSengled-South-3 was turned off
dev:302023-06-03 09:31:43.507 PMinfoPico 3 South button 5 was pushed
dev:72023-06-03 09:31:43.492 PMinforcvd: DEVICE,5,4,4
dev:72023-06-03 09:31:43.266 PMinforcvd: DEVICE,5,4,3
dev:1362023-06-03 08:17:05.852 PMinfoGuest Room Torchiere level was set to 60%
dev:1362023-06-03 08:17:02.449 PMinfoGuest Room Torchiere is on
dev:1362023-06-03 08:17:00.951 PMinfoGuest Room Torchiere level was set to 1%
dev:1362023-06-03 08:17:00.939 PMinfoGuest Room Torchiere was turned on
dev:362023-06-03 07:45:00.333 PMinfoFront Door was turned on [digital]
app:2182023-06-03 07:45:00.324 PMinfoapp: When Time of Day is 15 minutes before sunset …
app:2182023-06-03 07:45:00.314 PMinfoapp: Finished
dev:352023-06-03 07:45:00.295 PMinforcvd: OUTPUT,3,1,100.00
app:2182023-06-03 07:45:00.140 PMinfoact: Turn on Front Door
app:2182023-06-03 07:45:00.123 PMinfoevt: 15 minutes before sunset
dev:122023-06-03 07:35:00.647 PMinfoDining Room Sengled was turned on
dev:1372023-06-03 07:30:00.318 PMinfoKitchen 4' LED Sengled was turned on [digital]
dev:92023-06-03 07:25:00.200 PMinfoKitchen Torchiere was turned on [digital]
dev:2332023-06-03 07:22:00.533 PMinfoLiving Room Sengled was turned on
dev:372023-06-03 07:20:00.349 PMinfoBedroom Lamp was turned on [digital]
app:852023-06-03 07:20:00.133 PMinfoTurn On Bedroom Lamp at sunset -40 Turn On
dev:282023-06-03 07:13:53.148 PMinfoSengled-South-1 level was set to 20%
dev:272023-06-03 07:13:53.083 PMinfoSengled-South-2 level was set to 20%
dev:262023-06-03 07:13:53.031 PMinfoSengled-South-3 level was set to 20%
dev:212023-06-03 07:13:52.310 PMinfoSengled-North-3 level was set to 65%
dev:42023-06-03 07:13:52.276 PMinfoSengled-North-1 level was set to 65%
dev:202023-06-03 07:13:52.234 PMinfoSengled-North-2 level was set to 65%
dev:262023-06-03 07:13:49.575 PMinfoSengled-South-3 is on
dev:42023-06-03 07:13:48.849 PMinfoSengled-North-1 is on
dev:202023-06-03 07:13:48.773 PMinfoSengled-North-2 level was set to 1%
dev:282023-06-03 07:13:48.207 PMinfoSengled-South-1 level was set to 1%
dev:282023-06-03 07:13:48.202 PMinfoSengled-South-1 was turned on
dev:282023-06-03 07:13:48.201 PMinfoSengled-South-1 was turned on
dev:272023-06-03 07:13:48.046 PMinfoSengled-South-2 level was set to 1%
dev:272023-06-03 07:13:48.039 PMinfoSengled-South-2 was turned on
dev:272023-06-03 07:13:48.032 PMinfoSengled-South-2 was turned on
dev:262023-06-03 07:13:47.983 PMinfoSengled-South-3 level was set to 1%
dev:262023-06-03 07:13:47.981 PMinfoSengled-South-3 was turned on
dev:302023-06-03 07:13:47.862 PMinfoPico 3 South button 2 was pushed
dev:72023-06-03 07:13:47.850 PMinforcvd: DEVICE,5,5,4
dev:72023-06-03 07:13:47.619 PMinforcvd: DEVICE,5,5,3
dev:42023-06-03 07:13:47.354 PMinfoSengled-North-1 level was set to 1%
dev:42023-06-03 07:13:47.351 PMinfoSengled-North-1 was turned on
dev:212023-06-03 07:13:47.329 PMinfoSengled-North-3 level was set to 1%
dev:202023-06-03 07:13:47.302 PMinfoSengled-North-2 was turned on
dev:212023-06-03 07:13:47.296 PMinfoSengled-North-3 was turned on
dev:192023-06-03 07:13:46.708 PMinfoPico-1 North button 2 was pushed
dev:72023-06-03 07:13:46.692 PMinforcvd: DEVICE,2,5,4
dev:72023-06-03 07:13:46.473 PMinforcvd: DEVICE,2,5,3
dev:2322023-06-03 06:43:59.129 PMinfoRadiant Heater is off [digital]
dev:372023-06-03 06:39:04.502 PMinfoBedroom Lamp is off [physical]
app:232023-06-03 05:00:01.213 PMinfoChecking for updates for Hubitat Package Manager
app:232023-06-03 05:00:00.980 PMinfoChecking for updates for Hubitat Package Manager
app:232023-06-03 05:00:00.646 PMinfoChecking for updates for Dimmer Button Controller
dev:282023-06-03 04:39:46.709 PMinfoSengled-South-1 is off
dev:262023-06-03 04:39:05.508 PMinfoSengled-South-3 is off
dev:272023-06-03 04:38:50.125 PMinfoSengled-South-2 is off
app:2182023-06-03 04:28:16.614 PMinfoapp: When Time of Day is 15 minutes before sunset …
app:2182023-06-03 04:28:16.610 PMinfoapp: initialized
dev:362023-06-03 02:01:00.482 PMinfoFront Door is off [digital]
app:2192023-06-03 02:01:00.472 PMinfoapp: When Time of Day is 9:01 PM …
app:2192023-06-03 02:01:00.465 PMinfoapp: Finished
dev:352023-06-03 02:01:00.451 PMinforcvd: OUTPUT,3,1,0.00
app:2192023-06-03 02:01:00.318 PMinfoact: Turn off Front Door
app:2192023-06-03 02:01:00.305 PMinfoevt: certain time
dev:122023-06-03 11:58:55.787 AMinfoDining Room Sengled was turned off
dev:122023-06-03 11:58:55.543 AMinfoDining Room Sengled was turned on
dev:2362023-06-03 11:43:23.606 AMinfoBedroom Floor Fan is off [physical]
dev:1682023-06-03 11:37:19.950 AMinfoBedroom Annex Fan is off [physical]
dev:2332023-06-03 09:37:09.008 AMinfoLiving Room Sengled was turned off
dev:92023-06-03 09:36:49.042 AMinfoKitchen Torchiere was turned off [digital]
dev:1372023-06-03 09:33:38.193 AMinfoKitchen 4' LED Sengled was turned off [digital]
dev:1362023-06-03 09:33:09.967 AMinfoGuest Room Torchiere was turned off
dev:122023-06-03 09:32:26.640 AMinfoDining Room Sengled was turned off
dev:722023-06-03 07:30:01.020 AMinfoKitchen Hot Water (Sengled) was turned on [digital]
app:622023-06-03 07:30:00.617 AMinfoTurn On Kitchen Hot Water (Sengled) at 7:30 AM Turn On

No I mean the event log. Look up at the top of the logs page,

OK. I looked at it and couldn't that it helped but...

Now the devices that didn't go off at the time, look at a couple of them and click their event log (go to the device page, then click events and post a screen shot of the time it failed)

The 7:30 am events were all done by me, not the apps

2023-06-04_15h52_41


2023-06-04_15h56_26
2023-06-04_15h59_04

No, go to the device page, then click events at the top

Which app from the logs you shared above (I didn't check every schedule you shared, just the schedule for the app you've indicated it failed to run earlier)? Also, have you confirmed the schedule listed was correct? Lastly, could you please post the logs of the actions that a specific app has taken, and when it fired, as previously requested?

I'm sorry that I'm very confused. You asked for device logs so I gave you device logs from 4 devices that failed. Each device is controlled by a different app.

The entries in the device logs do not seem to differentiate between state changes that were caused by the app and those cause because I twiddled the UI.

I don't see any buttons on the app pages to generate logs so I really have no clue as to what you are asking me to do. When I go to logs under dev tools and use the filter by app dropdown, only 4 apps appear in the list and only one of those is an OFF app although 6 OFF haves fail routinely.

Here is that one. The log shows the OFF finished - only thing is the device didn't actually turn off even though when I poke it manually it responds instantly.

I certainly don't understand the timestamps on these log entries. Is it really trying to run the 9:01 pm app at 2:01 pm? What is this? Are these GMT even though my timezone is America/Los_Angeles and the detail screen says the time is correct?

I apologize for being so ignorant and confused - It basically worked great for a year until this migration and hasn't worked right since.

Yes, it fired at the wrong time, still. Can you please reboot the hub from Settings, that should resolve the problem.

OK but the forum app think OK is unclear

you can't just type "OK", the forum complains that its too short of a response.

4 Likes

I was asking you to go to the device page of a device that did t fire. At the top of that device page is a button that says events. Click that button and you will see all events that happened to that device. Focus in on when it didn't fire

I think I understand now. I will work on accumulating all that stuff.
This morning everything is on that should have been off.
I looked at the device events for a couple of devices and the entries there bear no relationshipto the entries in the log file. Things that the event list say happened don't have a log entry - and - there are a few log entries for things that (according to the app definition) should not have happened at all.

For example the radiant heater is supposed to fire at midnight, not 7am

Here are the events:






Please report new incidents after you had a chance to reboot the hub.

These are all new incidents. All of today's reports followed the recommended reboot at 5:00 pm yesterday

1 Like

We've been looking together at the app called "Turn On Kitchen Hot Water (Sengled) at 7:30AM" which according to the last screenshot you've shared, it has now fired at correct time. Did the device not turn on as directed by the app and confirmed by the logs at 7:30AM?

image

Can you turn on the logging in the app for the "When Time of Day is 12:01 AM, turn off Radiant Heater"? I see the device turned off, but there is no app that sent the command to it (or the app doesn't have the logging enabled).