Flags: channel,record,siparser

First entering LiveTV, channel tunes fine:

2006-04-02 14:59:15.266 DiSEqC(0): 1.3 Motor - Goto Angular Position -110
2006-04-02 14:59:15.284 DiSEqC(0): Sending 1.0 Command: e0 31 6e d2
2006-04-02 14:59:15.384 DiSEqC(0): Sending 1.3 Repeat Command: e0 31 6e d2 40
2006-04-02 14:59:16.124 DiSEqC(0): 1.1 Switch (4 ports) - Port 0 - Tone ON 13V
2006-04-02 14:59:16.142 DiSEqC(0): Sending 1.0 Command: e0 10 38 f1
2006-04-02 14:59:16.229 DiSEqC(0): Sending 1.3 Repeat Command: e0 10 38 f1  0
2006-04-02 14:59:16.462 DVB#0 Old Params: freq(0) type(QPSK)
2006-04-02 14:59:16.463 DVB#0 New Params: freq(12457000) type(QPSK)
2006-04-02 14:59:16.516 dvbchannel.cpp:wait_for_backend: Status: 
2006-04-02 14:59:16.516 DVB#0 DVBChannel::Tune: Frequency tuning successful.
2006-04-02 14:59:16.516 DVB#0 Tuned to frequency for channel 9460.
2006-04-02 14:59:16.528 TVRec(4): SetFlags(RunMainLoop,) -> RunMainLoop,
2006-04-02 14:59:16.528 TVRec(4): ClearFlags(ExitPlayer,FinishRecording,) -> RunMainLoop,
2006-04-02 14:59:16.531 New DB scheduler connection
2006-04-02 14:59:16.533 Connected to database 'mythconverg' at host: pc4
2006-04-02 14:59:16.549 mythbackend version: 0.19.20060331-1 www.mythtv.org
2006-04-02 14:59:16.550 Enabled verbose msgs:  important general record channel siparser
2006-04-02 14:59:16.551 AutoExpire: Found 4 recorders w/max rate of 421 MiB/min
2006-04-02 14:59:16.561 AutoExpire: Required Free Space: 6.3 GB w/freq: 5 min
2006-04-02 14:59:18.560 Reschedule requested for id -1.
2006-04-02 14:59:21.302 Scheduled 34 items in 2.7 = 2.57 match + 0.17 place
2006-04-02 14:59:21.309 scheduler: Scheduled items: Scheduled 34 items in 2.7 = 2.57 match + 0.17 place
2006-04-02 14:59:21.317 Recording starts soon, AUTO-Startup assumed
2006-04-02 14:59:21.682 MainServer::HandleAnnounce Monitor
2006-04-02 14:59:21.682 adding: pc4 as a client (events: 0)
2006-04-02 14:59:21.684 mythbackend: Running housekeeping thread
2006-04-02 14:59:21.690 Getting next free recorder after : -1
2006-04-02 14:59:21.693 Checking card 1. Best card so far 1
2006-04-02 14:59:21.694 Checking card 2. Best card so far 2
2006-04-02 14:59:21.694 Checking card 3. Best card so far 3
2006-04-02 14:59:21.694 Checking card 4. Best card so far 4
2006-04-02 14:59:21.704 MainServer::HandleAnnounce Monitor
2006-04-02 14:59:21.704 adding: pc4 as a client (events: 1)
2006-04-02 14:59:21.717 MainServer::HandleAnnounce Playback
2006-04-02 14:59:21.717 adding: pc4 as a client (events: 0)
2006-04-02 14:59:21.729 TVRec(4): Changing from None to WatchingLiveTV
2006-04-02 14:59:21.730 TVRec(4): ClearFlags(FrontendReady,CancelNextRecording,) -> RunMainLoop,
2006-04-02 14:59:21.730 TVRec(4): SetFlags(AskAllowRecording,) -> RunMainLoop,AskAllowRecording,
2006-04-02 14:59:21.730 TVRec(4): Request: Program(no) channel() input() flags(LiveTV,)
2006-04-02 14:59:21.730 TVRec(4): ClearFlags(PENDINGACTIONS,) -> RunMainLoop,AskAllowRecording,
2006-04-02 14:59:21.733 DVB#0 Opening DVB channel
2006-04-02 14:59:21.734 DVB#0 SetChannelByString(9460)
2006-04-02 14:59:21.734 DVB#0 SetChannelByString(9460): already on channel
2006-04-02 14:59:21.734 TVRec(4): CreateLiveTVRingBuffer()
2006-04-02 14:59:21.734 TVRec(4): GetProgramRingBufferForLiveTV()
2006-04-02 14:59:21.824 TVRec(4): StartedRecording(0x8203188) fn(/shares/recordings/corbin2/11460_20060402145921.mpg)
2006-04-02 14:59:21.838 Chain: Appended@0 '11460_20060402145921'
2006-04-02 14:59:21.851 RecBase(/dev/video): SetRingBuffer(0xafb123a8) '/shares/recordings/corbin2/11460_20060402145921.mpg'
2006-04-02 14:59:21.851 RecBase(/dev/video): SetRecording(0x8203188) title(SHO Me Now)
2006-04-02 14:59:21.852 TVRec(4): Starting Signal Monitor
2006-04-02 14:59:21.852 TVRec(4): SetupSignalMonitor(1, 1)
2006-04-02 14:59:21.853 DVB#0 Opening DVB channel
2006-04-02 14:59:21.879 SM(0)::AddFlags: Seen() Match() Wait(Sig,SNR,BER,UB,)
2006-04-02 14:59:21.880 DVBSM(0)::constructor(): initial flags 0x7400000
2006-04-02 14:59:22.182 TVRec(4): Signal monitor successfully created
2006-04-02 14:59:22.183 TVRec(4): Setting up table monitoring.
2006-04-02 14:59:22.183 TVRec(4): MPEG program number: 9460
2006-04-02 14:59:22.185 DTVSM(0)::SetProgramNumber(9460): 
2006-04-02 14:59:22.186 SM(0)::RemoveFlags: Seen(PMT,) Match(PMT,) Wait()
2006-04-02 14:59:22.186 SM(0)::AddFlags: Seen() Match() Wait(PMT,)
2006-04-02 14:59:22.186 SM(0)::AddFlags: Seen() Match() Wait(PAT,PMT,)
2006-04-02 14:59:22.186 TVRec(4): Successfully set up MPEG table monitoring.
2006-04-02 14:59:22.187 SM(0)::Start: begin
2006-04-02 14:59:22.189 SM(0)::Start: end
2006-04-02 14:59:22.190 TVRec(4): SetFlags(SignalMonitorRunning,) -> RunMainLoop,AskAllowRecording,SignalMonitorRunning,
2006-04-02 14:59:22.190 TVRec(4): ClearFlags(WaitingForSignal,) -> RunMainLoop,AskAllowRecording,SignalMonitorRunning,
2006-04-02 14:59:22.190 TVRec(4): SetFlags(WaitingForSignal,) -> RunMainLoop,AskAllowRecording,WaitingForSignal,SignalMonitorRunning,
2006-04-02 14:59:22.191 DummyDTVRecorder::StartRecording -- begin
2006-04-02 14:59:22.212 TVRec(4): SetFlags(DummyRecorderRunning,) -> RunMainLoop,AskAllowRecording,WaitingForSignal,SignalMonitorRunning,DummyRecorderRunning,
2006-04-02 14:59:22.212 DummyDTVRecorder -- started
2006-04-02 14:59:22.213 TVRec(4): SetFlags(RingBufferReady,) -> RunMainLoop,AskAllowRecording,WaitingForSignal,SignalMonitorRunning,DummyRecorderRunning,RingBufferReady,
2006-04-02 14:59:22.213 TVRec(4): ClearFlags(NeedToStartRecorder,) -> RunMainLoop,AskAllowRecording,WaitingForSignal,SignalMonitorRunning,DummyRecorderRunning,RingBufferReady,
2006-04-02 14:59:22.213 TVRec(4): SetFlags(NeedToStartRecorder,) -> RunMainLoop,AskAllowRecording,WaitingForSignal,NeedToStartRecorder,SignalMonitorRunning,DummyRecorderRunning,RingBufferReady,
2006-04-02 14:59:22.214 TVRec(4): SetFlags(CancelNextRecording,) -> RunMainLoop,CancelNextRecording,AskAllowRecording,WaitingForSignal,NeedToStartRecorder,SignalMonitorRunning,DummyRecorderRunning,RingBufferReady,
2006-04-02 14:59:22.213 DVBSM(0)::UpdateValues: Signal Locked
2006-04-02 14:59:22.215 DVBSM(0)::UpdateValues: Waiting for table monitor to start
2006-04-02 14:59:22.217 DVBSM(0)::AddPIDFilter(0x0): 
2006-04-02 14:59:22.217 DVBSM(0)::RemovePIDFilter(0x0): 
2006-04-02 14:59:22.217 DVBSM(0)::UpdateValues: Table monitor started
2006-04-02 14:59:22.218 DTVSM(0)::GetStatusList: WaitForPMT seen(0) matching(0)
2006-04-02 14:59:22.233 DVBSM(0): RunTableMonitorTS(): begin (# of pids 1)
2006-04-02 14:59:22.234 DVBSM(0)::AddPIDFilter(0x0): 
2006-04-02 14:59:22.254 DummyRec: Restart! Frames seen 12
2006-04-02 14:59:22.283 SM(0)::AddFlags: Seen(PAT,) Match() Wait()
2006-04-02 14:59:22.283 SM(0)::AddFlags: Seen() Match(PAT,) Wait()
2006-04-02 14:59:22.284 CreatePATSingleProgram()
2006-04-02 14:59:22.284 PAT in input stream
2006-04-02 14:59:22.284 Program Association Table
 PSIP tableID(0x0) length(29) extension(0xd9)
      version(1) current(1) section(0) last_section(0)
         tsid: 217
 programCount: 5
  program number 0 has PID 0x  10   data  0x0 0x0 0x224 0x16
  program number 295 has PID 0x  21   data  0x1 0x39 0x224 0x33
  program number 9421 has PID 0x  21   data  0x36 0x205 0x224 0x33
  program number 9424 has PID 0x  21   data  0x36 0x208 0x224 0x33
  program number 9460 has PID 0x  21   data  0x36 0x244 0x224 0x33

2006-04-02 14:59:22.285 desired_program(9460) pid(0x21)
2006-04-02 14:59:22.286 pmt_pid(0x21)
2006-04-02 14:59:22.286 PAT for output stream
2006-04-02 14:59:22.287 Program Association Table
 PSIP tableID(0x0) length(13) extension(0xd9)
      version(1) current(1) section(0) last_section(0)
         tsid: 217
 programCount: 1
  program number 1 has PID 0x  21   data  0x0 0x1 0x224 0x33

2006-04-02 14:59:22.289 DVBSM(0)::AddPIDFilter(0x21): 
2006-04-02 14:59:22.294 DummyRec: Restart! Frames seen 24
2006-04-02 14:59:22.299 SM(0)::AddFlags: Seen(PMT,) Match() Wait()
2006-04-02 14:59:22.300 DTVSM(0) Error: Wrong PMT; pmt->pn(295) desired(9460)
2006-04-02 14:59:22.300 CreatePMTSingleProgram()
2006-04-02 14:59:22.300 PMT in input stream
2006-04-02 14:59:22.301 Program Map Table ver(0) pid(0x21) pnum(295) len(41)

 Stream #0 pid(0x1222) type(video-mpeg2  0x2)
  Conditional Access: sid(0x1810) pid(0x12b) data_size(0)
  Conditional Access: sid(0x1801) pid(0x12b) data_size(0)
 Stream #1 pid(0x1223) type(audio-ac3  0x129)
  ISO-639 Language: code(eng) canonical(eng) eng(English)

2006-04-02 14:59:22.302 PMT for output stream
2006-04-02 14:59:22.302 Program Map Table ver(0) pid(0x21) pnum(1) len(23)

 Stream #0 pid(0x1222) type(video-mpeg2  0x2)
 Stream #1 pid(0x1223) type(audio-ac3  0x129)

2006-04-02 14:59:22.303 SM(0)::AddFlags: Seen(PMT,) Match() Wait()
2006-04-02 14:59:22.304 DTVSM(0) Error: Wrong PMT; pmt->pn(9421) desired(9460)
2006-04-02 14:59:22.304 CreatePMTSingleProgram()
2006-04-02 14:59:22.304 PMT in input stream
2006-04-02 14:59:22.305 Program Map Table ver(0) pid(0x21) pnum(9421) len(41)

 Stream #0 pid(0x1022) type(video-mpeg2  0x2)
  Conditional Access: sid(0x1810) pid(0x123) data_size(0)
  Conditional Access: sid(0x1801) pid(0x123) data_size(0)
 Stream #1 pid(0x1023) type(audio-ac3  0x129)
  ISO-639 Language: code(eng) canonical(eng) eng(English)

2006-04-02 14:59:22.306 PMT for output stream
2006-04-02 14:59:22.306 Program Map Table ver(0) pid(0x21) pnum(1) len(23)

 Stream #0 pid(0x1022) type(video-mpeg2  0x2)
 Stream #1 pid(0x1023) type(audio-ac3  0x129)

2006-04-02 14:59:22.307 SM(0)::AddFlags: Seen(PMT,) Match() Wait()
2006-04-02 14:59:22.308 DTVSM(0) Error: Wrong PMT; pmt->pn(9424) desired(9460)
2006-04-02 14:59:22.308 CreatePMTSingleProgram()
2006-04-02 14:59:22.308 PMT in input stream
2006-04-02 14:59:22.309 Program Map Table ver(0) pid(0x21) pnum(9424) len(41)

 Stream #0 pid(0x1122) type(video-mpeg2  0x2)
  Conditional Access: sid(0x1810) pid(0x130) data_size(0)
  Conditional Access: sid(0x1801) pid(0x130) data_size(0)
 Stream #1 pid(0x1123) type(audio-ac3  0x129)
  ISO-639 Language: code(eng) canonical(eng) eng(English)

2006-04-02 14:59:22.310 PMT for output stream
2006-04-02 14:59:22.310 Program Map Table ver(0) pid(0x21) pnum(1) len(23)

 Stream #0 pid(0x1122) type(video-mpeg2  0x2)
 Stream #1 pid(0x1123) type(audio-ac3  0x129)

2006-04-02 14:59:22.311 SM(0)::AddFlags: Seen(PMT,) Match() Wait()
2006-04-02 14:59:22.311 SM(0)::AddFlags: Seen() Match(PMT,) Wait()
2006-04-02 14:59:22.312 CreatePMTSingleProgram()
2006-04-02 14:59:22.312 PMT in input stream
2006-04-02 14:59:22.313 Program Map Table ver(0) pid(0x21) pnum(9460) len(41)

 Stream #0 pid(0x1222) type(video-mpeg2  0x2)
  Conditional Access: sid(0x1810) pid(0x122) data_size(0)
  Conditional Access: sid(0x1801) pid(0x122) data_size(0)
 Stream #1 pid(0x1223) type(audio-ac3  0x129)
  ISO-639 Language: code(eng) canonical(eng) eng(English)

2006-04-02 14:59:22.314 PMT for output stream
2006-04-02 14:59:22.314 Program Map Table ver(0) pid(0x21) pnum(1) len(23)

 Stream #0 pid(0x1222) type(video-mpeg2  0x2)
 Stream #1 pid(0x1223) type(audio-ac3  0x129)

2006-04-02 14:59:22.342 DummyRec: Restart! Frames seen 36
2006-04-02 14:59:22.380 DummyRec: Restart! Frames seen 48
2006-04-02 14:59:22.411 DummyRec: Restart! Frames seen 60
2006-04-02 14:59:22.447 DummyRec: Restart! Frames seen 72
2006-04-02 14:59:22.523 DTVSM(0)::GetStatusList: WaitForPMT seen(1) matching(1)
2006-04-02 14:59:22.524 TVRec(4): Got good signal
2006-04-02 14:59:22.524 TVRec(4): MPEG program num(9460)
2006-04-02 14:59:22.525 TVRec(4): TeardownSignalMonitor() -- begin
2006-04-02 14:59:22.525 DVBSM(0)::Stop: begin
2006-04-02 14:59:22.525 SM(0)::Stop: begin
2006-04-02 14:59:22.828 SM(0)::Stop: end
2006-04-02 14:59:22.843 DVBSM(0): RunTableMonitorTS(): shutdown
2006-04-02 14:59:22.843 DVBSM(0)::RemovePIDFilter(0x0): 
2006-04-02 14:59:22.843 DVBSM(0)::RemovePIDFilter(0x21): 
2006-04-02 14:59:22.846 DVBSM(0): RunTableMonitorTS(): end
2006-04-02 14:59:22.846 DVBSM(0)::Stop: end
2006-04-02 14:59:22.846 DVBSM(0)::Stop: begin
2006-04-02 14:59:22.847 SM(0)::Stop: begin
2006-04-02 14:59:22.847 SM(0)::Stop: end
2006-04-02 14:59:22.847 DVBSM(0)::Stop: end
2006-04-02 14:59:22.847 TVRec(4): TeardownSignalMonitor() -- end
2006-04-02 14:59:22.847 TVRec(4): ClearFlags(WaitingForSignal,SignalMonitorRunning,) -> RunMainLoop,CancelNextRecording,AskAllowRecording,NeedToStartRecorder,DummyRecorderRunning,RingBufferReady,
2006-04-02 14:59:22.848 SIParser: Setting ATSCStreamData
2006-04-02 14:59:22.849 DVBSM(0)::Stop: begin
2006-04-02 14:59:22.849 SM(0)::Stop: begin
2006-04-02 14:59:22.849 SIParser: Setting DVBStreamData
2006-04-02 14:59:22.849 SM(0)::Stop: end
2006-04-02 14:59:22.849 DVBSM(0)::Stop: end
2006-04-02 14:59:22.850 SM(0)::Stop: begin
2006-04-02 14:59:22.850 SM(0)::Stop: end
2006-04-02 14:59:22.854 SIParser: Added initial preferred language 'eng' with priority 1
2006-04-02 14:59:22.854 DVB#0 DVB SI Table Parser Started
2006-04-02 14:59:22.855 SIParser: ReinitSIParser(std dvb, service #9460)
2006-04-02 14:59:22.855 SIParser: SetTableStandard(dvb)
2006-04-02 14:59:22.855 SIParser: SetStreamData(0xafb13de0)
2006-04-02 14:59:22.856 SIParser: Setting ATSCStreamData
2006-04-02 14:59:22.856 SIParser: Making #9460 the requested MPEG program number
2006-04-02 14:59:22.857 SIParser: PAT Version: 1  Tuned to TransportID: 217
2006-04-02 14:59:22.857 SIParser: NIT Present on this transport  on PID 0x0
2006-04-02 14:59:22.857 SIParser: PMT pn(9460) version(0) cnt(2) pid(0x21)
2006-04-02 14:59:22.857 DVB#0 SetPMT(33) program number #9460, PCRPID(0x1222)
2006-04-02 14:59:22.858 DVB#0 CA: SetPMT() program num #9460
2006-04-02 14:59:22.858 DVB#0 SID: 9460 TID: 1 (4642 0) (4643 1)
2006-04-02 14:59:22.859 DVBSIParser: Starting DVB Section Reader thread
2006-04-02 14:59:22.859 DVBSIParser: Adding PID 0x   0 Filter 0x 0 Mask 0xff Buffer 40960
2006-04-02 14:59:22.860 DVBSIParser: Adding PID 0x  21 Filter 0x 2 Mask 0xff Buffer 40960
2006-04-02 14:59:22.861 DVBSIParser: Adding PID 0x  10 Filter 0x40 Mask 0xff Buffer 40960
2006-04-02 14:59:22.864 TVRec(4): SetFlags(WaitingForSIParser,SIParserRunning,) -> RunMainLoop,CancelNextRecording,AskAllowRecording,WaitingForSIParser,NeedToStartRecorder,SIParserRunning,DummyRecorderRunning,RingBufferReady,
2006-04-02 14:59:22.864 SIParser: PMT pn(295) version(0) cnt(2) pid(0x21)
2006-04-02 14:59:22.865 TVRec(4): Got SIParser PMT
2006-04-02 14:59:22.865 TVRec(4): ClearFlags(WaitingForSIParser,) -> RunMainLoop,CancelNextRecording,AskAllowRecording,NeedToStartRecorder,SIParserRunning,DummyRecorderRunning,RingBufferReady,
2006-04-02 14:59:22.865 TVRec(4): Starting Recorder
2006-04-02 14:59:22.865 SIParser: PMT pn(9421) version(0) cnt(2) pid(0x21)
2006-04-02 14:59:22.866 DummyDTVRecorder::StopRecordingThread(void)
2006-04-02 14:59:22.866 SIParser: PMT pn(9424) version(0) cnt(2) pid(0x21)
2006-04-02 14:59:22.866 SIParser: PMT pn(9460) version(0) cnt(2) pid(0x21)
2006-04-02 14:59:22.867 DVB#0 SetPMT(33) program number #9460, PCRPID(0x1222)
2006-04-02 14:59:22.873 DummyDTVRecorder::FinishRecording()
2006-04-02 14:59:22.875 DummyDTVRecorder::StartRecording -- end
2006-04-02 14:59:22.876 TVRec(4): ClearFlags(DummyRecorderRunning,) -> RunMainLoop,CancelNextRecording,AskAllowRecording,NeedToStartRecorder,SIParserRunning,RingBufferReady,
2006-04-02 14:59:22.882 TVRec(4): FinishedRecording(SHO Me Now) in recgroup: LiveTV
2006-04-02 14:59:22.884 Chain: Updated endtime for '11460_20060402145921' to 20060402145922
2006-04-02 14:59:22.888 Finished recording SHO Me Now "Alfie": channel 11460
2006-04-02 14:59:22.896 scheduler: Finished recording: SHO Me Now "Alfie": channel 11460
2006-04-02 14:59:22.904 TVRec(4): Using profile 'Live TV' to record
2006-04-02 14:59:22.904 TVRec(4): SwitchLiveTVRingBuffer(discont 1, set_rec 0)
2006-04-02 14:59:22.904 TVRec(4): GetProgramRingBufferForLiveTV()
2006-04-02 14:59:22.966 TVRec(4): FinishedRecording(SHO Me Now) in recgroup: LiveTV
2006-04-02 14:59:22.968 Chain: Updated endtime for '11460_20060402145921' to 20060402145922
2006-04-02 14:59:23.000 Finished recording SHO Me Now "Alfie": channel 11460
2006-04-02 14:59:23.001 Preview: 'myth://192.168.1.121:6543/11460_20060402145921.mpg' is not local, 
                        replacing with '/shares/recordings/corbin2/11460_20060402145921.mpg', which is local.
2006-04-02 14:59:23.013 Chain: Appended@1 '11460_20060402145922'
2006-04-02 14:59:23.020 DummyDTVRecorder::StopRecordingThread(void)
2006-04-02 14:59:23.022 TVRec(4): ClearFlags(DummyRecorderRunning,) -> RunMainLoop,CancelNextRecording,AskAllowRecording,NeedToStartRecorder,SIParserRunning,RingBufferReady,
2006-04-02 14:59:23.022 DummyDTVRecorder::StopRecordingThread(void)
2006-04-02 14:59:23.101 RecBase(0): SetRingBuffer(0xafb29408) '/shares/recordings/corbin2/11460_20060402145922.mpg'
2006-04-02 14:59:23.101 RecBase(0): SetRecording(0xafb107a8) title(SHO Me Now)
2006-04-02 14:59:23.104 DVB#0 CA: SetPMT() program num #9460
2006-04-02 14:59:23.105 DVB#0 SID: 9460 TID: 1 (4642 0) (4643 1)
2006-04-02 14:59:23.105 SIParser: PAT Version: 1  Tuned to TransportID: 217
2006-04-02 14:59:23.106 CreatePATSingleProgram()
2006-04-02 14:59:23.106 PAT in input stream
2006-04-02 14:59:23.106 Program Association Table
 PSIP tableID(0x0) length(29) extension(0xd9)
      version(1) current(1) section(0) last_section(0)
         tsid: 217
 programCount: 5
  program number 0 has PID 0x  10   data  0x0 0x0 0x224 0x16
  program number 295 has PID 0x  21   data  0x1 0x39 0x224 0x33
  program number 9421 has PID 0x  21   data  0x36 0x205 0x224 0x33
  program number 9424 has PID 0x  21   data  0x36 0x208 0x224 0x33
  program number 9460 has PID 0x  21   data  0x36 0x244 0x224 0x33

2006-04-02 14:59:23.107 desired_program(9460) pid(0x21)
2006-04-02 14:59:23.107 pmt_pid(0x21)
2006-04-02 14:59:23.107 DVBRec(0): Card opened successfully fd(22)
2006-04-02 14:59:23.107 PAT for output stream
2006-04-02 14:59:23.108 DVB#0 SetRecorder()
2006-04-02 14:59:23.108 Program Association Table
 PSIP tableID(0x0) length(13) extension(0xd9)
      version(1) current(1) section(0) last_section(0)
         tsid: 217
 programCount: 1
  program number 1 has PID 0x  21   data  0x0 0x1 0x224 0x33

2006-04-02 14:59:23.108 DVBRec(0): SetPMT(33)
2006-04-02 14:59:23.109 DVBRec(0): SetPAT(NULL)
2006-04-02 14:59:23.110 DVBRec(0): SetOutputPMT(NULL)
2006-04-02 14:59:23.114 TVRec(4): SetFlags(RecorderRunning,RingBufferReady,) -> RunMainLoop,CancelNextRecording,AskAllowRecording,NeedToStartRecorder,SIParserRunning,RecorderRunning,RingBufferReady,
2006-04-02 14:59:23.114 TVRec(4): ClearFlags(NeedToStartRecorder,) -> RunMainLoop,CancelNextRecording,AskAllowRecording,SIParserRunning,RecorderRunning,RingBufferReady,
2006-04-02 14:59:23.225 DevRdB(0): buffer size 32900 KB
2006-04-02 14:59:23.226 DVBRec(0): Resetting Demux Filters
2006-04-02 14:59:23.226 DVBRec(0): Adding pid 0x1222 size(3600384)
2006-04-02 14:59:23.228 DVBRec(0): Set demux buffer size for pid 0x1222 to 3600384,
                        which gives us a 1500 msec buffer.
2006-04-02 14:59:23.228 DVBRec(0): Adding pid 0x1223 size(94208)
2006-04-02 14:59:23.229 DVBRec(0): Set demux buffer size for pid 0x1223 to 94208,
                        which gives us a 1500 msec buffer.
2006-04-02 14:59:23.229 DVBRec(0): SetPAT()
Program Association Table
 PSIP tableID(0x0) length(13) extension(0x1)
      version(0) current(1) section(0) last_section(0)
         tsid: 1
 programCount: 1
  program number 1 has PID 0x  21   data  0x0 0x1 0x224 0x33

2006-04-02 14:59:23.230 DVBRec(0): CreatePMT(void) INPUT

Program Map Table ver(0) pid(0x29) pnum(9460) len(41)

 Stream #0 pid(0x1222) type(video-mpeg2  0x2)
  Conditional Access: sid(0x1810) pid(0x122) data_size(0)
  Conditional Access: sid(0x1801) pid(0x122) data_size(0)
 Stream #1 pid(0x1223) type(audio-ac3  0x129)
  ISO-639 Language: code(eng) canonical(eng) eng(English)

2006-04-02 14:59:23.231 Created PMT 
Program Map Table ver(1) pid(0x21) pnum(1) len(29)

 Stream #0 pid(0x1222) type(video-mpeg2  0x2)
 Stream #1 pid(0x1223) type(audio-ac3  0x129)
  ISO-639 Language: code(eng) canonical(eng) eng(English)

2006-04-02 14:59:23.232 DVBRec(0): CreatePMT(void) OUTPUT

Program Map Table ver(1) pid(0x21) pnum(1) len(29)

 Stream #0 pid(0x1222) type(video-mpeg2  0x2)
 Stream #1 pid(0x1223) type(audio-ac3  0x129)
  ISO-639 Language: code(eng) canonical(eng) eng(English)

2006-04-02 14:59:23.233 DVBRec(0): SetOutputPMT()
Program Map Table ver(1) pid(0x21) pnum(1) len(29)

 Stream #0 pid(0x1222) type(video-mpeg2  0x2)
 Stream #1 pid(0x1223) type(audio-ac3  0x129)
  ISO-639 Language: code(eng) canonical(eng) eng(English)

2006-04-02 14:59:23.236 PID 0x1222 Found Payload Start
2006-04-02 14:59:23.240 PID 0x1223 Found Payload Start
2006-04-02 14:59:23.280 SIParser: Private Type sdt_mapping = 1 defined for NetworkID 4102
2006-04-02 14:59:23.280 SIParser: SDT Mapping Incorrect for this Service Fixup Loaded
2006-04-02 14:59:23.280 SIParser: Private Type tv_types = 1,145,154 defined for NetworkID 4102
2006-04-02 14:59:23.281 SIParser: Added TV Type 1
2006-04-02 14:59:23.281 SIParser: Added TV Type 145
2006-04-02 14:59:23.281 SIParser: Added TV Type 154
2006-04-02 14:59:23.281 SIParser: Private Type guide_fixup = 1 defined for NetworkID 4102
2006-04-02 14:59:23.282 SIParser: Using Guide Fixup Scheme #1
2006-04-02 14:59:23.282 SIParser: Private Type force_guide_present = yes defined for NetworkID 4102
2006-04-02 14:59:23.282 SIParser: Forcing Guide Present
2006-04-02 14:59:23.282 SIParser: Private Type extended_guide_tid = 229 defined for NetworkID 4102
2006-04-02 14:59:23.283 SIParser: Private Type extended_guide_tid = 229 defined for NetworkID 4102
2006-04-02 14:59:23.283 SIParser: Private Type force_guide_present = yes defined for NetworkID 4102
2006-04-02 14:59:23.283 SIParser: Forcing Guide Present
2006-04-02 14:59:23.283 SIParser: Private Type force_guide_present = yes defined for NetworkID 4102
2006-04-02 14:59:23.284 SIParser: Forcing Guide Present
2006-04-02 14:59:23.284 SIParser: Private Type extended_guide_tid = 229 defined for NetworkID 4102
2006-04-02 14:59:23.284 SIParser: Private Type force_guide_present = yes defined for NetworkID 4102
2006-04-02 14:59:23.284 SIParser: Forcing Guide Present
2006-04-02 14:59:23.285 SIParser: Private Type extended_guide_tid = 229 defined for NetworkID 4102
2006-04-02 14:59:23.285 SIParser: Private Type force_guide_present = yes defined for NetworkID 4102
2006-04-02 14:59:23.285 SIParser: Forcing Guide Present
2006-04-02 14:59:23.285 SIParser: Private Type extended_guide_tid = 229 defined for NetworkID 4102
2006-04-02 14:59:23.286 SIParser: Private Type force_guide_present = yes defined for NetworkID 4102
2006-04-02 14:59:23.286 SIParser: Forcing Guide Present
2006-04-02 14:59:23.286 SIParser: Private Type extended_guide_tid = 229 defined for NetworkID 4102
2006-04-02 14:59:23.286 SIParser: Private Type force_guide_present = yes defined for NetworkID 4102
2006-04-02 14:59:23.286 SIParser: Forcing Guide Present
2006-04-02 14:59:23.287 SIParser: Private Type extended_guide_tid = 229 defined for NetworkID 4102
2006-04-02 14:59:23.637 SIParser: Table[SERVICES]->RequirePIDs() == true
2006-04-02 14:59:23.637 DVBSIParser: Adding PID 0x  11 Filter 0x46 Mask 0xfb Buffer 40960
...
2006-04-02 14:59:43.598 SIParser: SDT: sid=584 type=1 eit_present=1 collect_eit=1 name=SAMAY
2006-04-02 14:59:43.599 SIParser: SDT: sid=585 type=1 eit_present=1 collect_eit=1 name=AAJTK
2006-04-02 14:59:43.599 SIParser: SDT: sid=586 type=1 eit_present=1 collect_eit=1 name=HT
2006-04-02 14:59:43.600 SIParser: SDT: sid=590 type=1 eit_present=1 collect_eit=1 name=TRACE
2006-04-02 14:59:43.601 SIParser: SDT: sid=591 type=1 eit_present=1 collect_eit=1 name=TELSD
2006-04-02 14:59:43.601 SIParser: SDT: sid=599 type=1 eit_present=1 collect_eit=1 name=FPCHN
2006-04-02 14:59:43.602 SIParser: SDT: sid=622 type=1 eit_present=1 collect_eit=1 name=APUNJ
2006-04-02 14:59:43.602 SIParser: SDT: sid=623 type=1 eit_present=1 collect_eit=1 name=ZGUJ
2006-04-02 14:59:43.602 SIParser: SDT: sid=624 type=1 eit_present=1 collect_eit=1 name=SHARA
2006-04-02 14:59:43.602 SIParser: SDT: sid=654 type=1 eit_present=1 collect_eit=1 name=JSTV
2006-04-02 14:59:43.603 SIParser: SDT: sid=664 type=1 eit_present=1 collect_eit=1 name=ALTER
2006-04-02 14:59:43.597 DVBSIParser: Stopping DVB Section Reader
2006-04-02 14:59:43.604 DVBSIParser: DVB Section Reader thread stopped
2006-04-02 14:59:43.605 SIParser: Descriptor Stats -- begin
2006-04-02 14:59:43.606 SIParser: On PID 0x0: Found 24, Unknown(133) Descriptors
2006-04-02 14:59:43.606 SIParser: On PID 0x0: Found 247, Caption Service Descriptors
2006-04-02 14:59:43.606 SIParser: On PID 0x0: Found 139, Content Advisory Descriptors
2006-04-02 14:59:43.607 SIParser: On PID 0x0: Found 5049, Unknown(137) Descriptors
2006-04-02 14:59:43.607 SIParser: On PID 0x0: Found 6, Unknown(139) Descriptors
2006-04-02 14:59:43.608 SIParser: On PID 0x0: Found 93, Unknown(142) Descriptors
2006-04-02 14:59:43.608 SIParser: On PID 0x0: Found 4368, Unknown(150) Descriptors
2006-04-02 14:59:43.608 SIParser: On PID 0x0: Found 109, Unknown(152) Descriptors
2006-04-02 14:59:43.608 SIParser: On PID 0x0: Found 109, Unknown(174) Descriptors
2006-04-02 14:59:43.609 SIParser: On PID 0x10: Found 81, Service List Descriptors
2006-04-02 14:59:43.609 SIParser: On PID 0x11: Found 2508, Linkage Descriptors
2006-04-02 14:59:43.609 SIParser: On PID 0x11: Found 1222, ATSC Stuffing Descriptors
2006-04-02 14:59:43.609 SIParser: On PID 0x11: Found 5, Unknown(130) Descriptors
2006-04-02 14:59:43.610 SIParser: On PID 0x11: Found 1717, Unknown(132) Descriptors
2006-04-02 14:59:43.610 SIParser: On PID 0x11: Found 16, Unknown(133) Descriptors
2006-04-02 14:59:43.610 SIParser: On PID 0x11: Found 2513, Caption Service Descriptors
2006-04-02 14:59:43.611 SIParser: On PID 0x11: Found 2513, Unknown(147) Descriptors
2006-04-02 14:59:43.611 SIParser: On PID 0x11: Found 951, Unknown(153) Descriptors
2006-04-02 14:59:43.611 SIParser: Descriptor Stats -- end
2006-04-02 14:59:43.611 TVRec(4): ClearFlags(SIParserRunning,) -> FrontendReady,RunMainLoop,CancelNextRecording,RecorderRunning,
2006-04-02 14:59:43.612 TVRec(4): ClearFlags(PENDINGACTIONS,) -> FrontendReady,RunMainLoop,CancelNextRecording,RecorderRunning,
2006-04-02 14:59:43.613 TVRec(4): SetFlags(WaitingForRecPause,) -> FrontendReady,RunMainLoop,CancelNextRecording,WaitingForRecPause,RecorderRunning,
2006-04-02 14:59:43.613 TVRec(4): ClearFlags(WaitingForRecPause,) -> FrontendReady,RunMainLoop,CancelNextRecording,RecorderRunning,
2006-04-02 14:59:43.614 DVBRec(0): Close() fd(22) -- begin
2006-04-02 14:59:43.616 DVB#0 SetRecorder()
2006-04-02 14:59:43.617 DVBRec(0): Close() fd(-1) -- end
2006-04-02 14:59:43.617 RecBase(0): SetRingBuffer(0)

Tune to new channel:

2006-04-02 14:59:43.618 DVB#0 Opening DVB channel
2006-04-02 14:59:43.618 DVB#0 SetChannelByString(9456)
2006-04-02 14:59:43.631 DVB#0 Frequency: 12399000 Symbol Rate: 21500000 Pol: V/R Inv: Auto
2006-04-02 14:59:44.103 DiSEqC(0): 1.3 Motor - Goto Angular Position -110
2006-04-02 14:59:44.577 DiSEqC(0): 1.1 Switch (4 ports) - Port 0 - Tone ON 13V
2006-04-02 14:59:44.595 DiSEqC(0): Sending 1.0 Command: e0 10 38 f1
2006-04-02 14:59:44.682 DiSEqC(0): Sending 1.3 Repeat Command: e0 10 38 f1  0
2006-04-02 14:59:44.911 DVB#0 Old Params: freq(12457000) type(QPSK)
2006-04-02 14:59:44.911 DVB#0 New Params: freq(12399000) type(QPSK)
2006-04-02 14:59:44.912 DVB#0 DVBChannel::Tune: Frequency tuning successful.
2006-04-02 14:59:44.912 DVB#0 Tuned to frequency for channel 9456.
2006-04-02 14:59:44.912 TVRec(4): SwitchLiveTVRingBuffer(discont 1, set_rec 0)
2006-04-02 14:59:44.912 TVRec(4): GetProgramRingBufferForLiveTV()
2006-04-02 14:59:44.981 TVRec(4): StartedRecording(0xa5c46e90) fn(/shares/recordings/corbin2/114560_20060402145944.mpg)
2006-04-02 14:59:44.999 TVRec(4): FinishedRecording(SHO Me Now) in recgroup: LiveTV
2006-04-02 14:59:45.002 Chain: Updated endtime for '11460_20060402145922' to 20060402145945
2006-04-02 14:59:45.026 Finished recording SHO Me Now "Alfie": channel 11460
2006-04-02 14:59:45.026 Preview: 'myth://192.168.1.121:6543/11460_20060402145922.mpg' is not local, 
                        replacing with '/shares/recordings/corbin2/11460_20060402145922.mpg', which is local.
2006-04-02 14:59:45.040 Chain: Appended@2 '114560_20060402145944'
0: start_time: 2690.190 duration: 1.787
1: start_time: 2690.145 duration: 1.806
stream: start_time: 29890.496 duration: 20.358 bitrate=12475 kb/s
2006-04-02 14:59:45.209 AFD: Opened codec 0xa5c08f90, id(MPEG2VIDEO) type(Video)
2006-04-02 14:59:45.211 AFD: Opened codec 0xa5c50220, id(AC3) type(Audio)
2006-04-02 14:59:45.216 RecBase(/dev/video): SetRingBuffer(0xaa5404c8) '/shares/recordings/corbin2/114560_20060402145944.mpg'
2006-04-02 14:59:45.216 RecBase(/dev/video): SetRecording(0xa5c46e90) title(The Wedding Date)
2006-04-02 14:59:45.217 TVRec(4): Starting Signal Monitor
2006-04-02 14:59:45.217 TVRec(4): SetupSignalMonitor(1, 1)
2006-04-02 14:59:45.217 DVB#0 Opening DVB channel
2006-04-02 14:59:45.243 SM(0)::AddFlags: Seen() Match() Wait(Sig,SNR,BER,UB,)
2006-04-02 14:59:45.244 DVBSM(0)::constructor(): initial flags 0x7400000
2006-04-02 14:59:45.546 TVRec(4): Signal monitor successfully created
2006-04-02 14:59:45.546 TVRec(4): Setting up table monitoring.
2006-04-02 14:59:45.547 TVRec(4): MPEG program number: 9456
2006-04-02 14:59:45.550 DTVSM(0)::SetProgramNumber(9456): 
2006-04-02 14:59:45.550 SM(0)::RemoveFlags: Seen(PMT,) Match(PMT,) Wait()
2006-04-02 14:59:45.550 SM(0)::AddFlags: Seen() Match() Wait(PMT,)
2006-04-02 14:59:45.550 SM(0)::AddFlags: Seen() Match() Wait(PAT,PMT,)
2006-04-02 14:59:45.551 TVRec(4): Successfully set up MPEG table monitoring.
2006-04-02 14:59:45.551 SM(0)::Start: begin
2006-04-02 14:59:45.553 SM(0)::Start: end
2006-04-02 14:59:45.554 TVRec(4): SetFlags(SignalMonitorRunning,) -> FrontendReady,RunMainLoop,CancelNextRecording,SignalMonitorRunning,RecorderRunning,
2006-04-02 14:59:45.554 TVRec(4): ClearFlags(WaitingForSignal,) -> FrontendReady,RunMainLoop,CancelNextRecording,SignalMonitorRunning,RecorderRunning,
2006-04-02 14:59:45.554 TVRec(4): SetFlags(WaitingForSignal,) -> FrontendReady,RunMainLoop,CancelNextRecording,WaitingForSignal,SignalMonitorRunning,RecorderRunning,
2006-04-02 14:59:45.555 DummyDTVRecorder::StartRecording -- begin
2006-04-02 14:59:45.576 DVBSM(0)::UpdateValues: Signal Locked
2006-04-02 14:59:45.577 DVBSM(0)::UpdateValues: Waiting for table monitor to start
2006-04-02 14:59:45.580 DVBSM(0)::UpdateValues: Table monitor started
2006-04-02 14:59:45.582 DTVSM(0)::GetStatusList: WaitForPMT seen(0) matching(0)
2006-04-02 14:59:45.587 TVRec(4): SetFlags(DummyRecorderRunning,) -> FrontendReady,RunMainLoop,CancelNextRecording,WaitingForSignal,SignalMonitorRunning,ANYRECRUNNING,
2006-04-02 14:59:45.587 DummyDTVRecorder -- started
2006-04-02 14:59:45.587 TVRec(4): SetFlags(RingBufferReady,) -> FrontendReady,RunMainLoop,CancelNextRecording,WaitingForSignal,SignalMonitorRunning,ANYRECRUNNING,RingBufferReady,
2006-04-02 14:59:45.588 TVRec(4): ClearFlags(NeedToStartRecorder,) -> FrontendReady,RunMainLoop,CancelNextRecording,WaitingForSignal,SignalMonitorRunning,ANYRECRUNNING,RingBufferReady,
2006-04-02 14:59:45.588 TVRec(4): SetFlags(NeedToStartRecorder,) -> FrontendReady,RunMainLoop,CancelNextRecording,WaitingForSignal,NeedToStartRecorder,SignalMonitorRunning,ANYRECRUNNING,RingBufferReady,
2006-04-02 14:59:45.589 TVRec(4): SetChannel() -- end
2006-04-02 14:59:45.599 DVBSM(0): RunTableMonitorTS(): begin (# of pids 1)
2006-04-02 14:59:45.600 DVBSM(0)::AddPIDFilter(0x0): 
2006-04-02 14:59:45.609 ProcessPAT: PAT is missing program, setting timeout
2006-04-02 14:59:45.613 DummyRec: Restart! Frames seen 12
2006-04-02 14:59:45.658 DummyRec: Restart! Frames seen 24
2006-04-02 14:59:45.692 DummyRec: Restart! Frames seen 36
2006-04-02 14:59:45.717 DummyRec: Restart! Frames seen 48
[mpeg2video @ 0xb74123a4]ac-tex damaged at 0 65
[mpeg2video @ 0xb74123a4]00 motion_type at 5 66
[mpeg2video @ 0xb74123a4]00 motion_type at 9 67
2006-04-02 14:59:45.750 DummyRec: Restart! Frames seen 60
2006-04-02 14:59:45.789 DummyRec: Restart! Frames seen 72
2006-04-02 14:59:46.247 DummyRec: Restart! Frames seen 84
2006-04-02 14:59:46.750 DummyRec: Restart! Frames seen 96
2006-04-02 14:59:47.304 DummyRec: Restart! Frames seen 108
2006-04-02 14:59:47.807 DummyRec: Restart! Frames seen 120
2006-04-02 14:59:48.354 DummyRec: Restart! Frames seen 132
2006-04-02 14:59:48.911 DummyRec: Restart! Frames seen 144
2006-04-02 14:59:49.409 DummyRec: Restart! Frames seen 156
2006-04-02 14:59:49.966 DummyRec: Restart! Frames seen 168
2006-04-02 14:59:50.467 DummyRec: Restart! Frames seen 180
2006-04-02 14:59:51.018 DummyRec: Restart! Frames seen 192
2006-04-02 14:59:51.572 DummyRec: Restart! Frames seen 204
2006-04-02 14:59:52.072 DummyRec: Restart! Frames seen 216
2006-04-02 14:59:52.626 DummyRec: Restart! Frames seen 228
2006-04-02 14:59:53.128 DummyRec: Restart! Frames seen 240
2006-04-02 14:59:53.679 DummyRec: Restart! Frames seen 252
2006-04-02 14:59:54.235 DummyRec: Restart! Frames seen 264
2006-04-02 14:59:54.738 DummyRec: Restart! Frames seen 276
2006-04-02 14:59:55.291 DummyRec: Restart! Frames seen 288
2006-04-02 14:59:55.794 DummyRec: Restart! Frames seen 300
2006-04-02 14:59:56.346 DummyRec: Restart! Frames seen 312
2006-04-02 14:59:56.902 DummyRec: Restart! Frames seen 324
2006-04-02 14:59:57.402 DummyRec: Restart! Frames seen 336
2006-04-02 14:59:57.956 DummyRec: Restart! Frames seen 348
2006-04-02 14:59:58.462 DummyRec: Restart! Frames seen 360
2006-04-02 14:59:59.017 DummyRec: Restart! Frames seen 372
2006-04-02 14:59:59.578 DummyRec: Restart! Frames seen 384
2006-04-02 15:00:00.084 DummyRec: Restart! Frames seen 396
2006-04-02 15:00:00.649 DummyRec: Restart! Frames seen 408
2006-04-02 15:00:01.163 DummyRec: Restart! Frames seen 420
2006-04-02 15:00:01.960 DummyRec: Restart! Frames seen 432
2006-04-02 15:00:02.524 DummyRec: Restart! Frames seen 444
2006-04-02 15:00:03.039 DummyRec: Restart! Frames seen 456
2006-04-02 15:00:03.604 DummyRec: Restart! Frames seen 468
2006-04-02 15:00:04.128 DummyRec: Restart! Frames seen 480

Give up:

2006-04-02 15:00:04.329 StopLiveTV(void) curRec: 0xa5c46e90 pseudoRec: 0
2006-04-02 15:00:04.334 TVRec(4): Changing from WatchingLiveTV to None
2006-04-02 15:00:04.334 TVRec(4): ClearFlags(FrontendReady,CancelNextRecording,) -> RunMainLoop,WaitingForSignal,NeedToStartRecorder,SignalMonitorRunning,ANYRECRUNNING,RingBufferReady,
2006-04-02 15:00:04.335 TVRec(4): SetFlags(AskAllowRecording,) -> RunMainLoop,AskAllowRecording,WaitingForSignal,NeedToStartRecorder,SignalMonitorRunning,ANYRECRUNNING,RingBufferReady,
2006-04-02 15:00:04.335 TVRec(4): Request: Program(no) channel() input() flags(KillRec,KillRingBuffer,)
2006-04-02 15:00:04.335 TVRec(4): TeardownSignalMonitor() -- begin
2006-04-02 15:00:04.335 DVBSM(0)::Stop: begin
2006-04-02 15:00:04.336 SM(0)::Stop: begin
2006-04-02 15:00:04.368 SM(0)::Stop: end
2006-04-02 15:00:04.401 DVBSM(0): RunTableMonitorTS(): shutdown
2006-04-02 15:00:04.401 DVBSM(0)::RemovePIDFilter(0x0): 
2006-04-02 15:00:04.402 DVBSM(0): RunTableMonitorTS(): end
2006-04-02 15:00:04.402 DVBSM(0)::Stop: end
2006-04-02 15:00:04.403 DVBSM(0)::Stop: begin
2006-04-02 15:00:04.403 SM(0)::Stop: begin
2006-04-02 15:00:04.403 SM(0)::Stop: end
2006-04-02 15:00:04.403 DVBSM(0)::Stop: end
2006-04-02 15:00:04.404 TVRec(4): TeardownSignalMonitor() -- end
2006-04-02 15:00:04.404 TVRec(4): ClearFlags(SignalMonitorRunning,) -> RunMainLoop,AskAllowRecording,WaitingForSignal,NeedToStartRecorder,ANYRECRUNNING,RingBufferReady,
2006-04-02 15:00:04.404 TVRec(4): ClearFlags(WaitingForSignal,) -> RunMainLoop,AskAllowRecording,NeedToStartRecorder,ANYRECRUNNING,RingBufferReady,
2006-04-02 15:00:04.404 DummyDTVRecorder::StopRecordingThread(void)
2006-04-02 15:00:04.411 DummyDTVRecorder::FinishRecording()
2006-04-02 15:00:04.447 DummyDTVRecorder::StartRecording -- end
2006-04-02 15:00:04.447 TVRec(4): ClearFlags(DummyRecorderRunning,) -> RunMainLoop,AskAllowRecording,NeedToStartRecorder,RecorderRunning,RingBufferReady,
2006-04-02 15:00:04.453 TVRec(4): FinishedRecording(The Wedding Date) in recgroup: LiveTV
2006-04-02 15:00:04.455 Chain: Updated endtime for '114560_20060402145944' to 20060402150004
2006-04-02 15:00:04.458 Finished recording The Wedding Date: channel 114560
2006-04-02 15:00:04.464 scheduler: Finished recording: The Wedding Date: channel 114560
2006-04-02 15:00:04.469 DVBRec(0): Close() fd(-1) -- begin
2006-04-02 15:00:04.470 DVB#0 SetRecorder()
2006-04-02 15:00:04.470 DVBRec(0): Close() fd(-1) -- end
2006-04-02 15:00:04.502 TVRec(4): ClearFlags(RecorderRunning,) -> RunMainLoop,AskAllowRecording,NeedToStartRecorder,RingBufferReady,
2006-04-02 15:00:04.510 DVBRec(0): SetPAT(NULL)
2006-04-02 15:00:04.511 DVBRec(0): SetOutputPMT(NULL)
2006-04-02 15:00:04.517 TVRec(4): FinishedRecording(The Wedding Date) in recgroup: LiveTV
2006-04-02 15:00:04.519 Chain: Updated endtime for '114560_20060402145944' to 20060402150004
2006-04-02 15:00:04.521 Finished recording The Wedding Date: channel 114560
2006-04-02 15:00:04.526 TVRec(4): ClearFlags(RecorderRunning,) -> RunMainLoop,AskAllowRecording,NeedToStartRecorder,RingBufferReady,
2006-04-02 15:00:04.527 TVRec(4): Tearing down RingBuffer
2006-04-02 15:00:04.527 DummyDTVRecorder::StopRecordingThread(void)
2006-04-02 15:00:04.528 TVRec(4): ClearFlags(DummyRecorderRunning,) -> RunMainLoop,AskAllowRecording,NeedToStartRecorder,RingBufferReady,
2006-04-02 15:00:04.618 TVRec(4): ClearFlags(PENDINGACTIONS,) -> RunMainLoop,AskAllowRecording,RingBufferReady,
2006-04-02 15:00:04.619 DVBSM(0)::Stop: begin
2006-04-02 15:00:04.619 SM(0)::Stop: begin
2006-04-02 15:00:04.620 SM(0)::Stop: end
2006-04-02 15:00:04.620 DVBSM(0)::Stop: end
2006-04-02 15:00:04.620 SM(0)::Stop: begin
2006-04-02 15:00:04.620 SM(0)::Stop: end
2006-04-02 15:00:04.621 DVBRec(0): SetPAT(NULL)
2006-04-02 15:00:04.621 DVBRec(0): SetOutputPMT(NULL)
2006-04-02 15:00:04.622 DummyDTVRecorder::StopRecordingThread(void)
c