Beta [Real-time scheduling] schedule without rebooting

Status
Not open for further replies.
Black Hole said:
I don't think trying to schedule a recording too near or after it has started is a supportable proposition. I know it does work sometimes, but I see no way to guarantee it. Caveat emptor.

In my experience one can trigger a recording into starting by changing channel to the target.
Click to expand...
It has always worked for me until the above occasion. Usually if the guide start time has passed, the recording starts immediately (may be a 20 second lag), that is why I was surprised that it looked for an AR signal and then did not start recording. I appreciate that RTS a beta so it may not work 100% of the time.
 
I'm sure it is a matter of pure chance. The Humax software is not specced to cope with a new item in the schedule database like that, if you try it with the SUI you will find it refuses to add an EPG entry to the schedule if the start time has passed. That means the situation never arises that there is a new entry in the schedule that should already have triggered, and there was no need for the designers to ensure that it behaves in a consistent way. The RTS system is breaking that security, so the effect will be undefined. Consider it unreliable, and fortunate there are no worse effects (eg a crash).

To be reliable, AF would have to mimic the Humax SUI and refuse to schedule an entry after the starting gun.
 
I had a runaway recording this morning. The first since beta.

af123 do you need any of the logs?


Sent from my iPad using Tapatalk
 
4ndy said:
I had a runaway recording this morning. The first since beta.
Click to expand...
Drat, I really hoped that was fixed.
As before, the output of the rts.logs diagnostic is most useful but may be too late now.

Was there anything unusual about the way the recording was scheduled? (bit of a vague question I know).
Had you scheduled or unscheduled anything recently using RTS?
 
To be perfectly honest, I can't recall the circumstances with 100% certainty. I think it was the second daily episode of Frasier on Monday 6th 10:00 ish?. The first recorded OK. I would have been at work at that time, but I probably set some recordings via RS before breakfast, which may have synced on the first recording.

I can see where I stopped it at 19:12.

Also, the Yves Saint Laurent recording in the log at 00:12:22 failed for some reason. may be connected.

Let me know if I can supply any more info.

[RR] Sun Feb 5 22:01:17 2017: Recording end 47.
05/02/2017 22:01:23 - Recorded: The Good Karma Hospital/New: The Good Karma Hospital (61 minutes - ITV HD)
[RR] Sun Feb 5 22:59:22 2017: REC icon on.
[RR] Sun Feb 5 22:59:22 2017: Ring going red.
[RR] Sun Feb 5 22:59:22 2017: Ring going red.
[RR] Sun Feb 5 22:59:22 2017: Recording 1
06/02/2017 00:12:21 - Scheduled Yves Saint Laurent @ 1486418400
Mon Feb 6 00:12:31 2017: rsvsync starting.
Mon Feb 6 00:12:31 2017: Nugget is available.
Mon Feb 6 00:12:31 2017: Real-time mode.
[nugget]: Mon Feb 6 00:12:31 2017: schedule save starting.
[nugget]: Mon Feb 6 00:12:32 2017: schedule.stash 48 = 2
[nugget]: Mon Feb 6 00:12:32 2017: Deferred thread starting for '78:+3' (attempt 1)
Mon Feb 6 00:12:32 2017: Slots: +3
[nugget]: Mon Feb 6 00:12:32 2017: NULL database handle.
[nugget]: Mon Feb 6 00:12:32 2017: schedule save complete.
[nugget]: Mon Feb 6 00:12:32 2017: Schedule failed to reload, deferring.
Mon Feb 6 00:12:32 2017: Loading schedule information to HumaxTV binary.
Mon Feb 6 00:12:32 2017: Opening /var/lib/humaxtv/rsvp.db
[nugget]: Mon Feb 6 00:12:32 2017: Re-loading schedule database (78).
[nugget]: Mon Feb 6 00:12:32 2017: Closing database.
Mon Feb 6 00:12:32 2017: Final schedule entries: 78
Mon Feb 6 00:12:32 2017: Moving pending entry 0 to spare slot 3
[nugget]: Mon Feb 6 00:12:32 2017: Schedule load failed.
Mon Feb 6 00:12:32 2017: Schedule saved.
[nugget]: Mon Feb 6 00:12:35 2017: Deferred thread exiting.
[nugget]: Mon Feb 6 00:12:35 2017: Yves Saint Laurent
[nugget]: Mon Feb 6 00:12:35 2017: CRID: 1/[FP.BBC.CO.UK/4J5EZB]
[nugget]: Mon Feb 6 00:12:35 2017: Re-loading schedule database (78).
[nugget]: Mon Feb 6 00:12:35 2017: Recorded:
[nugget]: Mon Feb 6 00:12:35 2017: slots(78, +3)
[nugget]: Mon Feb 6 00:12:35 2017: Processing slot +3 (3)
[nugget]: Mon Feb 6 00:12:35 2017: Wake 1486417500 - Mon Feb 6 21:45:00 2017
[nugget]: Mon Feb 6 00:12:35 2017: @ 1486418400 (Mon Feb 6 22:00:00 2017)
[nugget]: Mon Feb 6 00:12:35 2017: - Mon Feb 6 21:44:30 2017
[nugget]: Mon Feb 6 00:12:35 2017: schedule.restore 48 = 2
[nugget]: Mon Feb 6 00:12:35 2017: Last Event: 0
[nugget]: Mon Feb 6 00:12:35 2017: Ready 1486417470 - Mon Feb 6 21:44:30 2017
[nugget]: Mon Feb 6 00:12:35 2017: [0] 1048876,1486418400,1486424400,53370
[nugget]: Mon Feb 6 00:12:35 2017: Adding timer(1486417470)
[nugget]: Mon Feb 6 00:12:35 2017: Mon Feb 6 22:00:00 2017 +100m
[nugget]: Mon Feb 6 00:12:35 2017: Events: 1FP.BBC.CO.UK/4J5EZB|
[nugget]: Mon Feb 6 00:12:35 2017: schedule reload complete (78).
06/02/2017 00:32:07 - Scheduled All Good Things @ 1486944900
06/02/2017 00:32:18 - Scheduled Wish You Were Here @ 1486947900
06/02/2017 00:32:27 - Scheduled Black Mountain Poets @ 1486944300
06/02/2017 00:32:35 - Scheduled Horns @ 1487019600
06/02/2017 00:32:49 - Scheduled Elementary @ 1487023200
06/02/2017 00:32:58 - Scheduled Yanks @ 1486999200
Mon Feb 6 00:33:02 2017: Opening /var/lib/humaxtv/rsvp.db
Mon Feb 6 00:33:02 2017: Moving pending entry 2 to spare slot 72
Mon Feb 6 00:33:02 2017: Real-time mode.
Mon Feb 6 00:33:02 2017: Moving pending entry 1 to spare slot 71
[nugget]: Mon Feb 6 00:33:02 2017: schedule save starting.
[nugget]: Mon Feb 6 00:33:02 2017: schedule save complete.
Mon Feb 6 00:33:02 2017: Schedule saved.
Mon Feb 6 00:33:02 2017: Moving pending entry 4 to spare slot 82
Mon Feb 6 00:33:02 2017: Moving pending entry 0 to spare slot 63
Mon Feb 6 00:33:02 2017: Nugget is available.
Mon Feb 6 00:33:02 2017: Moving pending entry 5 to spare slot 83
Mon Feb 6 00:33:02 2017: rsvsync starting.
Mon Feb 6 00:33:02 2017: Moving pending entry 3 to spare slot 81
[nugget]: Mon Feb 6 00:33:04 2017: Closing database.
Mon Feb 6 00:33:04 2017: Final schedule entries: 84
[nugget]: Mon Feb 6 00:33:04 2017: NULL database handle.
Mon Feb 6 00:33:04 2017: Loading schedule information to HumaxTV binary.
[nugget]: Mon Feb 6 00:33:04 2017: Deferred thread starting for '84:+63,+71,+72,+81,+82,+83' (attempt 1)
[nugget]: Mon Feb 6 00:33:04 2017: Schedule load failed.
[nugget]: Mon Feb 6 00:33:04 2017: Schedule failed to reload, deferring.
[nugget]: Mon Feb 6 00:33:04 2017: schedule.stash 48 = 2
Mon Feb 6 00:33:04 2017: Slots: +63,+71,+72,+81,+82,+83
[nugget]: Mon Feb 6 00:33:04 2017: Re-loading schedule database (84).
[nugget]: Mon Feb 6 00:33:07 2017: slots(84, +63,+71,+72,+81,+82,+83)
[nugget]: Mon Feb 6 00:33:07 2017: @ 1486944300 (Mon Feb 13 00:05:00 2017)
[nugget]: Mon Feb 6 00:33:07 2017: Horns
[nugget]: Mon Feb 6 00:33:07 2017: Recorded:
[nugget]: Mon Feb 6 00:33:07 2017: @ 1487019600 (Mon Feb 13 21:00:00 2017)
[nugget]: Mon Feb 6 00:33:07 2017: @ 1486947900 (Mon Feb 13 01:05:00 2017)
[nugget]: Mon Feb 6 00:33:07 2017: - Sun Feb 12 23:59:30 2017
[nugget]: Mon Feb 6 00:33:07 2017: CRID: 1/[WWW.CHANNEL4.COM/61499/001]
[nugget]: Mon Feb 6 00:33:07 2017: All Good Things
[nugget]: Mon Feb 6 00:33:07 2017: Events: 1FP.BBC.CO.UK/4J639D|
[nugget]: Mon Feb 6 00:33:07 2017: Processing slot +82 (82)
[nugget]: Mon Feb 6 00:33:07 2017: Recorded:
[nugget]: Mon Feb 6 00:33:07 2017: Last Event: 0
[nugget]: Mon Feb 6 00:33:07 2017: CRID: 1/[WWW.CHANNEL4.COM/62884/001]
[nugget]: Mon Feb 6 00:33:07 2017: Recorded:
[nugget]: Mon Feb 6 00:33:07 2017: - Mon Feb 13 00:49:30 2017
[nugget]: Mon Feb 6 00:33:07 2017: Black Mountain Poets
[nugget]: Mon Feb 6 00:33:07 2017: [0] 786626,1486944300,1486950900,5004
[nugget]: Mon Feb 6 00:33:07 2017: Mon Feb 13 00:05:00 2017 +110m
[nugget]: Mon Feb 6 00:33:07 2017: Mon Feb 13 00:15:00 2017 +95m
[nugget]: Mon Feb 6 00:33:07 2017: Events: 1WWW.CHANNEL4.COM/62884/001|
[nugget]: Mon Feb 6 00:33:07 2017: Ready 1486943970 - Sun Feb 12 23:59:30 2017
[nugget]: Mon Feb 6 00:33:07 2017: - Mon Feb 13 20:44:30 2017
[nugget]: Mon Feb 6 00:33:07 2017: Processing slot +72 (72)
[nugget]: Mon Feb 6 00:33:07 2017: schedule.restore 48 = 2
[nugget]: Mon Feb 6 00:33:07 2017: Deferred thread exiting.
[nugget]: Mon Feb 6 00:33:07 2017: Processing slot +63 (63)
[nugget]: Mon Feb 6 00:33:07 2017: CRID: 2/[WWW.SKY.COM/G_SKYB1547147]
[nugget]: Mon Feb 6 00:33:07 2017: CRID: 1/[FP.BBC.CO.UK/4J639D]
[nugget]: Mon Feb 6 00:33:07 2017: Last Event: 0
[nugget]: Mon Feb 6 00:33:07 2017: Events: 1WWW.CHANNEL4.COM/61499/001|
[nugget]: Mon Feb 6 00:33:07 2017: Last Event: 0
[nugget]: Mon Feb 6 00:33:07 2017: [0] 786621,1486944900,1486950600,41259
[nugget]: Mon Feb 6 00:33:07 2017: Ready 1487018670 - Mon Feb 13 20:44:30 2017
[nugget]: Mon Feb 6 00:33:07 2017: Wake 1486944000 - Mon Feb 13 00:00:00 2017
[nugget]: Mon Feb 6 00:33:07 2017: Adding timer(1487018670)
[nugget]: Mon Feb 6 00:33:07 2017: Processing slot +81 (81)
[nugget]: Mon Feb 6 00:33:07 2017: Adding timer(1486946970)
[nugget]: Mon Feb 6 00:33:07 2017: Elementary
[nugget]: Mon Feb 6 00:33:07 2017: @ 1487023200 (Mon Feb 13 22:00:00 2017)
[nugget]: Mon Feb 6 00:33:07 2017: [0] 983317,1487023200,1487026800,10969
[nugget]: Mon Feb 6 00:33:07 2017: Recorded:
[nugget]: Mon Feb 6 00:33:07 2017: Last Event: 0
[nugget]: Mon Feb 6 00:33:07 2017: Events: 1WWW.SKY.COM/G_S33115895|
[nugget]: Mon Feb 6 00:33:07 2017: Adding timer(1487022270)
[nugget]: Mon Feb 6 00:33:07 2017: Mon Feb 13 21:00:00 2017 +140m
[nugget]: Mon Feb 6 00:33:07 2017: Wake 1487018700 - Mon Feb 13 20:45:00 2017
[nugget]: Mon Feb 6 00:33:07 2017: Wake 1486947000 - Mon Feb 13 00:50:00 2017
[nugget]: Mon Feb 6 00:33:07 2017: @ 1486999200 (Mon Feb 13 15:20:00 2017)
[nugget]: Mon Feb 6 00:33:07 2017: Re-loading schedule database (84).
[nugget]: Mon Feb 6 00:33:07 2017: schedule reload complete (84).
[nugget]: Mon Feb 6 00:33:07 2017: Yanks
[nugget]: Mon Feb 6 00:33:07 2017: Recorded:
[nugget]: Mon Feb 6 00:33:07 2017: Last Event: 0
[nugget]: Mon Feb 6 00:33:07 2017: CRID: 1/[WWW.MOVIEMIX.CO.UK/E813435]
[nugget]: Mon Feb 6 00:33:07 2017: @ 1486944900 (Mon Feb 13 00:15:00 2017)
[nugget]: Mon Feb 6 00:33:07 2017: Wake 1487022300 - Mon Feb 13 21:45:00 2017
[nugget]: Mon Feb 6 00:33:07 2017: Wake 1486998300 - Mon Feb 13 15:05:00 2017
[nugget]: Mon Feb 6 00:33:07 2017: Events: 1WWW.MOVIEMIX.CO.UK/E813435|
[nugget]: Mon Feb 6 00:33:07 2017: [0] 1114444,1486947900,1486954500,5006
[nugget]: Mon Feb 6 00:33:07 2017: - Mon Feb 13 15:04:30 2017
[nugget]: Mon Feb 6 00:33:07 2017: Adding timer(1486943970)
[nugget]: Mon Feb 6 00:33:07 2017: Mon Feb 13 01:05:00 2017 +110m
[nugget]: Mon Feb 6 00:33:07 2017: - Mon Feb 13 21:44:30 2017
[nugget]: Mon Feb 6 00:33:07 2017: Wish You Were Here
[nugget]: Mon Feb 6 00:33:07 2017: Recorded:
[nugget]: Mon Feb 6 00:33:07 2017: CRID: 1/[WWW.CHANNEL4.COM/5470/001]
[nugget]: Mon Feb 6 00:33:07 2017: Processing slot +71 (71)
[nugget]: Mon Feb 6 00:33:07 2017: Adding timer(1486943370)
[nugget]: Mon Feb 6 00:33:07 2017: Ready 1486946970 - Mon Feb 13 00:49:30 2017
[nugget]: Mon Feb 6 00:33:07 2017: Ready 1486943370 - Sun Feb 12 23:49:30 2017
[nugget]: Mon Feb 6 00:33:07 2017: [0] 1114444,1487019600,1487028000,5037
[nugget]: Mon Feb 6 00:33:07 2017: Last Event: 10428
[nugget]: Mon Feb 6 00:33:07 2017: Ready 1487022270 - Mon Feb 13 21:44:30 2017
[nugget]: Mon Feb 6 00:33:07 2017: Processing slot +83 (83)
[nugget]: Mon Feb 6 00:33:07 2017: Mon Feb 13 15:20:00 2017 +165m
[nugget]: Mon Feb 6 00:33:07 2017: Wake 1486943400 - Sun Feb 12 23:50:00 2017
[nugget]: Mon Feb 6 00:33:07 2017: Mon Feb 13 22:00:00 2017 +60m
[nugget]: Mon Feb 6 00:33:07 2017: - Sun Feb 12 23:49:30 2017
[nugget]: Mon Feb 6 00:33:07 2017: Events: 1WWW.CHANNEL4.COM/5470/001|
[nugget]: Mon Feb 6 00:33:07 2017: Ready 1486998270 - Mon Feb 13 15:04:30 2017
[nugget]: Mon Feb 6 00:33:07 2017: [0] 983327,1486999200,1487009100,701
[nugget]: Mon Feb 6 00:33:07 2017: Adding timer(1486998270)
[RR] Mon Feb 6 01:09:48 2017: REC icon off.
[RR] Mon Feb 6 01:09:48 2017: Recording end 47.
06/02/2017 01:09:55 - Recorded: /Magic Mike (130 minutes - Channel 4 HD)
[RR] Mon Feb 6 03:37:07 2017: Recording 1
[RR] Mon Feb 6 03:37:07 2017: REC icon on.
[RR] Mon Feb 6 03:37:07 2017: Ring going red.
[RR] Mon Feb 6 03:37:07 2017: Recording 1
[RR] Mon Feb 6 03:59:11 2017: Recording end 44.
[RR] Mon Feb 6 03:59:11 2017: REC icon off.
06/02/2017 03:59:17 - Recorded: Ridiculousness/Ridiculousness (22 minutes - 5STAR)
06/02/2017 07:20:21 - Scheduled Black Mountain Poets @ 1486944300
Mon Feb 6 07:20:24 2017: Real-time mode.
Mon Feb 6 07:20:24 2017: Nugget is available.
[nugget]: Mon Feb 6 07:20:24 2017: schedule save starting.
Mon Feb 6 07:20:24 2017: rsvsync starting.
[nugget]: Mon Feb 6 07:20:25 2017: schedule save complete.
Mon Feb 6 07:20:25 2017: Delete slot 72
Mon Feb 6 07:20:25 2017: Schedule saved.
Mon Feb 6 07:20:25 2017: Found slot 72 for 3/786626/1486944300/5004
Mon Feb 6 07:20:25 2017: Opening /var/lib/humaxtv/rsvp.db
Mon Feb 6 07:20:26 2017: Slots: -72
Mon Feb 6 07:20:26 2017: Final schedule entries: 81
[nugget]: Mon Feb 6 07:20:26 2017: slots(81, -72)
[nugget]: Mon Feb 6 07:20:26 2017: Processing slot -72 (72)
[nugget]: Mon Feb 6 07:20:26 2017: schedule reload complete (81).
Mon Feb 6 07:20:26 2017: Loading schedule information to HumaxTV binary.
[nugget]: Mon Feb 6 07:20:26 2017: Re-loading schedule database (81).
[nugget]: Mon Feb 6 07:20:26 2017: Closing database.
[nugget]: Mon Feb 6 07:20:26 2017: Removing timer for slot 72
[RR] Mon Feb 6 07:59:24 2017: Recording 1
[RR] Mon Feb 6 07:59:24 2017: Ring going red.
[RR] Mon Feb 6 07:59:24 2017: REC icon on.
[RR] Mon Feb 6 07:59:24 2017: Recording 1
[RR] Mon Feb 6 09:00:01 2017: Recording end 45.
[RR] Mon Feb 6 09:00:01 2017: REC icon off.
06/02/2017 09:00:07 - Recorded: Boon/Boon (60 minutes - Drama)
[RR] Mon Feb 6 09:31:41 2017: REC icon on.
[RR] Mon Feb 6 09:31:41 2017: Ring going red.
[RR] Mon Feb 6 09:31:41 2017: Recording start 45:'/mnt/hd2/My Video/Frasier/Frasier_20170206_0931.nts'
[RR] Mon Feb 6 09:31:41 2017: Recording 1
[RR] Mon Feb 6 10:02:15 2017: REC icon off.
[RR] Mon Feb 6 10:02:16 2017: Recording end 45.
[RR] Mon Feb 6 10:02:21 2017: Ring going red.
[RR] Mon Feb 6 10:02:21 2017: Recording 1
[RR] Mon Feb 6 10:02:21 2017: Recording start 47:'/mnt/hd2/My Video/Frasier/Frasier_20170206_1002.nts'
[RR] Mon Feb 6 10:02:21 2017: REC icon on.
06/02/2017 10:02:21 - Recorded: Frasier/Frasier (30 minutes - Channel 4)
06/02/2017 10:11:09 - Scheduled Auf Wiedersehen, Pet @ 1486994400
06/02/2017 10:11:21 - Scheduled Reel History of Britain @ 1486409400
Mon Feb 6 10:11:24 2017: Real-time mode.
[nugget]: Mon Feb 6 10:11:24 2017: schedule save starting.
Mon Feb 6 10:11:24 2017: Nugget is available.
Mon Feb 6 10:11:24 2017: rsvsync starting.
Mon Feb 6 10:11:25 2017: Opening /var/lib/humaxtv/rsvp.db
[nugget]: Mon Feb 6 10:11:25 2017: Schedule failed to reload, deferring.
Mon Feb 6 10:11:25 2017: Moving pending entry 1 to spare slot 49
Mon Feb 6 10:11:25 2017: Loading schedule information to HumaxTV binary.
Mon Feb 6 10:11:25 2017: Moving pending entry 0 to spare slot 48
Mon Feb 6 10:11:25 2017: Final schedule entries: 83
[nugget]: Mon Feb 6 10:11:25 2017: Re-loading schedule database (83).
[nugget]: Mon Feb 6 10:11:25 2017: schedule.stash 39 = 2
[nugget]: Mon Feb 6 10:11:25 2017: Schedule load failed.
Mon Feb 6 10:11:25 2017: Slots: +48,+49
Mon Feb 6 10:11:25 2017: Schedule saved.
[nugget]: Mon Feb 6 10:11:25 2017: schedule save complete.
[nugget]: Mon Feb 6 10:11:25 2017: Deferred thread starting for '83:+48,+49' (attempt 1)
[nugget]: Mon Feb 6 10:11:25 2017: Closing database.
[nugget]: Mon Feb 6 10:11:25 2017: NULL database handle.
[nugget]: Mon Feb 6 10:11:28 2017: Adding timer(1486993470)
[nugget]: Mon Feb 6 10:11:28 2017: Ready 1486993470 - Mon Feb 13 13:44:30 2017
[nugget]: Mon Feb 6 10:11:28 2017: @ 1486409400 (Mon Feb 6 19:30:00 2017)
[nugget]: Mon Feb 6 10:11:28 2017: [1] 655528,1486582200,1486584000,53361
[nugget]: Mon Feb 6 10:11:28 2017: schedule.restore 39 = 2
[nugget]: Mon Feb 6 10:11:28 2017: Auf Wiedersehen, Pet
[nugget]: Mon Feb 6 10:11:28 2017: Wake 1486993500 - Mon Feb 13 13:45:00 2017
[nugget]: Mon Feb 6 10:11:28 2017: schedule reload complete (83).
[nugget]: Mon Feb 6 10:11:28 2017: CRID: 2/[BDS.TV/OCFC0Q]
[nugget]: Mon Feb 6 10:11:28 2017: Wed Feb 8 19:30:00 2017 +30m
[nugget]: Mon Feb 6 10:11:28 2017: Mon Feb 13 14:00:00 2017 +60m
[nugget]: Mon Feb 6 10:11:28 2017: Last Event: 0
[nugget]: Mon Feb 6 10:11:28 2017: Mon Feb 13 19:30:00 2017 +30m
[nugget]: Mon Feb 6 10:11:28 2017: Reel History of Britain
[nugget]: Mon Feb 6 10:11:28 2017: Ready 1486408470 - Mon Feb 6 19:14:30 2017
[nugget]: Mon Feb 6 10:11:28 2017: - Mon Feb 13 13:44:30 2017
[nugget]: Mon Feb 6 10:11:28 2017: Deferred thread exiting.
[nugget]: Mon Feb 6 10:11:28 2017: @ 1486994400 (Mon Feb 13 14:00:00 2017)
[nugget]: Mon Feb 6 10:11:28 2017: Recorded:
[nugget]: Mon Feb 6 10:11:28 2017: - Mon Feb 6 19:14:30 2017
[nugget]: Mon Feb 6 10:11:28 2017: Mon Feb 6 19:30:00 2017 +30m
[nugget]: Mon Feb 6 10:11:28 2017: [0] 655528,1486409400,1486411200,52767
[nugget]: Mon Feb 6 10:11:28 2017: Events: 1BDS.TV/A6GIO4|
[nugget]: Mon Feb 6 10:11:28 2017: [0] 852165,1486994400,1486998000,27213
[nugget]: Mon Feb 6 10:11:28 2017: [2] 655528,1487014200,1487016000,53550
[nugget]: Mon Feb 6 10:11:28 2017: slots(83, +48,+49)
[nugget]: Mon Feb 6 10:11:28 2017: Processing slot +49 (49)
[nugget]: Mon Feb 6 10:11:28 2017: Wake 1486408500 - Mon Feb 6 19:15:00 2017
[nugget]: Mon Feb 6 10:11:28 2017: Adding timer(1486408470)
[nugget]: Mon Feb 6 10:11:28 2017: Recorded:
[nugget]: Mon Feb 6 10:11:28 2017: Last Event: 0
[nugget]: Mon Feb 6 10:11:28 2017: Re-loading schedule database (83).
[nugget]: Mon Feb 6 10:11:28 2017: Processing slot +48 (48)
[nugget]: Mon Feb 6 10:11:28 2017: CRID: 2/[FP.BBC.CO.UK/VWNQMQ]
[nugget]: Mon Feb 6 10:11:28 2017: Events: 1FP.BBC.CO.UK/23V4K8|1FP.BBC.CO.UK/23V4K9|1FP.BBC.CO.UK/23V4KA|
06/02/2017 19:10:13 - Scheduled The Fake News Show @ 1486411200
[nugget]: Mon Feb 6 19:10:17 2017: schedule save starting.
Mon Feb 6 19:10:17 2017: rsvsync starting.
Mon Feb 6 19:10:17 2017: Real-time mode.
Mon Feb 6 19:10:17 2017: Nugget is available.
Mon Feb 6 19:10:18 2017: Final schedule entries: 84
[nugget]: Mon Feb 6 19:10:18 2017: NULL database handle.
[nugget]: Mon Feb 6 19:10:18 2017: Deferred thread starting for '84:+72' (attempt 1)
Mon Feb 6 19:10:18 2017: Slots: +72
[nugget]: Mon Feb 6 19:10:18 2017: schedule save complete.
[nugget]: Mon Feb 6 19:10:18 2017: Closing database.
[nugget]: Mon Feb 6 19:10:18 2017: Schedule load failed.
Mon Feb 6 19:10:18 2017: Moving pending entry 0 to spare slot 72
[nugget]: Mon Feb 6 19:10:18 2017: Schedule failed to reload, deferring.
Mon Feb 6 19:10:18 2017: Loading schedule information to HumaxTV binary.
Mon Feb 6 19:10:18 2017: Opening /var/lib/humaxtv/rsvp.db
Mon Feb 6 19:10:18 2017: Schedule saved.
[nugget]: Mon Feb 6 19:10:18 2017: Re-loading schedule database (84).
[nugget]: Mon Feb 6 19:10:21 2017: Deferred thread exiting.
[nugget]: Mon Feb 6 19:10:21 2017: slots(84, +72)
[nugget]: Mon Feb 6 19:10:21 2017: Wake 1486410300 - Mon Feb 6 19:45:00 2017
[nugget]: Mon Feb 6 19:10:21 2017: Last Event: 0
[nugget]: Mon Feb 6 19:10:21 2017: CRID: 1/[WWW.CHANNEL4.COM/66100/001]
[nugget]: Mon Feb 6 19:10:21 2017: Recorded:
[nugget]: Mon Feb 6 19:10:21 2017: schedule reload complete (84).
[nugget]: Mon Feb 6 19:10:21 2017: Processing slot +72 (72)
[nugget]: Mon Feb 6 19:10:21 2017: Re-loading schedule database (84).
[nugget]: Mon Feb 6 19:10:21 2017: - Mon Feb 6 19:44:30 2017
[nugget]: Mon Feb 6 19:10:21 2017: The Fake News Show
[nugget]: Mon Feb 6 19:10:21 2017: Events: 1WWW.CHANNEL4.COM/66100/001|
[nugget]: Mon Feb 6 19:10:21 2017: Mon Feb 6 20:00:00 2017 +30m
[nugget]: Mon Feb 6 19:10:21 2017: [0] 786622,1486411200,1486413000,5577
[nugget]: Mon Feb 6 19:10:21 2017: @ 1486411200 (Mon Feb 6 20:00:00 2017)
[nugget]: Mon Feb 6 19:10:21 2017: Ready 1486410270 - Mon Feb 6 19:44:30 2017
[nugget]: Mon Feb 6 19:10:21 2017: Adding timer(1486410270)
[RR] Mon Feb 6 20:11:55 2017: No-match, trying '20170206_2010'.
[RR] Mon Feb 6 20:11:55 2017: No-match, trying '20170206_2012'.
[RR] Mon Feb 6 20:12:48 2017: Recording end 47.
[RR] Mon Feb 6 20:12:48 2017: REC icon off.
06/02/2017 20:12:56 - Recorded: Frasier/Frasier (610 minutes - Channel 4)
[RR] Mon Feb 6 21:00:20 2017: Recording 1
[RR] Mon Feb 6 21:00:20 2017: REC icon on.
[RR] Mon Feb 6 21:00:20 2017: Recording start [RR] Mon Feb 6 21:00:20 2017: Recording start 49:'/mnt/hd2/My Video/The Halcyon/New_ The Halcyon_20170206_2100.nts'
[RR] Mon Feb 6 21:00:21 2017: Recording 2
[RR] Mon Feb 6 21:00:21 2017: Recording start 51:'/mnt/hd2/My Video/Apple Tree Yard/Apple Tree Yard_20170206_2100.nts'
[RR] Mon Feb 6 21:00:21 2017: Changing to purple.
[RR] Mon Feb 6 21:59:18 2017: Changing to red.
[RR] Mon Feb 6 21:59:18 2017: Recording end 49.
[RR] Mon Feb 6 21:59:20 2017: Recording end 51.
[RR] Mon Feb 6 21:59:20 2017: REC icon off.
06/02/2017 21:59:24 - Recorded: The Halcyon/New: The Halcyon (58 minutes - ITV HD)
06/02/2017 21:59:26 - Recorded: Apple Tree Yard/Apple Tree Yard (58 minutes - BBC ONE HD)
[RR] Mon Feb 6 22:00:43 2017: REC icon on.
[RR] Mon Feb 6 22:00:43 2017: Ring going red.
[RR] Mon Feb 6 22:00:43 2017: Recording 1
[RR] Mon Feb 6 22:00:43 2017: Recording start 51:'/mnt/hd2/My Video/Yves Saint Laurent_20170206_2200.nts'
[RR] Mon Feb 6 23:39:55 2017: Recording end 51.
[RR] Mon Feb 6 23:39:55 2017: REC icon off.
06/02/2017 23:40:01 - Recorded: /Yves Saint Laurent (99 minutes - BBC FOUR)
07/02/2017 00:10:34 - Scheduled Prime Suspect @ 1487026800
[nugget]: Tue Feb 7 00:10:36 2017: NULL database handle.
Tue Feb 7 00:10:36 2017: Final schedule entries: 83
[nugget]: Tue Feb 7 00:10:36 2017: Deferred thread starting for '83:+3' (atte
Click to expand...
 
Another runaway recording this evening, I attempted to schedule a series recording of the The Code at around 18:10 whilst Eggheads was recording.
The recording for Eggheads is still recording 3 hours later!

Notes:
  1. I had The Code scheduled last week but for some bizarre reason this weeks episodes have a different series CRID FP.BBC.CO.UK/NTADT1 instead of the usual [URL='http://humax/cgi-bin/epg/search.jim?scrid=/OEH0E5'] FP.BBC.CO.UK/OEH0E5 [/URL]
  2. Newk is involved removing the 'The' from the folder name

Code: 
Mon Apr 10 10:18:03 2017: Slots:
Mon Apr 10 10:18:03 2017: Restoring any favourites.
Mon Apr 10 10:18:03 2017: rsvsync starting.
Mon Apr 10 10:18:03 2017: Final schedule entries: 38
Mon Apr 10 10:18:03 2017: Opening /var/lib/humaxtv/rsvp.db
Mon Apr 10 10:18:03 2017: Ignoring: no such table: fav (no such table: fav)
10/04/2017 10:18:36 - System booted (Remote control handset).
[RR] Mon Apr 10 14:09:24 2017: Ring going red.
[RR] Mon Apr 10 14:09:24 2017: Persistent log starting, v2.20
[RR] Mon Apr 10 14:09:24 2017: Recording start 32:'/mnt/hd2/My Video/Countdown/Countdown_20170410_1409.nts'
[RR] Mon Apr 10 14:09:24 2017: REC icon on.
[RR] Mon Apr 10 14:09:24 2017:    Recording 1
[RR] Mon Apr 10 14:59:14 2017: REC icon off.
[RR] Mon Apr 10 14:59:14 2017: Recording end 32.
[RR] Mon Apr 10 14:59:17 2017:    Recording 1
[RR] Mon Apr 10 14:59:17 2017: Recording start 46:'/mnt/hd2/My Video/Fifteen to One/Fifteen to One_20170410_1459.nts'
[RR] Mon Apr 10 14:59:17 2017: Ring going red.
[RR] Mon Apr 10 14:59:17 2017: REC icon on.
10/04/2017 14:59:21 - Recorded: Countdown/Countdown (49 minutes - Channel 4)
[RR] Mon Apr 10 15:59:16 2017: REC icon off.
[RR] Mon Apr 10 15:59:17 2017: Recording end 46.
10/04/2017 15:59:23 - Recorded: Fifteen to One/Fifteen to One (59 minutes - Channel 4)
[RR] Mon Apr 10 17:14:17 2017:    Recording 1
[RR] Mon Apr 10 17:14:17 2017: Ring going red.
[RR] Mon Apr 10 17:14:17 2017: Recording start 34:'/mnt/hd2/My Video/Pointless/Pointless_20170410_1714.nts'
[RR] Mon Apr 10 17:14:17 2017: REC icon on.
[RR] Mon Apr 10 17:58:56 2017:    Recording 2
[RR] Mon Apr 10 17:58:56 2017:    Changing to purple.
[RR] Mon Apr 10 17:58:56 2017: Recording start 45:'/mnt/hd2/My Video/Eggheads/Eggheads_20170410_1758.nts'
[RR] Mon Apr 10 17:59:58 2017:    Changing to red.
[RR] Mon Apr 10 17:59:58 2017: Recording end 34.
10/04/2017 18:00:05 - Recorded: Pointless/Pointless (45 minutes - BBC ONE South)
10/04/2017 18:10:46 - Scheduled The Code @ 1491916500
[nugget]: Mon Apr 10 18:10:48 2017: Deferred thread starting for '39:+28' (attempt 1)
Mon Apr 10 18:10:48 2017: Final schedule entries: 39
[nugget]: Mon Apr 10 18:10:48 2017: Schedule failed to reload, deferring.
Mon Apr 10 18:10:48 2017: Moving pending entry 0 to spare slot 28
Mon Apr 10 18:10:48 2017: Slots: +28
Mon Apr 10 18:10:48 2017: Opening /var/lib/humaxtv/rsvp.db
[nugget]: Mon Apr 10 18:10:48 2017: Schedule load failed.
Mon Apr 10 18:10:48 2017: Nugget is available.
Mon Apr 10 18:10:48 2017: Schedule saved.
[nugget]: Mon Apr 10 18:10:48 2017: Closing database.
[nugget]: Mon Apr 10 18:10:48 2017: Re-loading schedule database (39).
[nugget]: Mon Apr 10 18:10:48 2017: NULL database handle.
Mon Apr 10 18:10:48 2017: Real-time mode.
Mon Apr 10 18:10:48 2017: Loading schedule information to HumaxTV binary.
[nugget]: Mon Apr 10 18:10:48 2017: Persistent log starting, v0.97
[nugget]: Mon Apr 10 18:10:48 2017: schedule save starting.
[nugget]: Mon Apr 10 18:10:48 2017: schedule save complete.
[nugget]: Mon Apr 10 18:10:48 2017: schedule.stash 31 = 2
Mon Apr 10 18:10:48 2017: rsvsync starting.
[nugget]: Mon Apr 10 18:10:49 2017: schedule.save - wait(1).
10/04/2017 18:10:49 - newk: removing The  from The Code
10/04/2017 18:10:49 - Scheduled The Code @ 1491916500
Mon Apr 10 18:10:49 2017: Nugget is available.
Mon Apr 10 18:10:49 2017: rsvsync starting.
Mon Apr 10 18:10:49 2017: Real-time mode.
[nugget]: Mon Apr 10 18:10:50 2017: schedule.save - wait(1).
[nugget]: Mon Apr 10 18:10:51 2017: schedule.save - wait(1).
[nugget]: Mon Apr 10 18:10:51 2017: Re-loading schedule database (39).
[nugget]: Mon Apr 10 18:10:52 2017:   Events: 1FP.BBC.CO.UK/1RKK27|1FP.BBC.CO.UK/1RKK28|1FP.BBC.CO.UK/1RKK29|1FP.BBC.CO.UK/1RKK2A|
[nugget]: Mon Apr 10 18:10:52 2017:  [0] 131100,1491916500,1491919200,55995
[nugget]: Mon Apr 10 18:10:52 2017:   Last Event: 55966
[nugget]: Mon Apr 10 18:10:52 2017:     - Tue Apr 11 13:59:30 2017
[nugget]: Mon Apr 10 18:10:52 2017: Deferred thread exiting.
[nugget]: Mon Apr 10 18:10:52 2017:   Recorded:
[nugget]: Mon Apr 10 18:10:52 2017: schedule save complete.
[nugget]: Mon Apr 10 18:10:52 2017:   The Code
[nugget]: Mon Apr 10 18:10:52 2017:    @ 1491916500 (Tue Apr 11 14:15:00 2017)
[nugget]: Mon Apr 10 18:10:52 2017: schedule save starting.
[nugget]: Mon Apr 10 18:10:52 2017: Ready 1491915570 - Tue Apr 11 13:59:30 2017
[nugget]: Mon Apr 10 18:10:52 2017: Adding timer(1491915570)
[nugget]: Mon Apr 10 18:10:52 2017:       Tue Apr 11 14:15:00 2017 +45m
[nugget]: Mon Apr 10 18:10:52 2017:   CRID: 2/[FP.BBC.CO.UK/NTADT1]
[nugget]: Mon Apr 10 18:10:52 2017: schedule reload complete (39).
[nugget]: Mon Apr 10 18:10:52 2017: schedule.restore 31 = 2
[nugget]: Mon Apr 10 18:10:52 2017: slots(39, +28)
[nugget]: Mon Apr 10 18:10:52 2017: Processing slot +28 (28)
Mon Apr 10 18:10:52 2017: Schedule saved.
Mon Apr 10 18:10:52 2017: Opening /var/lib/humaxtv/rsvp.db
[nugget]: Mon Apr 10 18:10:52 2017:  [2] 131100,1492089300,1492092000,56049
[nugget]: Mon Apr 10 18:10:52 2017:       Thu Apr 13 14:15:00 2017 +45m
[nugget]: Mon Apr 10 18:10:52 2017:  [1] 131100,1492002900,1492005600,56023
[nugget]: Mon Apr 10 18:10:52 2017:       Wed Apr 12 14:15:00 2017 +45m
[nugget]: Mon Apr 10 18:10:52 2017:  Wake 1491915600 - Tue Apr 11 14:00:00 2017
[nugget]: Mon Apr 10 18:10:52 2017:  [3] 131100,1492174500,1492177200,56077
[nugget]: Mon Apr 10 18:10:52 2017:       Fri Apr 14 13:55:00 2017 +45m
[nugget]: Mon Apr 10 18:10:53 2017: Ready 1491915570 - Tue Apr 11 13:59:30 2017
[nugget]: Mon Apr 10 18:10:53 2017:  Wake 1491915600 - Tue Apr 11 14:00:00 2017
Mon Apr 10 18:10:53 2017: Folder reservation 28 = Code
[nugget]: Mon Apr 10 18:10:53 2017: Adding timer(1491915570)
[nugget]: Mon Apr 10 18:10:53 2017:     - Tue Apr 11 13:59:30 2017
Mon Apr 10 18:10:53 2017: Found slot 28 for 3/131100/1491916500/55995
[nugget]: Mon Apr 10 18:10:53 2017: Re-loading schedule database (39).
Mon Apr 10 18:10:53 2017: Slots: 28
Mon Apr 10 18:10:53 2017: Final schedule entries: 39
Mon Apr 10 18:10:53 2017: Loading schedule information to HumaxTV binary.
[nugget]: Mon Apr 10 18:10:53 2017:   The Code
[nugget]: Mon Apr 10 18:10:53 2017:    @ 1491916500 (Tue Apr 11 14:15:00 2017)
[nugget]: Mon Apr 10 18:10:53 2017: Good EPG data, retaining.
[nugget]: Mon Apr 10 18:10:53 2017: schedule.stash 31 = 2
[nugget]: Mon Apr 10 18:10:53 2017: Closing database.
[nugget]: Mon Apr 10 18:10:53 2017: schedule reload complete (39).
[nugget]: Mon Apr 10 18:10:53 2017: schedule.restore 31 = 2
[nugget]: Mon Apr 10 18:10:53 2017: slots(39, 28)
[nugget]: Mon Apr 10 18:10:53 2017: Processing slot 28 (28)
[RR] Mon Apr 10 18:28:26 2017: Recording start 47:'/mnt/hd2/My Video/BBC News/South Today_20170410_1828.nts'
[RR] Mon Apr 10 18:28:26 2017:    Recording 2
[RR] Mon Apr 10 18:28:26 2017:    Changing to purple.
[RR] Mon Apr 10 18:59:26 2017:    Changing to red.
[RR] Mon Apr 10 18:59:26 2017: Recording end 47.
10/04/2017 18:59:33 - Recorded: BBC News/South Today (31 minutes - BBC ONE South)
[RR] Mon Apr 10 20:34:20 2017: Play icon on.
[RR] Mon Apr 10 20:34:27 2017: Opened time data file '/tmp/.offset'



>>> Ending diagnostic rts.logs
 
Interesting, could you please post just the bit of nugget.log from around 18:10? I think the order of lines is slightly jumbled by the diagnostic.
 
Code: 
1332    [nugget]: Mon Apr 10 18:10:53 2017:     - Tue Apr 11 13:59:30 2017
1331    [nugget]: Mon Apr 10 18:10:53 2017: Adding timer(1491915570)
1330    [nugget]: Mon Apr 10 18:10:53 2017: Ready 1491915570 - Tue Apr 11 13:59:30 2017
1329    [nugget]: Mon Apr 10 18:10:53 2017:  Wake 1491915600 - Tue Apr 11 14:00:00 2017
1328    [nugget]: Mon Apr 10 18:10:53 2017: Good EPG data, retaining.
1327    [nugget]: Mon Apr 10 18:10:53 2017:    @ 1491916500 (Tue Apr 11 14:15:00 2017)
1326    [nugget]: Mon Apr 10 18:10:53 2017:   The Code
1325    [nugget]: Mon Apr 10 18:10:53 2017: Processing slot 28 (28)
1324    [nugget]: Mon Apr 10 18:10:53 2017: slots(39, 28)
1323    [nugget]: Mon Apr 10 18:10:53 2017: schedule.restore 31 = 2
1322    [nugget]: Mon Apr 10 18:10:53 2017: schedule reload complete (39).
1321    [nugget]: Mon Apr 10 18:10:53 2017: Closing database.
1320    [nugget]: Mon Apr 10 18:10:53 2017: schedule.stash 31 = 2
1319    [nugget]: Mon Apr 10 18:10:53 2017: Re-loading schedule database (39).
1318    [nugget]: Mon Apr 10 18:10:52 2017: schedule save complete.
1317    [nugget]: Mon Apr 10 18:10:52 2017: schedule save starting.
1316    [nugget]: Mon Apr 10 18:10:52 2017: Deferred thread exiting.
1315    [nugget]: Mon Apr 10 18:10:52 2017:     - Tue Apr 11 13:59:30 2017
1314    [nugget]: Mon Apr 10 18:10:52 2017: Adding timer(1491915570)
1313    [nugget]: Mon Apr 10 18:10:52 2017: Ready 1491915570 - Tue Apr 11 13:59:30 2017
1312    [nugget]: Mon Apr 10 18:10:52 2017:  Wake 1491915600 - Tue Apr 11 14:00:00 2017
1311    [nugget]: Mon Apr 10 18:10:52 2017:       Fri Apr 14 13:55:00 2017 +45m
1310    [nugget]: Mon Apr 10 18:10:52 2017:  [3] 131100,1492174500,1492177200,56077
1309    [nugget]: Mon Apr 10 18:10:52 2017:       Thu Apr 13 14:15:00 2017 +45m
1308    [nugget]: Mon Apr 10 18:10:52 2017:  [2] 131100,1492089300,1492092000,56049
1307    [nugget]: Mon Apr 10 18:10:52 2017:       Wed Apr 12 14:15:00 2017 +45m
1306    [nugget]: Mon Apr 10 18:10:52 2017:  [1] 131100,1492002900,1492005600,56023
1305    [nugget]: Mon Apr 10 18:10:52 2017:       Tue Apr 11 14:15:00 2017 +45m
1304    [nugget]: Mon Apr 10 18:10:52 2017:  [0] 131100,1491916500,1491919200,55995
1303    [nugget]: Mon Apr 10 18:10:52 2017:   Events: 1FP.BBC.CO.UK/1RKK27|1FP.BBC.CO.UK/1RKK28|1FP.BBC.CO.UK/1RKK29|1FP.BBC.CO.UK/1RKK2A|
1302    [nugget]: Mon Apr 10 18:10:52 2017:   Last Event: 55966
1301    [nugget]: Mon Apr 10 18:10:52 2017:   Recorded:
1300    [nugget]: Mon Apr 10 18:10:52 2017:   CRID: 2/[FP.BBC.CO.UK/NTADT1]
1299    [nugget]: Mon Apr 10 18:10:52 2017:    @ 1491916500 (Tue Apr 11 14:15:00 2017)
1298    [nugget]: Mon Apr 10 18:10:52 2017:   The Code
1297    [nugget]: Mon Apr 10 18:10:52 2017: Processing slot +28 (28)
1296    [nugget]: Mon Apr 10 18:10:52 2017: slots(39, +28)
1295    [nugget]: Mon Apr 10 18:10:52 2017: schedule.restore 31 = 2
1294    [nugget]: Mon Apr 10 18:10:52 2017: schedule reload complete (39).
1293    [nugget]: Mon Apr 10 18:10:51 2017: Re-loading schedule database (39).
1292    [nugget]: Mon Apr 10 18:10:51 2017: schedule.save - wait(1).
1291    [nugget]: Mon Apr 10 18:10:50 2017: schedule.save - wait(1).
1290    [nugget]: Mon Apr 10 18:10:49 2017: schedule.save - wait(1).
1289    [nugget]: Mon Apr 10 18:10:48 2017: Deferred thread starting for '39:+28' (attempt 1)
1288    [nugget]: Mon Apr 10 18:10:48 2017: Schedule failed to reload, deferring.
1287    [nugget]: Mon Apr 10 18:10:48 2017: NULL database handle.
1286    [nugget]: Mon Apr 10 18:10:48 2017: Schedule load failed.
1285    [nugget]: Mon Apr 10 18:10:48 2017: Closing database.
1284    [nugget]: Mon Apr 10 18:10:48 2017: schedule.stash 31 = 2
1283    [nugget]: Mon Apr 10 18:10:48 2017: Re-loading schedule database (39).
1282    [nugget]: Mon Apr 10 18:10:48 2017: schedule save complete.
1281    [nugget]: Mon Apr 10 18:10:48 2017: schedule save starting.
1280    [nugget]: Mon Apr 10 18:10:48 2017: Persistent log starting, v0.97
1279    +++++++++++++++++++++++++++++++++++++++++++++++++++++++
 
I have noticed that since the runaway recording incident that:
  • The system has not shut down properly and has only entered delinquent half awake
  • Eggheads has not recorded and all future show as Red - To be skipped in the RS EPG display
  • The future episode do appear in the Events to be recorded column of rsv.db and don't appear in the already recorded column
I have attached the rsv.db in case it includes any clues
I will try a full back switch reboot later to see if it clears the problem.
 

Attachments

  • rsv.db.txt
    34 KB · Views: 1
I had a runaway recording last night. It was the second episode of a series; the event was scheduled over a week ago (I put my units in standby overnight). I did remove two expired entries (Webif>Scheduled Events) and set up two new recordings (Webif>EPG) while the recording was ongoing. I have RTS enabled. Webif 1.4.2-4 and nugget 0.97-1. I had to reboot to allow the system to shut down properly as it was in the delinquent half-awake state after attempting to put it into standby. I have attached the corresponding section of nugget.log:

Code: 
[nugget]: Tue Jun  6 21:10:56 2017: Persistent log starting, v0.97
[nugget]: Tue Jun  6 21:10:56 2017: schedule save starting.
[nugget]: Tue Jun  6 21:10:56 2017: schedule save complete.
[nugget]: Tue Jun  6 21:10:57 2017: Re-loading schedule database (14).
[nugget]: Tue Jun  6 21:10:57 2017: schedule.stash 15 = 2
[nugget]: Tue Jun  6 21:10:57 2017: Closing database.
[nugget]: Tue Jun  6 21:10:57 2017: schedule reload complete (14).
[nugget]: Tue Jun  6 21:10:57 2017: schedule.restore 15 = 2
[nugget]: Tue Jun  6 21:10:57 2017: slots(14, -1,-12)
[nugget]: Tue Jun  6 21:10:57 2017: Processing slot -1 (1)
[nugget]: Tue Jun  6 21:10:57 2017: Removing timer for slot 1
[nugget]: Tue Jun  6 21:10:57 2017: Processing slot -12 (12)
[nugget]: Tue Jun  6 21:10:57 2017: Removing timer for slot 12
[nugget]: Tue Jun  6 21:21:58 2017: schedule save starting.
[nugget]: Tue Jun  6 21:21:58 2017: schedule save complete.
[nugget]: Tue Jun  6 21:21:58 2017: Re-loading schedule database (18).
[nugget]: Tue Jun  6 21:21:58 2017: schedule.stash 15 = 2
[nugget]: Tue Jun  6 21:21:59 2017: Closing database.
[nugget]: Tue Jun  6 21:21:59 2017: Schedule load failed.
[nugget]: Tue Jun  6 21:21:59 2017: NULL database handle.
[nugget]: Tue Jun  6 21:21:59 2017: Schedule failed to reload, deferring.
[nugget]: Tue Jun  6 21:21:59 2017: Deferred thread starting for '18:+1,+12,+14,+17' (attempt 1)
[nugget]: Tue Jun  6 21:22:02 2017: Re-loading schedule database (18).
[nugget]: Tue Jun  6 21:22:02 2017: Schedule load failed.
[nugget]: Tue Jun  6 21:22:02 2017: NULL database handle.
[nugget]: Tue Jun  6 21:22:02 2017: Schedule failed to reload, deferring.
[nugget]: Tue Jun  6 21:22:02 2017: Deferred thread exiting.
[nugget]: Tue Jun  6 21:22:02 2017: Deferred thread starting for '18:+1,+12,+14,+17' (attempt 2)
[nugget]: Tue Jun  6 21:22:05 2017: Re-loading schedule database (18).
[nugget]: Tue Jun  6 21:22:05 2017: schedule reload complete (18).
[nugget]: Tue Jun  6 21:22:05 2017: schedule.restore 15 = 2
[nugget]: Tue Jun  6 21:22:05 2017: slots(18, +1,+12,+14,+17)
[nugget]: Tue Jun  6 21:22:05 2017: Processing slot +1 (1)
[nugget]: Tue Jun  6 21:22:05 2017:   Top of the Pops: 1984
[nugget]: Tue Jun  6 21:22:05 2017:    @ 1497129900 (Sat Jun 10 22:25:00 2017)
[nugget]: Tue Jun  6 21:22:05 2017:   CRID: 2/[FP.BBC.CO.UK/W4ZN7N]
[nugget]: Tue Jun  6 21:22:05 2017:   Recorded:
[nugget]: Tue Jun  6 21:22:05 2017:   Last Event: 0
[nugget]: Tue Jun  6 21:22:05 2017:   Events: 1FP.BBC.CO.UK/4HCWKT|1FP.BBC.CO.UK/4HCWKU|
[nugget]: Tue Jun  6 21:22:05 2017:  [0] 65539,1497129900,1497132300,36985
[nugget]: Tue Jun  6 21:22:05 2017:       Sat Jun 10 22:25:00 2017 +40m
[nugget]: Tue Jun  6 21:22:05 2017:  [1] 65539,1497132300,1497134400,36986
[nugget]: Tue Jun  6 21:22:05 2017:       Sat Jun 10 23:05:00 2017 +35m
[nugget]: Tue Jun  6 21:22:05 2017:  Wake 1497129000 - Sat Jun 10 22:10:00 2017
[nugget]: Tue Jun  6 21:22:05 2017: Ready 1497128970 - Sat Jun 10 22:09:30 2017
[nugget]: Tue Jun  6 21:22:05 2017: Adding timer(1497128970)
[nugget]: Tue Jun  6 21:22:05 2017:     - Sat Jun 10 22:09:30 2017
[nugget]: Tue Jun  6 21:22:05 2017: Processing slot +12 (12)
[nugget]: Tue Jun  6 21:22:05 2017:   New: 8 Out of 10 Cats
[nugget]: Tue Jun  6 21:22:05 2017:    @ 1496782800 (Tue Jun  6 22:00:00 2017)
[nugget]: Tue Jun  6 21:22:05 2017:   CRID: 1/[WWW.CHANNEL4.COM/66307/004]
[nugget]: Tue Jun  6 21:22:05 2017:   Recorded:
[nugget]: Tue Jun  6 21:22:05 2017:   Last Event: 0
[nugget]: Tue Jun  6 21:22:05 2017:   Events: 1WWW.CHANNEL4.COM/66307/004|
[nugget]: Tue Jun  6 21:22:05 2017:  [0] 524454,1496782800,1496785800,25843
[nugget]: Tue Jun  6 21:22:05 2017:       Tue Jun  6 22:00:00 2017 +50m
[nugget]: Tue Jun  6 21:22:05 2017:  Wake 1496781900 - Tue Jun  6 21:45:00 2017
[nugget]: Tue Jun  6 21:22:05 2017: Ready 1496781870 - Tue Jun  6 21:44:30 2017
[nugget]: Tue Jun  6 21:22:05 2017: Adding timer(1496781870)
[nugget]: Tue Jun  6 21:22:05 2017:     - Tue Jun  6 21:44:30 2017
[nugget]: Tue Jun  6 21:22:05 2017: Processing slot +14 (14)
[nugget]: Tue Jun  6 21:22:05 2017:   Ramsay's Hotel Hell
[nugget]: Tue Jun  6 21:22:05 2017:    @ 1496790300 (Wed Jun  7 00:05:00 2017)
[nugget]: Tue Jun  6 21:22:05 2017:   CRID: 1/[WWW.CHANNEL4.COM/64418/001]
[nugget]: Tue Jun  6 21:22:05 2017:   Recorded:
[nugget]: Tue Jun  6 21:22:05 2017:   Last Event: 0
[nugget]: Tue Jun  6 21:22:05 2017:   Events: 1WWW.CHANNEL4.COM/64418/001|
[nugget]: Tue Jun  6 21:22:05 2017:  [0] 524453,1496790300,1496793900,27289
[nugget]: Tue Jun  6 21:22:05 2017:       Wed Jun  7 00:05:00 2017 +60m
[nugget]: Tue Jun  6 21:22:05 2017:  Wake 1496789400 - Tue Jun  6 23:50:00 2017
[nugget]: Tue Jun  6 21:22:05 2017: Ready 1496789370 - Tue Jun  6 23:49:30 2017
[nugget]: Tue Jun  6 21:22:05 2017: Adding timer(1496789370)
[nugget]: Tue Jun  6 21:22:05 2017:     - Tue Jun  6 23:49:30 2017
[nugget]: Tue Jun  6 21:22:05 2017: Processing slot +17 (17)
[nugget]: Tue Jun  6 21:22:05 2017:   Long Lost Family US
[nugget]: Tue Jun  6 21:22:05 2017:    @ 1496865600 (Wed Jun  7 21:00:00 2017)
[nugget]: Tue Jun  6 21:22:05 2017:   CRID: 1/[WWW.QUESTTV.CO.UK/E301924]
[nugget]: Tue Jun  6 21:22:05 2017:   Recorded:
[nugget]: Tue Jun  6 21:22:05 2017:   Last Event: 0
[nugget]: Tue Jun  6 21:22:05 2017:   Events: 1WWW.QUESTTV.CO.UK/E301924|
[nugget]: Tue Jun  6 21:22:05 2017:  [0] 458913,1496865600,1496869200,3081
[nugget]: Tue Jun  6 21:22:05 2017:       Wed Jun  7 21:00:00 2017 +60m
[nugget]: Tue Jun  6 21:22:05 2017:  Wake 1496864700 - Wed Jun  7 20:45:00 2017
[nugget]: Tue Jun  6 21:22:05 2017: Ready 1496864670 - Wed Jun  7 20:44:30 2017
[nugget]: Tue Jun  6 21:22:05 2017: Adding timer(1496864670)
[nugget]: Tue Jun  6 21:22:05 2017:     - Wed Jun  7 20:44:30 2017
[nugget]: Tue Jun  6 21:22:05 2017: Deferred thread exiting.
 
I have just returned from holiday to find that Monday's Monarch of the Glenn had runaway (over 7000 minutes). I had previously received the RS notification of failed recordings. These were presumably where the second tuner was needed.

Until a permanent solution is found, please can some sort of maximum time (say 300 minutes) be put on recordings as damage limitation?.
 
prpr said:
You could set a cron job at say 3am to do "ir STOP OK".
Click to expand...
5am would suit me better, as Talkingpictures occasionally has films running past the update time.

Are you suggesting this as something af123 could incorporate into CF, or something I could do myself?

If the latter, I would need more help.

Sent from my SM-G930F using Tapatalk
 
4ndy said:
Are you suggesting this as something af123 could incorporate into CF, or something I could do myself?
Click to expand...
The latter, in this instance.
Add this line to /mod/var/spool/cron/crontabs/root using the WebIf file editor (or other tool of your choice):
Code: 
0 5 * * * ir STOP OK
The first digit is the minute, the second the hour. Adjust to suit.
Then run "service cron restart" from a command prompt (via telnet or ssh or Webshell) or reboot.
Obviously you need the ir package installed.
 
Thank you. Only time will tell how effective it is.

Interestingly, I deleted the big recording and the power cycled as the machine would not have rebooted since Monday.

When it restarted it was in the installation wizard mode.

Cause, effect or coincedence? Who knows?

Thank again for your help.

Sent from my SM-G930F using Tapatalk
 
I had another runaway recording which only terminated when it filled the disk :(
Unfortunately this was just as I left for a week in a cottage with no internet access :( :(
Luckily the automatic dustbin clear out did manage to free up enough space to cover most of the weeks recordings but it appear the RS Failed recording email has not listed all of the failures - I have come across a few failed recording hmt files that weren't in the most recent email

The common denominator in my runaway recordings appears to be scheduling new recordings whilst another recording is in progress
 
I have NEVER had any runaway recordings on any of my boxes and have been using RTS since it has been available.
 
Status
Not open for further replies.
Back
Top