home
products
contribute
download
documentation
forum
Home
Forums
New posts
Search forums
What's new
New posts
All posts
Latest activity
Members
Registered members
Current visitors
Donate
Log in
Register
What's new
Search
Search
Search titles only
By:
New posts
Search forums
Search titles only
By:
Menu
Log in
Register
Navigation
Install the app
Install
More options
Contact us
Close Menu
Forums
Language specific support
Deutsches MediaPortal Forum
MediaPortal 1
Installationsprobleme?
Kein Signal mit MSI Digi Vox Trio
Contact us
RSS
JavaScript is disabled. For a better experience, please enable JavaScript in your browser before proceeding.
You are using an out of date browser. It may not display this or other websites correctly.
You should upgrade or use an
alternative browser
.
Reply to thread
Message
<blockquote data-quote="flow87" data-source="post: 778725" data-attributes="member: 87305"><p>Ich muss das Thema nochmal aufgreifen. Ich habe den USB Stick auch und habe auch den obengenannten Treiner installiert.</p><p></p><p>Ich habe folgendes Setup:</p><p>Windows 7 32bit TV Server</p><p>MP 1.1.3</p><p>FireDTV DvB-C und MSI Digi Vox Trio</p><p></p><p>Ich programmiere eine aufnahme auf einem Unitymedia Kabelkanal. Nun möchte ich z. B. sky select gucken (frei empfangbar !!!) und erhalte die Meldung "Kein Signal". Wechsle ich auf den Kanal ZDF kann ich ohne Probleme gucken!</p><p>Starte ich nun - nachdem ich die Meldung kein Signal auf dem Sky Select in MePo hatte und MePo geschlossen wurde (Aufnahme läuft weiter) - DVBViewer mit dem MSI Digi Vox als TV Karte und wechsle auf den Kanal Sky Select, kann ich diesen ohne Probleme mit 100 % Empfang gucken. Wo liegt da das Problem??</p><p></p><p>hier mal die TV Log</p><p>[CODE]</p><p>2011-08-21 13:58:15.781234 [(27)]: WaitForPmt: PMT handling took 0,5200007 seconds.</p><p>2011-08-21 13:58:15.951234 [(27)]: card: Tuner locked: True</p><p>2011-08-21 13:58:15.951234 [(27)]: **************************************************</p><p>2011-08-21 13:58:15.951234 [(27)]: ***** SIGNAL LEVEL: 100, SIGNAL QUALITY: 100 *****</p><p>2011-08-21 13:58:15.951234 [(27)]: **************************************************</p><p>2011-08-21 13:58:15.951234 [(27)]: card: tuned user: scheduler20 subchannel: 0</p><p>2011-08-21 13:58:15.951234 [(27)]: user:scheduler20 add</p><p>2011-08-21 13:58:15.951234 [(27)]: Scheduler: MakeFileName() using "moviesformat" (_isSerie=False)</p><p>2011-08-21 13:58:15.961234 [(27)]: Scheduler : record to C:\ProgramData\Team MediaPortal\MediaPortal TV Server\recordings\Paul - Ein Alien auf der Flucht HD (Nr.566) - Kino HD - 2011-08-21.ts</p><p>2011-08-21 13:58:15.971234 [(27)]: Recorder.start add audioVideoEventHandler</p><p>2011-08-21 13:58:15.971234 [(27)]: card: StartRecording 2 C:\ProgramData\Team MediaPortal\MediaPortal TV Server\recordings\Paul - Ein Alien auf der Flucht HD (Nr.566) - Kino HD - 2011-08-21.ts</p><p>2011-08-21 13:58:15.971234 [(27)]: StartRecording to C:\ProgramData\Team MediaPortal\MediaPortal TV Server\recordings\Paul - Ein Alien auf der Flucht HD (Nr.566) - Kino HD - 2011-08-21.ts</p><p>2011-08-21 13:58:15.971234 [(27)]: subch:0 StartRecord(C:\ProgramData\Team MediaPortal\MediaPortal TV Server\recordings\Paul - Ein Alien auf der Flucht HD (Nr.566) - Kino HD - 2011-08-21.ts)</p><p>2011-08-21 13:58:15.971234 [(27)]: subch:0-0 tswriter StartRecording...</p><p>2011-08-21 13:58:15.981234 [(27)]: SetRecorderPids</p><p>2011-08-21 13:58:15.981234 [(27)]: Set video / audio observer</p><p>2011-08-21 13:58:15.981234 [(27)]: DVB subch:0 Started recording</p><p>2011-08-21 13:58:15.981234 [(27)]: card: WaitForRecordingFile - waiting _eventAudio & _eventVideo</p><p>2011-08-21 13:58:15.981234 [(32)]: PID seen - type = Video</p><p>2011-08-21 13:58:15.981234 [(32)]: Recorder audioVideoEventHandler Video</p><p>2011-08-21 13:58:16.011234 [(32)]: PID seen - type = Audio</p><p>2011-08-21 13:58:16.011234 [(32)]: Recorder audioVideoEventHandler Audio</p><p>2011-08-21 13:58:16.021234 [(27)]: card: WaitForRecordingFile - video and audio are seen after 0,03 seconds</p><p>2011-08-21 13:58:16.021234 [(27)]: Timeshifting epg grabber started.</p><p>2011-08-21 13:58:16.021234 [(27)]: dvb:grab epg...</p><p>2011-08-21 13:58:16.031234 [Channel state thread(33)]: Controller: DoSetChannelStates for 233 channels</p><p>2011-08-21 13:58:16.031234 [Channel state thread(33)]: ChannelStates.DoSetChannelStates took 0 msec</p><p>2011-08-21 13:58:16.031234 [(27)]: Scheduler: adding new row in db for title="Paul - Ein Alien auf der Flucht HD (Nr.566)" of type="0"</p><p>2011-08-21 13:58:16.041234 [(27)]: Scheduler: recList: count: 1 add scheduleid: 20 card: FireDTV BDA Tuner DVBC</p><p>2011-08-21 13:58:23.651245 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 13:57:23.6511 , False</p><p>2011-08-21 13:58:23.651245 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 13:58:23.651245 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 13:58:23.651245 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>2011-08-21 13:59:23.671328 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 13:58:23.6512 , False</p><p>2011-08-21 13:59:23.671328 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 13:59:23.671328 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 13:59:23.671328 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>2011-08-21 13:59:27.151332 [EPG Update thread(33)]: schedule.SynchProgramStatesForAll</p><p>2011-08-21 14:00:23.681410 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 13:59:23.6713 , False</p><p>2011-08-21 14:00:23.681410 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:00:23.681410 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 14:00:23.681410 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>2011-08-21 14:01:23.681493 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:00:23.6814 , False</p><p>2011-08-21 14:01:23.681493 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:01:23.691493 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 14:01:23.691493 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>2011-08-21 14:02:23.711576 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 14:01:23.6914 , False</p><p>2011-08-21 14:02:23.711576 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:02:23.711576 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 14:02:23.711576 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>2011-08-21 14:03:23.721659 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:02:23.7115 , False</p><p>2011-08-21 14:03:23.721659 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:03:23.721659 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 14:03:23.721659 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>2011-08-21 14:04:23.731742 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 14:03:23.7216 , False</p><p>2011-08-21 14:04:23.731742 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:04:23.731742 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 14:04:23.731742 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>2011-08-21 14:04:54.221784 [(33)]: Controller: TimeShiftingWouldUseCard Info Tafel 96</p><p>2011-08-21 14:04:54.221784 [(33)]: Controller: find free card for channel Blue Movie</p><p>2011-08-21 14:04:54.221784 [(33)]: Controller: got 1 tuning details for Blue Movie</p><p>2011-08-21 14:04:54.221784 [(33)]: Controller: channel #1 DVBC:tv:SKY Blue Movie Freq:378000 ONID:133 TSID:4 SID:513 PMT:0x65 FTA:False LCN:760 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:04:54.231784 [(33)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:04:54.231784 [(33)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:04:54.231784 [(33)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:04:54.231784 [(33)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:04:54.231784 [(33)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:04:54.231784 [(33)]: Controller: found 1 available</p><p>2011-08-21 14:04:54.231784 [(33)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 17 msec</p><p>2011-08-21 14:04:54.241784 [(33)]: CiMenuSupported called cardid 4</p><p>2011-08-21 14:04:54.241784 [(33)]: CiMenuSupported card BDA 2885 TVTuner C supported: False</p><p>2011-08-21 14:04:54.661784 [(33)]: Controller: StartTimeShifting Info Tafel 96</p><p>2011-08-21 14:04:54.661784 [(33)]: Controller: find free card for channel Blue Movie</p><p>2011-08-21 14:04:54.661784 [(33)]: Controller: got 1 tuning details for Blue Movie</p><p>2011-08-21 14:04:54.661784 [(33)]: Controller: channel #1 DVBC:tv:SKY Blue Movie Freq:378000 ONID:133 TSID:4 SID:513 PMT:0x65 FTA:False LCN:760 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:04:54.671784 [(33)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:04:54.671784 [(33)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:04:54.671784 [(33)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:04:54.671784 [(33)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:04:54.681784 [(33)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:04:54.681784 [(33)]: Controller: found 1 available</p><p>2011-08-21 14:04:54.681784 [(33)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 18 msec</p><p>2011-08-21 14:04:54.681784 [(33)]: card: CardTune 4 Blue Movie MS_PC:4:-1</p><p>2011-08-21 14:04:54.681784 [(33)]: card: Tune 4 to Blue Movie</p><p>2011-08-21 14:04:54.681784 [(33)]: card: user: MS_PC:4:-1 tune DVBC:tv:SKY Blue Movie Freq:378000 ONID:133 TSID:4 SID:513 PMT:0x65 FTA:False LCN:760 SymbolRate:6900 Modulation:Mod256Qam</p><p>2011-08-21 14:04:54.691784 [(33)]: dvbc: Tune:DVBC:tv:SKY Blue Movie Freq:378000 ONID:133 TSID:4 SID:513 PMT:0x65 FTA:False LCN:760 SymbolRate:6900 Modulation:Mod256Qam</p><p>2011-08-21 14:04:54.691784 [(33)]: dvb:Submiting tunerequest Channel:Blue Movie subChannel:-1 </p><p>2011-08-21 14:04:54.691784 [(33)]: dvb:Getting new subchannel</p><p>2011-08-21 14:04:54.691784 [(33)]: dvb:GetNewSubChannel:0 #0</p><p>2011-08-21 14:04:54.691784 [(33)]: TvDvbChannel ctor new subchIndex:0</p><p>2011-08-21 14:04:54.691784 [(33)]: dvb:Submit tunerequest size:1 new:0</p><p>2011-08-21 14:04:54.691784 [(33)]: subch:0 OnBeforeTune</p><p>2011-08-21 14:04:54.691784 [(33)]: dvb:Submit tunerequest calling put_TuneRequest</p><p>2011-08-21 14:04:54.691784 [(33)]: dvb:Submit tunerequest done calling put_TuneRequest</p><p>2011-08-21 14:04:54.691784 [(33)]: subch:0 OnAfterTune</p><p>2011-08-21 14:04:54.691784 [(33)]: subch:0 OnGraphStart</p><p>2011-08-21 14:04:54.701784 [(33)]: dvb: RunGraph</p><p>2011-08-21 14:04:56.401787 [(33)]: dvb: LockedInOnSignal waiting 20ms</p><p>2011-08-21 14:04:57.191788 [(33)]: dvb: LockedInOnSignal waiting 20ms</p><p>2011-08-21 14:04:57.981789 [(33)]: dvb: LockedInOnSignal waiting 20ms</p><p>2011-08-21 14:04:58.001789 [(33)]: dvb: LockedInOnSignal could not lock onto channel - no signal or bad signal</p><p>2011-08-21 14:04:58.001789 [(33)]: tvcard:FreeSubChannel: subchannels count 1 subch#0 keep graph=False</p><p>2011-08-21 14:04:58.001789 [(33)]: DVB subch:0 Decompose()</p><p>2011-08-21 14:04:58.001789 [(33)]: FreeSubChannel CA: freeing sub channel : 0</p><p>2011-08-21 14:04:58.001789 [(33)]: tvcard:FreeSubChannel : no subchannels present, stopping graph</p><p>2011-08-21 14:04:58.001789 [(33)]: dvb:StopGraph called</p><p>2011-08-21 14:04:58.001789 [(33)]: tvcard:FreeAllSubChannels</p><p>2011-08-21 14:04:58.011789 [(33)]: dvb:StopGraph</p><p>2011-08-21 14:04:58.451790 [(33)]: card2:MS_PC 4 -1</p><p>2011-08-21 14:04:58.451790 [(33)]: Controller: MS_PC 4 -1</p><p>2011-08-21 14:05:08.091803 [(33)]: Controller: TimeShiftingWouldUseCard Sky Select 91</p><p>2011-08-21 14:05:08.091803 [(33)]: Controller: find free card for channel Sky Select</p><p>2011-08-21 14:05:08.091803 [(33)]: Controller: got 1 tuning details for Sky Select</p><p>2011-08-21 14:05:08.091803 [(33)]: Controller: channel #1 DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:05:08.101803 [(33)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:05:08.101803 [(33)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:05:08.101803 [(33)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:05:08.101803 [(33)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:05:08.101803 [(33)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:05:08.101803 [(33)]: Controller: found 1 available</p><p>2011-08-21 14:05:08.111803 [(33)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 15 msec</p><p>2011-08-21 14:05:08.111803 [(33)]: CiMenuSupported called cardid 4</p><p>2011-08-21 14:05:08.111803 [(33)]: CiMenuSupported card BDA 2885 TVTuner C supported: False</p><p>2011-08-21 14:05:08.111803 [(33)]: Controller: StartTimeShifting Sky Select 91</p><p>2011-08-21 14:05:08.121803 [(33)]: Controller: find free card for channel Sky Select</p><p>2011-08-21 14:05:08.121803 [(33)]: Controller: got 1 tuning details for Sky Select</p><p>2011-08-21 14:05:08.121803 [(33)]: Controller: channel #1 DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:05:08.121803 [(33)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:05:08.121803 [(33)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:05:08.121803 [(33)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:05:08.121803 [(33)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:05:08.131803 [(33)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:05:08.131803 [(33)]: Controller: found 1 available</p><p>2011-08-21 14:05:08.131803 [(33)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 14 msec</p><p>2011-08-21 14:05:08.131803 [(33)]: card: CardTune 4 Sky Select MS_PC:4:-1</p><p>2011-08-21 14:05:08.131803 [(33)]: card: Tune 4 to Sky Select</p><p>2011-08-21 14:05:08.131803 [(33)]: card: user: MS_PC:4:-1 tune DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam</p><p>2011-08-21 14:05:08.141803 [(33)]: dvbc: Tune:DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam</p><p>2011-08-21 14:05:08.141803 [(33)]: dvb:Submiting tunerequest Channel:Sky Select subChannel:-1 </p><p>2011-08-21 14:05:08.141803 [(33)]: dvb:Getting new subchannel</p><p>2011-08-21 14:05:08.141803 [(33)]: dvb:GetNewSubChannel:0 #0</p><p>2011-08-21 14:05:08.141803 [(33)]: TvDvbChannel ctor new subchIndex:0</p><p>2011-08-21 14:05:08.141803 [(33)]: dvb:Submit tunerequest size:1 new:0</p><p>2011-08-21 14:05:08.141803 [(33)]: subch:0 OnBeforeTune</p><p>2011-08-21 14:05:08.141803 [(33)]: dvb:Submit tunerequest calling put_TuneRequest</p><p>2011-08-21 14:05:08.151803 [(33)]: dvb:Submit tunerequest done calling put_TuneRequest</p><p>2011-08-21 14:05:08.151803 [(33)]: subch:0 OnAfterTune</p><p>2011-08-21 14:05:08.151803 [(33)]: subch:0 OnGraphStart</p><p>2011-08-21 14:05:08.151803 [(33)]: dvb: RunGraph</p><p>2011-08-21 14:05:09.721805 [(33)]: dvb: LockedInOnSignal waiting 20ms</p><p>2011-08-21 14:05:10.521806 [(33)]: dvb: LockedInOnSignal waiting 20ms</p><p>2011-08-21 14:05:11.321807 [(33)]: dvb: LockedInOnSignal waiting 20ms</p><p>2011-08-21 14:05:11.341807 [(33)]: dvb: LockedInOnSignal could not lock onto channel - no signal or bad signal</p><p>2011-08-21 14:05:11.341807 [(33)]: tvcard:FreeSubChannel: subchannels count 1 subch#0 keep graph=False</p><p>2011-08-21 14:05:11.341807 [(33)]: DVB subch:0 Decompose()</p><p>2011-08-21 14:05:11.341807 [(33)]: FreeSubChannel CA: freeing sub channel : 0</p><p>2011-08-21 14:05:11.341807 [(33)]: tvcard:FreeSubChannel : no subchannels present, stopping graph</p><p>2011-08-21 14:05:11.341807 [(33)]: dvb:StopGraph called</p><p>2011-08-21 14:05:11.341807 [(33)]: tvcard:FreeAllSubChannels</p><p>2011-08-21 14:05:11.351807 [(33)]: dvb:StopGraph</p><p>2011-08-21 14:05:11.781808 [(33)]: card2:MS_PC 4 -1</p><p>2011-08-21 14:05:11.781808 [(33)]: Controller: MS_PC 4 -1</p><p>2011-08-21 14:05:23.751825 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:04:23.7317 , False</p><p>2011-08-21 14:05:23.751825 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:05:23.751825 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 14:05:23.751825 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>2011-08-21 14:06:23.761907 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 14:05:23.7518 , False</p><p>2011-08-21 14:06:23.761907 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:06:23.761907 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 14:06:23.761907 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>2011-08-21 14:07:23.771990 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:06:23.7619 , False</p><p>2011-08-21 14:07:23.771990 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:07:23.771990 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 14:07:23.771990 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>2011-08-21 14:07:57.242036 [(17)]: Controller: TimeShiftingWouldUseCard ZDF 431</p><p>2011-08-21 14:07:57.242036 [(17)]: Controller: find free card for channel ZDF</p><p>2011-08-21 14:07:57.242036 [(17)]: Controller: got 1 tuning details for ZDF</p><p>2011-08-21 14:07:57.242036 [(17)]: Controller: channel #1 DVBC:tv:ZDFvision ZDF Freq:394000 ONID:102 TSID:1079 SID:28006 PMT:0x64 FTA:True LCN:102 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:07:57.242036 [(17)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:07:57.252036 [(17)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:07:57.252036 [(17)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:07:57.252036 [(17)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:07:57.252036 [(17)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:07:57.252036 [(17)]: Controller: found 1 available</p><p>2011-08-21 14:07:57.252036 [(17)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 15 msec</p><p>2011-08-21 14:07:57.262036 [(17)]: CiMenuSupported called cardid 4</p><p>2011-08-21 14:07:57.262036 [(17)]: CiMenuSupported card BDA 2885 TVTuner C supported: False</p><p>2011-08-21 14:07:57.662037 [(17)]: Controller: StartTimeShifting ZDF 431</p><p>2011-08-21 14:07:57.662037 [(17)]: Controller: find free card for channel ZDF</p><p>2011-08-21 14:07:57.662037 [(17)]: Controller: got 1 tuning details for ZDF</p><p>2011-08-21 14:07:57.662037 [(17)]: Controller: channel #1 DVBC:tv:ZDFvision ZDF Freq:394000 ONID:102 TSID:1079 SID:28006 PMT:0x64 FTA:True LCN:102 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:07:57.672037 [(17)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:07:57.672037 [(17)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:07:57.672037 [(17)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:07:57.672037 [(17)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:07:57.682037 [(17)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:07:57.682037 [(17)]: Controller: found 1 available</p><p>2011-08-21 14:07:57.682037 [(17)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 18 msec</p><p>2011-08-21 14:07:57.682037 [(17)]: card: CardTune 4 ZDF MS_PC:4:-1</p><p>2011-08-21 14:07:57.682037 [(17)]: card: Tune 4 to ZDF</p><p>2011-08-21 14:07:57.682037 [(17)]: card: user: MS_PC:4:-1 tune DVBC:tv:ZDFvision ZDF Freq:394000 ONID:102 TSID:1079 SID:28006 PMT:0x64 FTA:True LCN:102 SymbolRate:6900 Modulation:Mod256Qam</p><p>2011-08-21 14:07:57.692037 [(17)]: dvbc: Tune:DVBC:tv:ZDFvision ZDF Freq:394000 ONID:102 TSID:1079 SID:28006 PMT:0x64 FTA:True LCN:102 SymbolRate:6900 Modulation:Mod256Qam</p><p>2011-08-21 14:07:57.692037 [(17)]: dvb:Submiting tunerequest Channel:ZDF subChannel:-1 </p><p>2011-08-21 14:07:57.692037 [(17)]: dvb:Getting new subchannel</p><p>2011-08-21 14:07:57.692037 [(17)]: dvb:GetNewSubChannel:0 #0</p><p>2011-08-21 14:07:57.692037 [(17)]: TvDvbChannel ctor new subchIndex:0</p><p>2011-08-21 14:07:57.692037 [(17)]: dvb:Submit tunerequest size:1 new:0</p><p>2011-08-21 14:07:57.692037 [(17)]: subch:0 OnBeforeTune</p><p>2011-08-21 14:07:57.692037 [(17)]: dvb:Submit tunerequest calling put_TuneRequest</p><p>2011-08-21 14:07:57.692037 [(17)]: dvb:Submit tunerequest done calling put_TuneRequest</p><p>2011-08-21 14:07:57.692037 [(17)]: subch:0 OnAfterTune</p><p>2011-08-21 14:07:57.692037 [(17)]: subch:0 OnGraphStart</p><p>2011-08-21 14:07:57.692037 [(17)]: dvb: RunGraph</p><p>2011-08-21 14:07:59.002039 [(17)]: dvb: LockedInOnSignal ok</p><p>2011-08-21 14:07:59.002039 [(17)]: subch:0 OnGraphStarted</p><p>2011-08-21 14:07:59.012039 [(17)]: subch:0 SetupPmtGrabber:pid 64 sid:6D66</p><p>2011-08-21 14:07:59.012039 [(17)]: subch:0 set pmt grabber pmt:64 sid:6D66</p><p>2011-08-21 14:07:59.012039 [(17)]: subch:0 set ca grabber </p><p>2011-08-21 14:07:59.012039 [(17)]: WaitForPMT: Waiting for PMT 64</p><p>2011-08-21 14:07:59.242039 [(15)]: subch:0 OnPMTReceived() pmt:64 ran:True dynamic:False</p><p>2011-08-21 14:07:59.242039 [(17)]: WaitForPMT: Found PMT after 0,2300003 seconds.</p><p>2011-08-21 14:07:59.242039 [(17)]: subch:0 SendPmt:6D66 6D66 FFFFFFFF 1</p><p>2011-08-21 14:07:59.242039 [(17)]: Decode pmt</p><p>2011-08-21 14:07:59.242039 [(17)]: Set descriptor data with length 3</p><p>2011-08-21 14:07:59.242039 [(17)]: Set descriptor data with length 3</p><p>2011-08-21 14:07:59.242039 [(17)]: PROBLEM : descriptor lengths dont match 6 9</p><p>2011-08-21 14:07:59.242039 [(17)]: Set descriptor data with length 3</p><p>2011-08-21 14:07:59.242039 [(17)]: PROBLEM : descriptor lengths dont match 6 9</p><p>2011-08-21 14:07:59.242039 [(17)]: Set descriptor data with length 3</p><p>2011-08-21 14:07:59.242039 [(17)]: PROBLEM : descriptor lengths dont match 6 9</p><p>2011-08-21 14:07:59.242039 [(17)]: Set descriptor data with length 3</p><p>2011-08-21 14:07:59.242039 [(17)]: PROBLEM : descriptor lengths dont match 7 10</p><p>2011-08-21 14:07:59.242039 [(17)]: Set descriptor data with length 10</p><p>2011-08-21 14:07:59.242039 [(17)]: PROBLEM : descriptor lengths dont match 3 13</p><p>2011-08-21 14:07:59.242039 [(17)]: subch:0 SendPMT: Channel is FTA, nothing to do.</p><p>2011-08-21 14:07:59.242039 [(17)]: subch:0 SetMpegPidMapping</p><p>2011-08-21 14:07:59.242039 [(17)]: subch:0 pid:6E pcr</p><p>2011-08-21 14:07:59.242039 [(17)]: subch:0 pid:64 pmt</p><p>2011-08-21 14:07:59.242039 [(17)]: subch:0 pid:6E video type:MPEG-2</p><p>2011-08-21 14:07:59.242039 [(17)]: subch:0 map pid:6E video type:MPEG-2</p><p>2011-08-21 14:07:59.252039 [(17)]: subch:0 pid:78 audio lang:deu type:MPEG-1</p><p>2011-08-21 14:07:59.252039 [(17)]: subch:0 map pid:78 audio lang:deu type:MPEG-1</p><p>2011-08-21 14:07:59.252039 [(17)]: subch:0 pid:79 audio lang:mis type:MPEG-1</p><p>2011-08-21 14:07:59.252039 [(17)]: subch:0 pid:7D audio lang: type:AC3</p><p>2011-08-21 14:07:59.252039 [(17)]: subch:0 map pid:7D audio lang: type:AC3</p><p>2011-08-21 14:07:59.252039 [(17)]: subch:0 pid:82 teletext type:6</p><p>2011-08-21 14:07:59.252039 [(17)]: subch:0 map pid:82 teletext type:6</p><p>2011-08-21 14:07:59.252039 [(17)]: subch:0 pid:83 subtitle type:6</p><p>2011-08-21 14:07:59.252039 [(17)]: subch:0 map pid:83 subtitle type:6</p><p>2011-08-21 14:07:59.252039 [(17)]: subch:0 pid:3B6 type:5</p><p>2011-08-21 14:07:59.252039 [(17)]: Number of HWPIDS that needs to be sent to tuner :12 </p><p>2011-08-21 14:07:59.252039 [(17)]: subch:0 stop tif</p><p>2011-08-21 14:07:59.252039 [(17)]: WaitForPmt: PMT handling took 0,01 seconds.</p><p>2011-08-21 14:08:00.432041 [(17)]: card: Tuner locked: True</p><p>2011-08-21 14:08:00.432041 [(17)]: **************************************************</p><p>2011-08-21 14:08:00.432041 [(17)]: ***** SIGNAL LEVEL: 87, SIGNAL QUALITY: 100 *****</p><p>2011-08-21 14:08:00.432041 [(17)]: **************************************************</p><p>2011-08-21 14:08:00.432041 [(17)]: card: tuned user: MS_PC subchannel: 0</p><p>2011-08-21 14:08:00.432041 [(17)]: user:MS_PC add</p><p>2011-08-21 14:08:00.432041 [(17)]: card2:MS_PC 4 0</p><p>2011-08-21 14:08:00.432041 [(17)]: Controller: MS_PC 4 0</p><p>2011-08-21 14:08:00.432041 [(17)]: control2:MS_PC 4 0</p><p>2011-08-21 14:08:00.442041 [(17)]: Controller: delete timeshift files C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts</p><p>2011-08-21 14:08:00.442041 [(17)]: card: StartTimeShifting 4 C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts </p><p>2011-08-21 14:08:00.442041 [(17)]: card: CAM enabled : True</p><p>2011-08-21 14:08:00.442041 [(17)]: subch:0 SetTimeShiftFileName:C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts</p><p>2011-08-21 14:08:00.442041 [(17)]: Set video / audio observer</p><p>2011-08-21 14:08:00.442041 [(17)]: subch:0 SetTimeShiftFileName fill in pids</p><p>2011-08-21 14:08:00.452041 [(17)]: subch:0-0 tswriter StartTimeshifting...</p><p>2011-08-21 14:08:00.452041 [(17)]: card: WaitForTimeShiftFile - waiting _eventAudio & _eventVideo</p><p>2011-08-21 14:08:00.492041 [(15)]: PID seen - type = Video</p><p>2011-08-21 14:08:00.492041 [(15)]: audioVideoEventHandler Video</p><p>2011-08-21 14:08:00.502041 [(15)]: PID seen - type = Audio</p><p>2011-08-21 14:08:00.502041 [(15)]: audioVideoEventHandler Audio</p><p>2011-08-21 14:08:00.502041 [(17)]: card: WaitForTimeShiftFile - video and audio are seen after 0,05 seconds</p><p>2011-08-21 14:08:00.512041 [(17)]: Timeshifting epg grabber started.</p><p>2011-08-21 14:08:00.512041 [(17)]: dvb:grab epg...</p><p>2011-08-21 14:08:00.512041 [(17)]: user:MS_PC card:4 sub:0 add stream:C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer</p><p>2011-08-21 14:08:00.512041 [(17)]: RTSP: add stream stream4.0 file:C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer</p><p>2011-08-21 14:08:00.512041 [(17)]: Controller: StartTimeShifting started on card:4 to C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer</p><p>2011-08-21 14:08:00.522041 [Channel state thread(25)]: Controller: DoSetChannelStates for 233 channels</p><p>2011-08-21 14:08:00.522041 [(17)]: CiMenuSupported called cardid 4</p><p>2011-08-21 14:08:00.522041 [(17)]: CiMenuSupported card BDA 2885 TVTuner C supported: False</p><p>2011-08-21 14:08:00.532041 [(15)]: PID seen - type = Audio</p><p>2011-08-21 14:08:00.582041 [(15)]: PID seen - type = Audio</p><p>2011-08-21 14:08:01.882043 [Channel state thread(25)]: ChannelStates.DoSetChannelStates took 1368 msec</p><p>2011-08-21 14:08:19.022066 [(15)]: OnLinkageReceived()</p><p>2011-08-21 14:08:19.022066 [Channel linkage update thread(24)]: ChannelLinkage received. 0 portal channels read</p><p>2011-08-21 14:08:23.792073 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:07:23.7719 , False</p><p>2011-08-21 14:08:23.792073 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:08:23.792073 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:True</p><p>2011-08-21 14:08:49.702109 [(22)]: Controller: TimeShiftingWouldUseCard Sky Select 91</p><p>2011-08-21 14:08:49.702109 [(22)]: Controller: find free card for channel Sky Select</p><p>2011-08-21 14:08:49.712109 [(22)]: Controller: got 1 tuning details for Sky Select</p><p>2011-08-21 14:08:49.712109 [(22)]: Controller: channel #1 DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:08:49.712109 [(22)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:08:49.712109 [(22)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:08:49.712109 [(22)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:08:49.712109 [(22)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:08:49.722109 [(22)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:08:49.722109 [(22)]: Controller: found 1 available</p><p>2011-08-21 14:08:49.722109 [(22)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 17 msec</p><p>2011-08-21 14:08:50.662110 [(22)]: Controller: StartTimeShifting Sky Select 91</p><p>2011-08-21 14:08:50.662110 [(22)]: Controller: find free card for channel Sky Select</p><p>2011-08-21 14:08:50.662110 [(22)]: Controller: got 1 tuning details for Sky Select</p><p>2011-08-21 14:08:50.672110 [(22)]: Controller: channel #1 DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:08:50.672110 [(22)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:08:50.672110 [(22)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:08:50.672110 [(22)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:08:50.672110 [(22)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:08:50.682110 [(22)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:08:50.682110 [(22)]: Controller: found 1 available</p><p>2011-08-21 14:08:50.682110 [(22)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 21 msec</p><p>2011-08-21 14:08:50.692110 [(22)]: tvcard:FreeSubChannel: subchannels count 1 subch#0 keep graph=True</p><p>2011-08-21 14:08:50.692110 [(22)]: tvcard:FreeSubChannel :0 - is timeshifting (skipped)</p><p>2011-08-21 14:08:50.692110 [(22)]: card: CardTune 4 Sky Select MS_PC:4:-1</p><p>2011-08-21 14:08:50.692110 [(22)]: card: Tune 4 to Sky Select</p><p>2011-08-21 14:08:50.692110 [(22)]: card: user: MS_PC:4:0 tune DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam</p><p>2011-08-21 14:08:50.702110 [(22)]: card: to different transponder</p><p>2011-08-21 14:08:50.702110 [(22)]: dvbc: Tune:DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam</p><p>2011-08-21 14:08:50.702110 [(22)]: dvb:Submiting tunerequest Channel:Sky Select subChannel:0 </p><p>2011-08-21 14:08:50.702110 [(22)]: dvb:using existing subchannel:0</p><p>2011-08-21 14:08:50.702110 [(22)]: dvb:Submit tunerequest size:1 new:0</p><p>2011-08-21 14:08:50.702110 [(22)]: subch:0 OnBeforeTune</p><p>2011-08-21 14:08:50.702110 [(22)]: dvb:Submit tunerequest calling put_TuneRequest</p><p>2011-08-21 14:08:51.072111 [(22)]: dvb:Submit tunerequest done calling put_TuneRequest</p><p>2011-08-21 14:08:51.072111 [(22)]: subch:0 OnAfterTune</p><p>2011-08-21 14:08:52.902113 [(22)]: dvb: LockedInOnSignal waiting 20ms</p><p>2011-08-21 14:08:54.772116 [(22)]: dvb: LockedInOnSignal waiting 20ms</p><p>2011-08-21 14:08:54.792116 [(22)]: dvb: LockedInOnSignal could not lock onto channel - no signal or bad signal</p><p>2011-08-21 14:08:54.792116 [(22)]: tvcard:FreeSubChannel: subchannels count 1 subch#0 keep graph=False</p><p>2011-08-21 14:08:54.792116 [(22)]: tvcard:FreeSubChannel :0 - is timeshifting (skipped)</p><p>2011-08-21 14:08:54.792116 [(22)]: card2:MS_PC 4 0</p><p>2011-08-21 14:08:54.792116 [(22)]: Controller: MS_PC 4 0</p><p>2011-08-21 14:08:54.822116 [(22)]: Controller: StopTimeShifting 4</p><p>2011-08-21 14:08:54.832116 [(22)]: card BDA 2885 TVTuner C: StopTimeShifting user:MS_PC sub:0</p><p>2011-08-21 14:08:54.832116 [(22)]: card: StopTimeShifting user:MS_PC sub:0</p><p>2011-08-21 14:08:54.832116 [(22)]: card not IDLE - removing user: MS_PC</p><p>2011-08-21 14:08:54.832116 [(22)]: user:MS_PC remove</p><p>2011-08-21 14:08:54.832116 [(22)]: subch:0-0 tswriter StopTimeshifting...</p><p>2011-08-21 14:08:54.832116 [(22)]: tvcard:FreeSubChannel: subchannels count 1 subch#0 keep graph=False</p><p>2011-08-21 14:08:54.832116 [(22)]: DVB subch:0 Decompose()</p><p>2011-08-21 14:08:54.832116 [(22)]: FreeSubChannel CA: freeing sub channel : 0</p><p>2011-08-21 14:08:54.842116 [(22)]: tvcard:FreeSubChannel : no subchannels present, stopping graph</p><p>2011-08-21 14:08:54.842116 [(22)]: dvb:StopGraph called</p><p>2011-08-21 14:08:54.842116 [(22)]: tvcard:FreeAllSubChannels</p><p>2011-08-21 14:08:54.842116 [(22)]: dvb:StopGraph</p><p>2011-08-21 14:08:55.162116 [(22)]: dvb:StopGraph called</p><p>2011-08-21 14:08:55.162116 [(22)]: tvcard:FreeAllSubChannels</p><p>2011-08-21 14:08:55.162116 [TS_File_Cleanup(27)]: card: delete timeshift files C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts</p><p>2011-08-21 14:08:55.162116 [(22)]: dvb:StopGraph filterstate already stopped, returning.</p><p>2011-08-21 14:08:55.162116 [(22)]: user:MS_PC remove</p><p>2011-08-21 14:08:55.162116 [TS_File_Cleanup(27)]: card: trying to delete C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer</p><p>2011-08-21 14:08:55.162116 [(22)]: Controller:Timeshifting stopped on card:4</p><p>2011-08-21 14:08:55.162116 [(22)]: RTSP: remove stream stream4.0</p><p>2011-08-21 14:08:55.162116 [Channel state thread(29)]: Controller: DoSetChannelStates for 233 channels</p><p>2011-08-21 14:08:55.172116 [Channel state thread(29)]: ChannelStates.DoSetChannelStates took 1 msec</p><p>2011-08-21 14:09:00.162123 [TS_File_Cleanup(27)]: card: delete timeshift files C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts</p><p>2011-08-21 14:09:00.162123 [TS_File_Cleanup(27)]: card: trying to delete C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer</p><p>2011-08-21 14:09:00.162123 [TS_File_Cleanup(27)]: card: deleted file C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer</p><p>2011-08-21 14:09:00.162123 [TS_File_Cleanup(27)]: card: trying to delete C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer1.ts</p><p>2011-08-21 14:09:00.162123 [TS_File_Cleanup(27)]: card: deleted file C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer1.ts</p><p>2011-08-21 14:09:02.272126 [(31)]: Controller: find free card for channel Sky Bundesliga</p><p>2011-08-21 14:09:02.282126 [(31)]: Controller: got 1 tuning details for Sky Bundesliga</p><p>2011-08-21 14:09:02.282126 [(31)]: Controller: channel #1 DVBC:tv:SKY Sky Bundesliga Freq:378000 ONID:133 TSID:4 SID:223 PMT:0x66 FTA:False LCN:764 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:09:02.282126 [(31)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:09:02.282126 [(31)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:09:02.282126 [(31)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:09:02.282126 [(31)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:09:02.292126 [(31)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:09:02.292126 [(31)]: Controller: found 1 available</p><p>2011-08-21 14:09:02.292126 [(31)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 17 msec</p><p>2011-08-21 14:09:02.302126 [(31)]: Controller: TimeShiftingWouldUseCard 2. Liga Konf. 95</p><p>2011-08-21 14:09:02.302126 [(31)]: Controller: find free card for channel Sky Bundesliga</p><p>2011-08-21 14:09:02.302126 [(31)]: Controller: got 1 tuning details for Sky Bundesliga</p><p>2011-08-21 14:09:02.302126 [(31)]: Controller: channel #1 DVBC:tv:SKY Sky Bundesliga Freq:378000 ONID:133 TSID:4 SID:223 PMT:0x66 FTA:False LCN:764 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:09:02.302126 [(31)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:09:02.302126 [(31)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:09:02.302126 [(31)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:09:02.302126 [(31)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:09:02.312126 [(31)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:09:02.312126 [(31)]: Controller: found 1 available</p><p>2011-08-21 14:09:02.312126 [(31)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 16 msec</p><p>2011-08-21 14:09:02.312126 [(31)]: CiMenuSupported called cardid 4</p><p>2011-08-21 14:09:02.322126 [(31)]: CiMenuSupported card BDA 2885 TVTuner C supported: False</p><p>2011-08-21 14:09:02.322126 [(31)]: Controller: StartTimeShifting 2. Liga Konf. 95</p><p>2011-08-21 14:09:02.322126 [(31)]: Controller: find free card for channel Sky Bundesliga</p><p>2011-08-21 14:09:02.322126 [(31)]: Controller: got 1 tuning details for Sky Bundesliga</p><p>2011-08-21 14:09:02.322126 [(31)]: Controller: channel #1 DVBC:tv:SKY Sky Bundesliga Freq:378000 ONID:133 TSID:4 SID:223 PMT:0x66 FTA:False LCN:764 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:09:02.332126 [(31)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:09:02.332126 [(31)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:09:02.332126 [(31)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:09:02.332126 [(31)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:09:02.332126 [(31)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:09:02.332126 [(31)]: Controller: found 1 available</p><p>2011-08-21 14:09:02.332126 [(31)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 13 msec</p><p>2011-08-21 14:09:02.342126 [(31)]: card: CardTune 4 Sky Bundesliga MS_PC:4:-1</p><p>2011-08-21 14:09:02.342126 [(31)]: card: Tune 4 to Sky Bundesliga</p><p>2011-08-21 14:09:02.342126 [(31)]: card: user: MS_PC:4:-1 tune DVBC:tv:SKY Sky Bundesliga Freq:378000 ONID:133 TSID:4 SID:223 PMT:0x66 FTA:False LCN:764 SymbolRate:6900 Modulation:Mod256Qam</p><p>2011-08-21 14:09:02.352126 [(31)]: dvbc: Tune:DVBC:tv:SKY Sky Bundesliga Freq:378000 ONID:133 TSID:4 SID:223 PMT:0x66 FTA:False LCN:764 SymbolRate:6900 Modulation:Mod256Qam</p><p>2011-08-21 14:09:02.352126 [(31)]: dvb:Submiting tunerequest Channel:Sky Bundesliga subChannel:-1 </p><p>2011-08-21 14:09:02.352126 [(31)]: dvb:Getting new subchannel</p><p>2011-08-21 14:09:02.352126 [(31)]: dvb:GetNewSubChannel:0 #0</p><p>2011-08-21 14:09:02.352126 [(31)]: TvDvbChannel ctor new subchIndex:0</p><p>2011-08-21 14:09:02.352126 [(31)]: dvb:Submit tunerequest size:1 new:0</p><p>2011-08-21 14:09:02.352126 [(31)]: subch:0 OnBeforeTune</p><p>2011-08-21 14:09:02.352126 [(31)]: dvb:Submit tunerequest calling put_TuneRequest</p><p>2011-08-21 14:09:02.352126 [(31)]: dvb:Submit tunerequest done calling put_TuneRequest</p><p>2011-08-21 14:09:02.352126 [(31)]: subch:0 OnAfterTune</p><p>2011-08-21 14:09:02.352126 [(31)]: subch:0 OnGraphStart</p><p>2011-08-21 14:09:02.352126 [(31)]: dvb: RunGraph</p><p>2011-08-21 14:09:03.962128 [(31)]: dvb: LockedInOnSignal waiting 20ms</p><p>2011-08-21 14:09:04.752130 [(31)]: dvb: LockedInOnSignal waiting 20ms</p><p>2011-08-21 14:09:05.552131 [(31)]: dvb: LockedInOnSignal waiting 20ms</p><p>2011-08-21 14:09:05.572131 [(31)]: dvb: LockedInOnSignal could not lock onto channel - no signal or bad signal</p><p>2011-08-21 14:09:05.572131 [(31)]: tvcard:FreeSubChannel: subchannels count 1 subch#0 keep graph=False</p><p>2011-08-21 14:09:05.572131 [(31)]: DVB subch:0 Decompose()</p><p>2011-08-21 14:09:05.572131 [(31)]: FreeSubChannel CA: freeing sub channel : 0</p><p>2011-08-21 14:09:05.572131 [(31)]: tvcard:FreeSubChannel : no subchannels present, stopping graph</p><p>2011-08-21 14:09:05.572131 [(31)]: dvb:StopGraph called</p><p>2011-08-21 14:09:05.572131 [(31)]: tvcard:FreeAllSubChannels</p><p>2011-08-21 14:09:05.582131 [(31)]: dvb:StopGraph</p><p>2011-08-21 14:09:05.992131 [(31)]: card2:MS_PC 4 -1</p><p>2011-08-21 14:09:05.992131 [(31)]: Controller: MS_PC 4 -1</p><p>2011-08-21 14:09:23.482155 [(24)]: Controller: find free card for channel Das Erste</p><p>2011-08-21 14:09:23.482155 [(24)]: Controller: got 1 tuning details for Das Erste</p><p>2011-08-21 14:09:23.482155 [(24)]: Controller: channel #1 DVBC:tv:ARD Das Erste Freq:410000 ONID:41985 TSID:1101 SID:28106 PMT:0x64 FTA:True LCN:101 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:09:23.492155 [(24)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:09:23.492155 [(24)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:09:23.492155 [(24)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:09:23.492155 [(24)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:09:23.492155 [(24)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:09:23.492155 [(24)]: Controller: found 1 available</p><p>2011-08-21 14:09:23.492155 [(24)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 15 msec</p><p>2011-08-21 14:09:23.502155 [(24)]: Controller: TimeShiftingWouldUseCard Das Erste 130</p><p>2011-08-21 14:09:23.502155 [(24)]: Controller: find free card for channel Das Erste</p><p>2011-08-21 14:09:23.502155 [(24)]: Controller: got 1 tuning details for Das Erste</p><p>2011-08-21 14:09:23.502155 [(24)]: Controller: channel #1 DVBC:tv:ARD Das Erste Freq:410000 ONID:41985 TSID:1101 SID:28106 PMT:0x64 FTA:True LCN:101 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:09:23.502155 [(24)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:09:23.502155 [(24)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:09:23.502155 [(24)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:09:23.502155 [(24)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:09:23.512155 [(24)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:09:23.512155 [(24)]: Controller: found 1 available</p><p>2011-08-21 14:09:23.512155 [(24)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 13 msec</p><p>2011-08-21 14:09:23.512155 [(24)]: CiMenuSupported called cardid 4</p><p>2011-08-21 14:09:23.512155 [(24)]: CiMenuSupported card BDA 2885 TVTuner C supported: False</p><p>2011-08-21 14:09:23.662156 [(24)]: Controller: StartTimeShifting Das Erste 130</p><p>2011-08-21 14:09:23.662156 [(24)]: Controller: find free card for channel Das Erste</p><p>2011-08-21 14:09:23.662156 [(24)]: Controller: got 1 tuning details for Das Erste</p><p>2011-08-21 14:09:23.662156 [(24)]: Controller: channel #1 DVBC:tv:ARD Das Erste Freq:410000 ONID:41985 TSID:1101 SID:28106 PMT:0x64 FTA:True LCN:101 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:09:23.672156 [(24)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:09:23.672156 [(24)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:09:23.672156 [(24)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:09:23.672156 [(24)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:09:23.682156 [(24)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:09:23.682156 [(24)]: Controller: found 1 available</p><p>2011-08-21 14:09:23.682156 [(24)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 20 msec</p><p>2011-08-21 14:09:23.682156 [(24)]: card: CardTune 4 Das Erste MS_PC:4:-1</p><p>2011-08-21 14:09:23.682156 [(24)]: card: Tune 4 to Das Erste</p><p>2011-08-21 14:09:23.682156 [(24)]: card: user: MS_PC:4:-1 tune DVBC:tv:ARD Das Erste Freq:410000 ONID:41985 TSID:1101 SID:28106 PMT:0x64 FTA:True LCN:101 SymbolRate:6900 Modulation:Mod256Qam</p><p>2011-08-21 14:09:23.692156 [(24)]: dvbc: Tune:DVBC:tv:ARD Das Erste Freq:410000 ONID:41985 TSID:1101 SID:28106 PMT:0x64 FTA:True LCN:101 SymbolRate:6900 Modulation:Mod256Qam</p><p>2011-08-21 14:09:23.702156 [(24)]: dvb:Submiting tunerequest Channel:Das Erste subChannel:-1 </p><p>2011-08-21 14:09:23.702156 [(24)]: dvb:Getting new subchannel</p><p>2011-08-21 14:09:23.702156 [(24)]: dvb:GetNewSubChannel:0 #0</p><p>2011-08-21 14:09:23.702156 [(24)]: TvDvbChannel ctor new subchIndex:0</p><p>2011-08-21 14:09:23.702156 [(24)]: dvb:Submit tunerequest size:1 new:0</p><p>2011-08-21 14:09:23.702156 [(24)]: subch:0 OnBeforeTune</p><p>2011-08-21 14:09:23.702156 [(24)]: dvb:Submit tunerequest calling put_TuneRequest</p><p>2011-08-21 14:09:23.702156 [(24)]: dvb:Submit tunerequest done calling put_TuneRequest</p><p>2011-08-21 14:09:23.702156 [(24)]: subch:0 OnAfterTune</p><p>2011-08-21 14:09:23.702156 [(24)]: subch:0 OnGraphStart</p><p>2011-08-21 14:09:23.702156 [(24)]: dvb: RunGraph</p><p>2011-08-21 14:09:23.792156 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 14:08:23.7920 , False</p><p>2011-08-21 14:09:23.792156 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:09:23.792156 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 14:09:23.802156 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>2011-08-21 14:09:25.332158 [(24)]: dvb: LockedInOnSignal ok</p><p>2011-08-21 14:09:25.332158 [(24)]: subch:0 OnGraphStarted</p><p>2011-08-21 14:09:25.342158 [(24)]: subch:0 SetupPmtGrabber:pid 64 sid:6DCA</p><p>2011-08-21 14:09:25.342158 [(24)]: subch:0 set pmt grabber pmt:64 sid:6DCA</p><p>2011-08-21 14:09:25.342158 [(24)]: subch:0 set ca grabber </p><p>2011-08-21 14:09:25.342158 [(24)]: WaitForPMT: Waiting for PMT 64</p><p>2011-08-21 14:09:25.572158 [(27)]: subch:OnCaReceived()</p><p>2011-08-21 14:09:25.582158 [(27)]: subch:0 OnPMTReceived() pmt:64 ran:True dynamic:False</p><p>2011-08-21 14:09:25.582158 [(24)]: WaitForPMT: Found PMT after 0,2400004 seconds.</p><p>2011-08-21 14:09:25.582158 [(24)]: subch:0 SendPmt:6DCA 6DCA FFFFFFFF A</p><p>2011-08-21 14:09:25.582158 [(24)]: Decode pmt</p><p>2011-08-21 14:09:25.582158 [(24)]: Set descriptor data with length 3</p><p>2011-08-21 14:09:25.582158 [(24)]: Set descriptor data with length 6</p><p>2011-08-21 14:09:25.582158 [(24)]: PROBLEM : descriptor lengths dont match 3 9</p><p>2011-08-21 14:09:25.582158 [(24)]: Set descriptor data with length 6</p><p>2011-08-21 14:09:25.582158 [(24)]: PROBLEM : descriptor lengths dont match 3 9</p><p>2011-08-21 14:09:25.582158 [(24)]: Set descriptor data with length 7</p><p>2011-08-21 14:09:25.582158 [(24)]: PROBLEM : descriptor lengths dont match 3 10</p><p>2011-08-21 14:09:25.582158 [(24)]: Set descriptor data with length 3</p><p>2011-08-21 14:09:25.582158 [(24)]: PROBLEM : descriptor lengths dont match 10 13</p><p>2011-08-21 14:09:25.582158 [(24)]: Set descriptor data with length 6</p><p>2011-08-21 14:09:25.582158 [(24)]: PROBLEM : descriptor lengths dont match 3 9</p><p>2011-08-21 14:09:25.582158 [(24)]: Set descriptor data with length 3</p><p>2011-08-21 14:09:25.582158 [(24)]: subch:0 SendPMT: Channel is FTA, nothing to do.</p><p>2011-08-21 14:09:25.582158 [(24)]: subch:0 SetMpegPidMapping</p><p>2011-08-21 14:09:25.582158 [(24)]: subch:0 pid:65 pcr</p><p>2011-08-21 14:09:25.582158 [(24)]: subch:0 pid:64 pmt</p><p>2011-08-21 14:09:25.582158 [(24)]: subch:0 pid:65 video type:MPEG-2</p><p>2011-08-21 14:09:25.582158 [(24)]: subch:0 map pid:65 video type:MPEG-2</p><p>2011-08-21 14:09:25.592158 [(24)]: subch:0 pid:66 audio lang:deu type:MPEG-1</p><p>2011-08-21 14:09:25.592158 [(24)]: subch:0 map pid:66 audio lang:deu type:MPEG-1</p><p>2011-08-21 14:09:25.592158 [(24)]: subch:0 pid:67 audio lang: type:MPEG-1</p><p>2011-08-21 14:09:25.592158 [(24)]: subch:0 pid:68 teletext type:6</p><p>2011-08-21 14:09:25.592158 [(24)]: subch:0 map pid:68 teletext type:6</p><p>2011-08-21 14:09:25.592158 [(24)]: subch:0 pid:69 subtitle type:6</p><p>2011-08-21 14:09:25.592158 [(24)]: subch:0 map pid:69 subtitle type:6</p><p>2011-08-21 14:09:25.592158 [(24)]: subch:0 pid:6A audio lang:deu type:AC3</p><p>2011-08-21 14:09:25.592158 [(24)]: subch:0 map pid:6A audio lang:deu type:AC3</p><p>2011-08-21 14:09:25.592158 [(24)]: subch:0 pid:816 type:5</p><p>2011-08-21 14:09:25.592158 [(24)]: subch:0 pid:87B type:B</p><p>2011-08-21 14:09:25.592158 [(24)]: Number of HWPIDS that needs to be sent to tuner :12 </p><p>2011-08-21 14:09:25.592158 [(24)]: subch:0 stop tif</p><p>2011-08-21 14:09:25.592158 [(24)]: WaitForPmt: PMT handling took 0,01 seconds.</p><p>2011-08-21 14:09:26.362159 [(24)]: card: Tuner locked: True</p><p>2011-08-21 14:09:26.362159 [(24)]: **************************************************</p><p>2011-08-21 14:09:26.362159 [(24)]: ***** SIGNAL LEVEL: 0, SIGNAL QUALITY: 50 *****</p><p>2011-08-21 14:09:26.372159 [(24)]: **************************************************</p><p>2011-08-21 14:09:26.372159 [(24)]: card: tuned user: MS_PC subchannel: 0</p><p>2011-08-21 14:09:26.372159 [(24)]: user:MS_PC add</p><p>2011-08-21 14:09:26.372159 [(24)]: card2:MS_PC 4 0</p><p>2011-08-21 14:09:26.372159 [(24)]: Controller: MS_PC 4 0</p><p>2011-08-21 14:09:26.372159 [(24)]: control2:MS_PC 4 0</p><p>2011-08-21 14:09:26.372159 [(24)]: Controller: delete timeshift files C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts</p><p>2011-08-21 14:09:26.372159 [(24)]: card: StartTimeShifting 4 C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts </p><p>2011-08-21 14:09:26.382159 [(24)]: card: CAM enabled : True</p><p>2011-08-21 14:09:26.382159 [(24)]: subch:0 SetTimeShiftFileName:C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts</p><p>2011-08-21 14:09:26.382159 [(24)]: Set video / audio observer</p><p>2011-08-21 14:09:26.382159 [(24)]: subch:0 SetTimeShiftFileName fill in pids</p><p>2011-08-21 14:09:26.382159 [(24)]: subch:0-0 tswriter StartTimeshifting...</p><p>2011-08-21 14:09:26.382159 [(24)]: card: WaitForTimeShiftFile - waiting _eventAudio & _eventVideo</p><p>2011-08-21 14:09:26.392159 [(27)]: PID seen - type = Audio</p><p>2011-08-21 14:09:26.392159 [(27)]: audioVideoEventHandler Audio</p><p>2011-08-21 14:09:26.402159 [(27)]: PID seen - type = Audio</p><p>2011-08-21 14:09:26.432159 [(27)]: PID seen - type = Video</p><p>2011-08-21 14:09:26.432159 [(27)]: audioVideoEventHandler Video</p><p>2011-08-21 14:09:26.432159 [(24)]: card: WaitForTimeShiftFile - video and audio are seen after 0,05 seconds</p><p>2011-08-21 14:09:26.432159 [(24)]: Timeshifting epg grabber started.</p><p>2011-08-21 14:09:26.432159 [(24)]: dvb:grab epg...</p><p>2011-08-21 14:09:26.442159 [(24)]: user:MS_PC card:4 sub:0 add stream:C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer</p><p>2011-08-21 14:09:26.442159 [(24)]: RTSP: add stream stream4.0 file:C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer</p><p>2011-08-21 14:09:26.442159 [(27)]: PID seen - type = Audio</p><p>2011-08-21 14:09:26.442159 [(24)]: Controller: StartTimeShifting started on card:4 to C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer</p><p>2011-08-21 14:09:26.442159 [Channel state thread(34)]: Controller: DoSetChannelStates for 233 channels</p><p>2011-08-21 14:09:26.462160 [(24)]: CiMenuSupported called cardid 4</p><p>2011-08-21 14:09:26.462160 [(24)]: CiMenuSupported card BDA 2885 TVTuner C supported: False</p><p>2011-08-21 14:09:27.792161 [Channel state thread(34)]: ChannelStates.DoSetChannelStates took 1351 msec</p><p>2011-08-21 14:09:44.002184 [(27)]: OnLinkageReceived()</p><p>2011-08-21 14:09:44.012184 [Channel linkage update thread(34)]: ChannelLinkage received. 0 portal channels read</p><p>2011-08-21 14:10:23.822239 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:09:23.8021 , False</p><p>2011-08-21 14:10:23.822239 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:10:23.822239 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:True</p><p>2011-08-21 14:10:37.972258 [EPG Update thread(34)]: schedule.SynchProgramStatesForAll</p><p>2011-08-21 14:11:23.832321 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 14:10:23.8222 , False</p><p>2011-08-21 14:11:23.832321 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:11:23.832321 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:True</p><p>2011-08-21 14:11:31.082331 [(29)]: Controller: StopTimeShifting 4</p><p>2011-08-21 14:11:31.082331 [(29)]: card BDA 2885 TVTuner C: StopTimeShifting user:MS_PC sub:0</p><p>2011-08-21 14:11:31.092332 [(29)]: card: StopTimeShifting user:MS_PC sub:0</p><p>2011-08-21 14:11:31.092332 [(29)]: card not IDLE - removing user: MS_PC</p><p>2011-08-21 14:11:31.092332 [(29)]: user:MS_PC remove</p><p>2011-08-21 14:11:31.092332 [(29)]: subch:0-0 tswriter StopTimeshifting...</p><p>2011-08-21 14:11:31.092332 [(29)]: tvcard:FreeSubChannel: subchannels count 1 subch#0 keep graph=False</p><p>2011-08-21 14:11:31.092332 [(29)]: DVB subch:0 Decompose()</p><p>2011-08-21 14:11:31.092332 [(29)]: FreeSubChannel CA: freeing sub channel : 0</p><p>2011-08-21 14:11:31.092332 [(29)]: tvcard:FreeSubChannel : no subchannels present, stopping graph</p><p>2011-08-21 14:11:31.092332 [(29)]: dvb:StopGraph called</p><p>2011-08-21 14:11:31.092332 [(29)]: tvcard:FreeAllSubChannels</p><p>2011-08-21 14:11:31.092332 [(29)]: dvb:StopGraph</p><p>2011-08-21 14:11:31.332332 [(29)]: dvb:StopGraph called</p><p>2011-08-21 14:11:31.332332 [(29)]: tvcard:FreeAllSubChannels</p><p>2011-08-21 14:11:31.332332 [TS_File_Cleanup(31)]: card: delete timeshift files C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts</p><p>2011-08-21 14:11:31.332332 [(29)]: dvb:StopGraph filterstate already stopped, returning.</p><p>2011-08-21 14:11:31.332332 [TS_File_Cleanup(31)]: card: trying to delete C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer</p><p>2011-08-21 14:11:31.332332 [(29)]: user:MS_PC remove</p><p>2011-08-21 14:11:31.332332 [(29)]: Controller:Timeshifting stopped on card:4</p><p>2011-08-21 14:11:31.332332 [(29)]: RTSP: remove stream stream4.0</p><p>2011-08-21 14:11:31.342332 [Channel state thread(25)]: Controller: DoSetChannelStates for 233 channels</p><p>2011-08-21 14:11:31.342332 [Channel state thread(25)]: ChannelStates.DoSetChannelStates took 0 msec</p><p>2011-08-21 14:11:36.332339 [TS_File_Cleanup(31)]: card: delete timeshift files C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts</p><p>2011-08-21 14:11:36.332339 [TS_File_Cleanup(31)]: card: trying to delete C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer</p><p>2011-08-21 14:11:36.332339 [TS_File_Cleanup(31)]: card: deleted file C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer</p><p>2011-08-21 14:11:36.342339 [TS_File_Cleanup(31)]: card: trying to delete C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer1.ts</p><p>2011-08-21 14:11:36.382339 [TS_File_Cleanup(31)]: card: deleted file C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer1.ts</p><p>2011-08-21 14:12:23.841502 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:11:23.8323 , False</p><p>2011-08-21 14:12:23.842502 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:12:23.842502 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 14:12:23.844502 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>2011-08-21 14:13:23.852934 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 14:12:23.8445 , False</p><p>2011-08-21 14:13:23.852934 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:13:23.853934 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 14:13:23.856935 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>2011-08-21 14:14:23.833116 [(31)]: Controller: DoSetChannelStates for 25 channels</p><p>2011-08-21 14:14:23.863116 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 14:13:23.8569 , False</p><p>2011-08-21 14:14:23.863116 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:14:23.863116 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 14:14:23.873116 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>2011-08-21 14:14:23.963116 [(31)]: ChannelStates.DoSetChannelStates took 127 msec</p><p>2011-08-21 14:14:25.643118 [(31)]: Controller: DoSetChannelStates for 35 channels</p><p>2011-08-21 14:14:26.283119 [(31)]: ChannelStates.DoSetChannelStates took 638 msec</p><p>2011-08-21 14:14:26.353119 [(31)]: Controller: DoSetChannelStates for 25 channels</p><p>2011-08-21 14:14:26.483119 [(31)]: ChannelStates.DoSetChannelStates took 138 msec</p><p>2011-08-21 14:14:26.913120 [(31)]: Controller: DoSetChannelStates for 35 channels</p><p>2011-08-21 14:14:27.093120 [(31)]: ChannelStates.DoSetChannelStates took 179 msec</p><p>2011-08-21 14:14:31.213126 [(31)]: Controller: find free card for channel Sky Select</p><p>2011-08-21 14:14:31.213126 [(31)]: Controller: got 1 tuning details for Sky Select</p><p>2011-08-21 14:14:31.213126 [(31)]: Controller: channel #1 DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:14:31.223126 [(31)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:14:31.223126 [(31)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:14:31.223126 [(31)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:14:31.223126 [(31)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:14:31.233126 [(31)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:14:31.233126 [(31)]: Controller: found 1 available</p><p>2011-08-21 14:14:31.233126 [(31)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 20 msec</p><p>2011-08-21 14:14:31.243126 [(31)]: Controller: TimeShiftingWouldUseCard Sky Select 91</p><p>2011-08-21 14:14:31.243126 [(31)]: Controller: find free card for channel Sky Select</p><p>2011-08-21 14:14:31.243126 [(31)]: Controller: got 1 tuning details for Sky Select</p><p>2011-08-21 14:14:31.243126 [(31)]: Controller: channel #1 DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:14:31.253126 [(31)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:14:31.253126 [(31)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:14:31.253126 [(31)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:14:31.253126 [(31)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:14:31.253126 [(31)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:14:31.253126 [(31)]: Controller: found 1 available</p><p>2011-08-21 14:14:31.253126 [(31)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 16 msec</p><p>2011-08-21 14:14:31.263126 [(31)]: CiMenuSupported called cardid 4</p><p>2011-08-21 14:14:31.263126 [(31)]: CiMenuSupported card BDA 2885 TVTuner C supported: False</p><p>2011-08-21 14:14:31.263126 [(31)]: Controller: StartTimeShifting Sky Select 91</p><p>2011-08-21 14:14:31.263126 [(31)]: Controller: find free card for channel Sky Select</p><p>2011-08-21 14:14:31.273126 [(31)]: Controller: got 1 tuning details for Sky Select</p><p>2011-08-21 14:14:31.273126 [(31)]: Controller: channel #1 DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam </p><p>2011-08-21 14:14:31.273126 [(31)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True</p><p>2011-08-21 14:14:31.273126 [(31)]: Controller: card:3 type:DvbT is disabled</p><p>2011-08-21 14:14:31.273126 [(31)]: Controller: card:5 type:Analog is disabled</p><p>2011-08-21 14:14:31.273126 [(31)]: Controller: card:6 type:RadioWebStream is disabled</p><p>2011-08-21 14:14:31.283126 [(31)]: Controller: card:2 type:DvbC is tuned to different transponder</p><p>2011-08-21 14:14:31.283126 [(31)]: Controller: found 1 available</p><p>2011-08-21 14:14:31.283126 [(31)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 13 msec</p><p>2011-08-21 14:14:31.283126 [(31)]: card: CardTune 4 Sky Select MS_PC:4:-1</p><p>2011-08-21 14:14:31.283126 [(31)]: card: Tune 4 to Sky Select</p><p>2011-08-21 14:14:31.283126 [(31)]: card: user: MS_PC:4:-1 tune DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam</p><p>2011-08-21 14:14:31.293126 [(31)]: dvbc: Tune:DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam</p><p>2011-08-21 14:14:31.293126 [(31)]: dvb:Submiting tunerequest Channel:Sky Select subChannel:-1 </p><p>2011-08-21 14:14:31.293126 [(31)]: dvb:Getting new subchannel</p><p>2011-08-21 14:14:31.293126 [(31)]: dvb:GetNewSubChannel:0 #0</p><p>2011-08-21 14:14:31.293126 [(31)]: TvDvbChannel ctor new subchIndex:0</p><p>2011-08-21 14:14:31.293126 [(31)]: dvb:Submit tunerequest size:1 new:0</p><p>2011-08-21 14:14:31.293126 [(31)]: subch:0 OnBeforeTune</p><p>2011-08-21 14:14:31.293126 [(31)]: dvb:Submit tunerequest calling put_TuneRequest</p><p>2011-08-21 14:14:31.293126 [(31)]: dvb:Submit tunerequest done calling put_TuneRequest</p><p>2011-08-21 14:14:31.293126 [(31)]: subch:0 OnAfterTune</p><p>2011-08-21 14:14:31.293126 [(31)]: subch:0 OnGraphStart</p><p>2011-08-21 14:14:31.293126 [(31)]: dvb: RunGraph</p><p>2011-08-21 14:14:33.713129 [(31)]: dvb: LockedInOnSignal waiting 20ms</p><p>2011-08-21 14:14:35.363132 [(31)]: dvb: LockedInOnSignal waiting 20ms</p><p>2011-08-21 14:14:35.383132 [(31)]: dvb: LockedInOnSignal could not lock onto channel - no signal or bad signal</p><p>2011-08-21 14:14:35.383132 [(31)]: tvcard:FreeSubChannel: subchannels count 1 subch#0 keep graph=False</p><p>2011-08-21 14:14:35.383132 [(31)]: DVB subch:0 Decompose()</p><p>2011-08-21 14:14:35.383132 [(31)]: FreeSubChannel CA: freeing sub channel : 0</p><p>2011-08-21 14:14:35.383132 [(31)]: tvcard:FreeSubChannel : no subchannels present, stopping graph</p><p>2011-08-21 14:14:35.383132 [(31)]: dvb:StopGraph called</p><p>2011-08-21 14:14:35.383132 [(31)]: tvcard:FreeAllSubChannels</p><p>2011-08-21 14:14:35.393132 [(31)]: dvb:StopGraph</p><p>2011-08-21 14:14:35.693132 [(31)]: card2:MS_PC 4 -1</p><p>2011-08-21 14:14:35.693132 [(31)]: Controller: MS_PC 4 -1</p><p>2011-08-21 14:15:23.883215 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:14:23.8731 , False</p><p>2011-08-21 14:15:23.883215 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:15:23.883215 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 14:15:23.883215 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>2011-08-21 14:16:23.903298 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:15:23.8832 , False</p><p>2011-08-21 14:16:23.903298 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:16:23.903298 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 14:16:23.903298 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>2011-08-21 14:17:23.903380 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 14:16:23.9032 , False</p><p>2011-08-21 14:17:23.913380 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False</p><p>2011-08-21 14:17:23.913380 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False</p><p>2011-08-21 14:17:23.913380 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True</p><p>[/CODE]</p></blockquote><p></p>
[QUOTE="flow87, post: 778725, member: 87305"] Ich muss das Thema nochmal aufgreifen. Ich habe den USB Stick auch und habe auch den obengenannten Treiner installiert. Ich habe folgendes Setup: Windows 7 32bit TV Server MP 1.1.3 FireDTV DvB-C und MSI Digi Vox Trio Ich programmiere eine aufnahme auf einem Unitymedia Kabelkanal. Nun möchte ich z. B. sky select gucken (frei empfangbar !!!) und erhalte die Meldung "Kein Signal". Wechsle ich auf den Kanal ZDF kann ich ohne Probleme gucken! Starte ich nun - nachdem ich die Meldung kein Signal auf dem Sky Select in MePo hatte und MePo geschlossen wurde (Aufnahme läuft weiter) - DVBViewer mit dem MSI Digi Vox als TV Karte und wechsle auf den Kanal Sky Select, kann ich diesen ohne Probleme mit 100 % Empfang gucken. Wo liegt da das Problem?? hier mal die TV Log [CODE] 2011-08-21 13:58:15.781234 [(27)]: WaitForPmt: PMT handling took 0,5200007 seconds. 2011-08-21 13:58:15.951234 [(27)]: card: Tuner locked: True 2011-08-21 13:58:15.951234 [(27)]: ************************************************** 2011-08-21 13:58:15.951234 [(27)]: ***** SIGNAL LEVEL: 100, SIGNAL QUALITY: 100 ***** 2011-08-21 13:58:15.951234 [(27)]: ************************************************** 2011-08-21 13:58:15.951234 [(27)]: card: tuned user: scheduler20 subchannel: 0 2011-08-21 13:58:15.951234 [(27)]: user:scheduler20 add 2011-08-21 13:58:15.951234 [(27)]: Scheduler: MakeFileName() using "moviesformat" (_isSerie=False) 2011-08-21 13:58:15.961234 [(27)]: Scheduler : record to C:\ProgramData\Team MediaPortal\MediaPortal TV Server\recordings\Paul - Ein Alien auf der Flucht HD (Nr.566) - Kino HD - 2011-08-21.ts 2011-08-21 13:58:15.971234 [(27)]: Recorder.start add audioVideoEventHandler 2011-08-21 13:58:15.971234 [(27)]: card: StartRecording 2 C:\ProgramData\Team MediaPortal\MediaPortal TV Server\recordings\Paul - Ein Alien auf der Flucht HD (Nr.566) - Kino HD - 2011-08-21.ts 2011-08-21 13:58:15.971234 [(27)]: StartRecording to C:\ProgramData\Team MediaPortal\MediaPortal TV Server\recordings\Paul - Ein Alien auf der Flucht HD (Nr.566) - Kino HD - 2011-08-21.ts 2011-08-21 13:58:15.971234 [(27)]: subch:0 StartRecord(C:\ProgramData\Team MediaPortal\MediaPortal TV Server\recordings\Paul - Ein Alien auf der Flucht HD (Nr.566) - Kino HD - 2011-08-21.ts) 2011-08-21 13:58:15.971234 [(27)]: subch:0-0 tswriter StartRecording... 2011-08-21 13:58:15.981234 [(27)]: SetRecorderPids 2011-08-21 13:58:15.981234 [(27)]: Set video / audio observer 2011-08-21 13:58:15.981234 [(27)]: DVB subch:0 Started recording 2011-08-21 13:58:15.981234 [(27)]: card: WaitForRecordingFile - waiting _eventAudio & _eventVideo 2011-08-21 13:58:15.981234 [(32)]: PID seen - type = Video 2011-08-21 13:58:15.981234 [(32)]: Recorder audioVideoEventHandler Video 2011-08-21 13:58:16.011234 [(32)]: PID seen - type = Audio 2011-08-21 13:58:16.011234 [(32)]: Recorder audioVideoEventHandler Audio 2011-08-21 13:58:16.021234 [(27)]: card: WaitForRecordingFile - video and audio are seen after 0,03 seconds 2011-08-21 13:58:16.021234 [(27)]: Timeshifting epg grabber started. 2011-08-21 13:58:16.021234 [(27)]: dvb:grab epg... 2011-08-21 13:58:16.031234 [Channel state thread(33)]: Controller: DoSetChannelStates for 233 channels 2011-08-21 13:58:16.031234 [Channel state thread(33)]: ChannelStates.DoSetChannelStates took 0 msec 2011-08-21 13:58:16.031234 [(27)]: Scheduler: adding new row in db for title="Paul - Ein Alien auf der Flucht HD (Nr.566)" of type="0" 2011-08-21 13:58:16.041234 [(27)]: Scheduler: recList: count: 1 add scheduleid: 20 card: FireDTV BDA Tuner DVBC 2011-08-21 13:58:23.651245 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 13:57:23.6511 , False 2011-08-21 13:58:23.651245 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 13:58:23.651245 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 13:58:23.651245 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True 2011-08-21 13:59:23.671328 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 13:58:23.6512 , False 2011-08-21 13:59:23.671328 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 13:59:23.671328 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 13:59:23.671328 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True 2011-08-21 13:59:27.151332 [EPG Update thread(33)]: schedule.SynchProgramStatesForAll 2011-08-21 14:00:23.681410 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 13:59:23.6713 , False 2011-08-21 14:00:23.681410 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:00:23.681410 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 14:00:23.681410 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True 2011-08-21 14:01:23.681493 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:00:23.6814 , False 2011-08-21 14:01:23.681493 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:01:23.691493 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 14:01:23.691493 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True 2011-08-21 14:02:23.711576 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 14:01:23.6914 , False 2011-08-21 14:02:23.711576 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:02:23.711576 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 14:02:23.711576 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True 2011-08-21 14:03:23.721659 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:02:23.7115 , False 2011-08-21 14:03:23.721659 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:03:23.721659 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 14:03:23.721659 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True 2011-08-21 14:04:23.731742 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 14:03:23.7216 , False 2011-08-21 14:04:23.731742 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:04:23.731742 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 14:04:23.731742 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True 2011-08-21 14:04:54.221784 [(33)]: Controller: TimeShiftingWouldUseCard Info Tafel 96 2011-08-21 14:04:54.221784 [(33)]: Controller: find free card for channel Blue Movie 2011-08-21 14:04:54.221784 [(33)]: Controller: got 1 tuning details for Blue Movie 2011-08-21 14:04:54.221784 [(33)]: Controller: channel #1 DVBC:tv:SKY Blue Movie Freq:378000 ONID:133 TSID:4 SID:513 PMT:0x65 FTA:False LCN:760 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:04:54.231784 [(33)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:04:54.231784 [(33)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:04:54.231784 [(33)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:04:54.231784 [(33)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:04:54.231784 [(33)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:04:54.231784 [(33)]: Controller: found 1 available 2011-08-21 14:04:54.231784 [(33)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 17 msec 2011-08-21 14:04:54.241784 [(33)]: CiMenuSupported called cardid 4 2011-08-21 14:04:54.241784 [(33)]: CiMenuSupported card BDA 2885 TVTuner C supported: False 2011-08-21 14:04:54.661784 [(33)]: Controller: StartTimeShifting Info Tafel 96 2011-08-21 14:04:54.661784 [(33)]: Controller: find free card for channel Blue Movie 2011-08-21 14:04:54.661784 [(33)]: Controller: got 1 tuning details for Blue Movie 2011-08-21 14:04:54.661784 [(33)]: Controller: channel #1 DVBC:tv:SKY Blue Movie Freq:378000 ONID:133 TSID:4 SID:513 PMT:0x65 FTA:False LCN:760 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:04:54.671784 [(33)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:04:54.671784 [(33)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:04:54.671784 [(33)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:04:54.671784 [(33)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:04:54.681784 [(33)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:04:54.681784 [(33)]: Controller: found 1 available 2011-08-21 14:04:54.681784 [(33)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 18 msec 2011-08-21 14:04:54.681784 [(33)]: card: CardTune 4 Blue Movie MS_PC:4:-1 2011-08-21 14:04:54.681784 [(33)]: card: Tune 4 to Blue Movie 2011-08-21 14:04:54.681784 [(33)]: card: user: MS_PC:4:-1 tune DVBC:tv:SKY Blue Movie Freq:378000 ONID:133 TSID:4 SID:513 PMT:0x65 FTA:False LCN:760 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:04:54.691784 [(33)]: dvbc: Tune:DVBC:tv:SKY Blue Movie Freq:378000 ONID:133 TSID:4 SID:513 PMT:0x65 FTA:False LCN:760 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:04:54.691784 [(33)]: dvb:Submiting tunerequest Channel:Blue Movie subChannel:-1 2011-08-21 14:04:54.691784 [(33)]: dvb:Getting new subchannel 2011-08-21 14:04:54.691784 [(33)]: dvb:GetNewSubChannel:0 #0 2011-08-21 14:04:54.691784 [(33)]: TvDvbChannel ctor new subchIndex:0 2011-08-21 14:04:54.691784 [(33)]: dvb:Submit tunerequest size:1 new:0 2011-08-21 14:04:54.691784 [(33)]: subch:0 OnBeforeTune 2011-08-21 14:04:54.691784 [(33)]: dvb:Submit tunerequest calling put_TuneRequest 2011-08-21 14:04:54.691784 [(33)]: dvb:Submit tunerequest done calling put_TuneRequest 2011-08-21 14:04:54.691784 [(33)]: subch:0 OnAfterTune 2011-08-21 14:04:54.691784 [(33)]: subch:0 OnGraphStart 2011-08-21 14:04:54.701784 [(33)]: dvb: RunGraph 2011-08-21 14:04:56.401787 [(33)]: dvb: LockedInOnSignal waiting 20ms 2011-08-21 14:04:57.191788 [(33)]: dvb: LockedInOnSignal waiting 20ms 2011-08-21 14:04:57.981789 [(33)]: dvb: LockedInOnSignal waiting 20ms 2011-08-21 14:04:58.001789 [(33)]: dvb: LockedInOnSignal could not lock onto channel - no signal or bad signal 2011-08-21 14:04:58.001789 [(33)]: tvcard:FreeSubChannel: subchannels count 1 subch#0 keep graph=False 2011-08-21 14:04:58.001789 [(33)]: DVB subch:0 Decompose() 2011-08-21 14:04:58.001789 [(33)]: FreeSubChannel CA: freeing sub channel : 0 2011-08-21 14:04:58.001789 [(33)]: tvcard:FreeSubChannel : no subchannels present, stopping graph 2011-08-21 14:04:58.001789 [(33)]: dvb:StopGraph called 2011-08-21 14:04:58.001789 [(33)]: tvcard:FreeAllSubChannels 2011-08-21 14:04:58.011789 [(33)]: dvb:StopGraph 2011-08-21 14:04:58.451790 [(33)]: card2:MS_PC 4 -1 2011-08-21 14:04:58.451790 [(33)]: Controller: MS_PC 4 -1 2011-08-21 14:05:08.091803 [(33)]: Controller: TimeShiftingWouldUseCard Sky Select 91 2011-08-21 14:05:08.091803 [(33)]: Controller: find free card for channel Sky Select 2011-08-21 14:05:08.091803 [(33)]: Controller: got 1 tuning details for Sky Select 2011-08-21 14:05:08.091803 [(33)]: Controller: channel #1 DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:05:08.101803 [(33)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:05:08.101803 [(33)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:05:08.101803 [(33)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:05:08.101803 [(33)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:05:08.101803 [(33)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:05:08.101803 [(33)]: Controller: found 1 available 2011-08-21 14:05:08.111803 [(33)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 15 msec 2011-08-21 14:05:08.111803 [(33)]: CiMenuSupported called cardid 4 2011-08-21 14:05:08.111803 [(33)]: CiMenuSupported card BDA 2885 TVTuner C supported: False 2011-08-21 14:05:08.111803 [(33)]: Controller: StartTimeShifting Sky Select 91 2011-08-21 14:05:08.121803 [(33)]: Controller: find free card for channel Sky Select 2011-08-21 14:05:08.121803 [(33)]: Controller: got 1 tuning details for Sky Select 2011-08-21 14:05:08.121803 [(33)]: Controller: channel #1 DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:05:08.121803 [(33)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:05:08.121803 [(33)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:05:08.121803 [(33)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:05:08.121803 [(33)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:05:08.131803 [(33)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:05:08.131803 [(33)]: Controller: found 1 available 2011-08-21 14:05:08.131803 [(33)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 14 msec 2011-08-21 14:05:08.131803 [(33)]: card: CardTune 4 Sky Select MS_PC:4:-1 2011-08-21 14:05:08.131803 [(33)]: card: Tune 4 to Sky Select 2011-08-21 14:05:08.131803 [(33)]: card: user: MS_PC:4:-1 tune DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:05:08.141803 [(33)]: dvbc: Tune:DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:05:08.141803 [(33)]: dvb:Submiting tunerequest Channel:Sky Select subChannel:-1 2011-08-21 14:05:08.141803 [(33)]: dvb:Getting new subchannel 2011-08-21 14:05:08.141803 [(33)]: dvb:GetNewSubChannel:0 #0 2011-08-21 14:05:08.141803 [(33)]: TvDvbChannel ctor new subchIndex:0 2011-08-21 14:05:08.141803 [(33)]: dvb:Submit tunerequest size:1 new:0 2011-08-21 14:05:08.141803 [(33)]: subch:0 OnBeforeTune 2011-08-21 14:05:08.141803 [(33)]: dvb:Submit tunerequest calling put_TuneRequest 2011-08-21 14:05:08.151803 [(33)]: dvb:Submit tunerequest done calling put_TuneRequest 2011-08-21 14:05:08.151803 [(33)]: subch:0 OnAfterTune 2011-08-21 14:05:08.151803 [(33)]: subch:0 OnGraphStart 2011-08-21 14:05:08.151803 [(33)]: dvb: RunGraph 2011-08-21 14:05:09.721805 [(33)]: dvb: LockedInOnSignal waiting 20ms 2011-08-21 14:05:10.521806 [(33)]: dvb: LockedInOnSignal waiting 20ms 2011-08-21 14:05:11.321807 [(33)]: dvb: LockedInOnSignal waiting 20ms 2011-08-21 14:05:11.341807 [(33)]: dvb: LockedInOnSignal could not lock onto channel - no signal or bad signal 2011-08-21 14:05:11.341807 [(33)]: tvcard:FreeSubChannel: subchannels count 1 subch#0 keep graph=False 2011-08-21 14:05:11.341807 [(33)]: DVB subch:0 Decompose() 2011-08-21 14:05:11.341807 [(33)]: FreeSubChannel CA: freeing sub channel : 0 2011-08-21 14:05:11.341807 [(33)]: tvcard:FreeSubChannel : no subchannels present, stopping graph 2011-08-21 14:05:11.341807 [(33)]: dvb:StopGraph called 2011-08-21 14:05:11.341807 [(33)]: tvcard:FreeAllSubChannels 2011-08-21 14:05:11.351807 [(33)]: dvb:StopGraph 2011-08-21 14:05:11.781808 [(33)]: card2:MS_PC 4 -1 2011-08-21 14:05:11.781808 [(33)]: Controller: MS_PC 4 -1 2011-08-21 14:05:23.751825 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:04:23.7317 , False 2011-08-21 14:05:23.751825 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:05:23.751825 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 14:05:23.751825 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True 2011-08-21 14:06:23.761907 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 14:05:23.7518 , False 2011-08-21 14:06:23.761907 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:06:23.761907 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 14:06:23.761907 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True 2011-08-21 14:07:23.771990 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:06:23.7619 , False 2011-08-21 14:07:23.771990 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:07:23.771990 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 14:07:23.771990 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True 2011-08-21 14:07:57.242036 [(17)]: Controller: TimeShiftingWouldUseCard ZDF 431 2011-08-21 14:07:57.242036 [(17)]: Controller: find free card for channel ZDF 2011-08-21 14:07:57.242036 [(17)]: Controller: got 1 tuning details for ZDF 2011-08-21 14:07:57.242036 [(17)]: Controller: channel #1 DVBC:tv:ZDFvision ZDF Freq:394000 ONID:102 TSID:1079 SID:28006 PMT:0x64 FTA:True LCN:102 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:07:57.242036 [(17)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:07:57.252036 [(17)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:07:57.252036 [(17)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:07:57.252036 [(17)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:07:57.252036 [(17)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:07:57.252036 [(17)]: Controller: found 1 available 2011-08-21 14:07:57.252036 [(17)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 15 msec 2011-08-21 14:07:57.262036 [(17)]: CiMenuSupported called cardid 4 2011-08-21 14:07:57.262036 [(17)]: CiMenuSupported card BDA 2885 TVTuner C supported: False 2011-08-21 14:07:57.662037 [(17)]: Controller: StartTimeShifting ZDF 431 2011-08-21 14:07:57.662037 [(17)]: Controller: find free card for channel ZDF 2011-08-21 14:07:57.662037 [(17)]: Controller: got 1 tuning details for ZDF 2011-08-21 14:07:57.662037 [(17)]: Controller: channel #1 DVBC:tv:ZDFvision ZDF Freq:394000 ONID:102 TSID:1079 SID:28006 PMT:0x64 FTA:True LCN:102 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:07:57.672037 [(17)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:07:57.672037 [(17)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:07:57.672037 [(17)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:07:57.672037 [(17)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:07:57.682037 [(17)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:07:57.682037 [(17)]: Controller: found 1 available 2011-08-21 14:07:57.682037 [(17)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 18 msec 2011-08-21 14:07:57.682037 [(17)]: card: CardTune 4 ZDF MS_PC:4:-1 2011-08-21 14:07:57.682037 [(17)]: card: Tune 4 to ZDF 2011-08-21 14:07:57.682037 [(17)]: card: user: MS_PC:4:-1 tune DVBC:tv:ZDFvision ZDF Freq:394000 ONID:102 TSID:1079 SID:28006 PMT:0x64 FTA:True LCN:102 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:07:57.692037 [(17)]: dvbc: Tune:DVBC:tv:ZDFvision ZDF Freq:394000 ONID:102 TSID:1079 SID:28006 PMT:0x64 FTA:True LCN:102 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:07:57.692037 [(17)]: dvb:Submiting tunerequest Channel:ZDF subChannel:-1 2011-08-21 14:07:57.692037 [(17)]: dvb:Getting new subchannel 2011-08-21 14:07:57.692037 [(17)]: dvb:GetNewSubChannel:0 #0 2011-08-21 14:07:57.692037 [(17)]: TvDvbChannel ctor new subchIndex:0 2011-08-21 14:07:57.692037 [(17)]: dvb:Submit tunerequest size:1 new:0 2011-08-21 14:07:57.692037 [(17)]: subch:0 OnBeforeTune 2011-08-21 14:07:57.692037 [(17)]: dvb:Submit tunerequest calling put_TuneRequest 2011-08-21 14:07:57.692037 [(17)]: dvb:Submit tunerequest done calling put_TuneRequest 2011-08-21 14:07:57.692037 [(17)]: subch:0 OnAfterTune 2011-08-21 14:07:57.692037 [(17)]: subch:0 OnGraphStart 2011-08-21 14:07:57.692037 [(17)]: dvb: RunGraph 2011-08-21 14:07:59.002039 [(17)]: dvb: LockedInOnSignal ok 2011-08-21 14:07:59.002039 [(17)]: subch:0 OnGraphStarted 2011-08-21 14:07:59.012039 [(17)]: subch:0 SetupPmtGrabber:pid 64 sid:6D66 2011-08-21 14:07:59.012039 [(17)]: subch:0 set pmt grabber pmt:64 sid:6D66 2011-08-21 14:07:59.012039 [(17)]: subch:0 set ca grabber 2011-08-21 14:07:59.012039 [(17)]: WaitForPMT: Waiting for PMT 64 2011-08-21 14:07:59.242039 [(15)]: subch:0 OnPMTReceived() pmt:64 ran:True dynamic:False 2011-08-21 14:07:59.242039 [(17)]: WaitForPMT: Found PMT after 0,2300003 seconds. 2011-08-21 14:07:59.242039 [(17)]: subch:0 SendPmt:6D66 6D66 FFFFFFFF 1 2011-08-21 14:07:59.242039 [(17)]: Decode pmt 2011-08-21 14:07:59.242039 [(17)]: Set descriptor data with length 3 2011-08-21 14:07:59.242039 [(17)]: Set descriptor data with length 3 2011-08-21 14:07:59.242039 [(17)]: PROBLEM : descriptor lengths dont match 6 9 2011-08-21 14:07:59.242039 [(17)]: Set descriptor data with length 3 2011-08-21 14:07:59.242039 [(17)]: PROBLEM : descriptor lengths dont match 6 9 2011-08-21 14:07:59.242039 [(17)]: Set descriptor data with length 3 2011-08-21 14:07:59.242039 [(17)]: PROBLEM : descriptor lengths dont match 6 9 2011-08-21 14:07:59.242039 [(17)]: Set descriptor data with length 3 2011-08-21 14:07:59.242039 [(17)]: PROBLEM : descriptor lengths dont match 7 10 2011-08-21 14:07:59.242039 [(17)]: Set descriptor data with length 10 2011-08-21 14:07:59.242039 [(17)]: PROBLEM : descriptor lengths dont match 3 13 2011-08-21 14:07:59.242039 [(17)]: subch:0 SendPMT: Channel is FTA, nothing to do. 2011-08-21 14:07:59.242039 [(17)]: subch:0 SetMpegPidMapping 2011-08-21 14:07:59.242039 [(17)]: subch:0 pid:6E pcr 2011-08-21 14:07:59.242039 [(17)]: subch:0 pid:64 pmt 2011-08-21 14:07:59.242039 [(17)]: subch:0 pid:6E video type:MPEG-2 2011-08-21 14:07:59.242039 [(17)]: subch:0 map pid:6E video type:MPEG-2 2011-08-21 14:07:59.252039 [(17)]: subch:0 pid:78 audio lang:deu type:MPEG-1 2011-08-21 14:07:59.252039 [(17)]: subch:0 map pid:78 audio lang:deu type:MPEG-1 2011-08-21 14:07:59.252039 [(17)]: subch:0 pid:79 audio lang:mis type:MPEG-1 2011-08-21 14:07:59.252039 [(17)]: subch:0 pid:7D audio lang: type:AC3 2011-08-21 14:07:59.252039 [(17)]: subch:0 map pid:7D audio lang: type:AC3 2011-08-21 14:07:59.252039 [(17)]: subch:0 pid:82 teletext type:6 2011-08-21 14:07:59.252039 [(17)]: subch:0 map pid:82 teletext type:6 2011-08-21 14:07:59.252039 [(17)]: subch:0 pid:83 subtitle type:6 2011-08-21 14:07:59.252039 [(17)]: subch:0 map pid:83 subtitle type:6 2011-08-21 14:07:59.252039 [(17)]: subch:0 pid:3B6 type:5 2011-08-21 14:07:59.252039 [(17)]: Number of HWPIDS that needs to be sent to tuner :12 2011-08-21 14:07:59.252039 [(17)]: subch:0 stop tif 2011-08-21 14:07:59.252039 [(17)]: WaitForPmt: PMT handling took 0,01 seconds. 2011-08-21 14:08:00.432041 [(17)]: card: Tuner locked: True 2011-08-21 14:08:00.432041 [(17)]: ************************************************** 2011-08-21 14:08:00.432041 [(17)]: ***** SIGNAL LEVEL: 87, SIGNAL QUALITY: 100 ***** 2011-08-21 14:08:00.432041 [(17)]: ************************************************** 2011-08-21 14:08:00.432041 [(17)]: card: tuned user: MS_PC subchannel: 0 2011-08-21 14:08:00.432041 [(17)]: user:MS_PC add 2011-08-21 14:08:00.432041 [(17)]: card2:MS_PC 4 0 2011-08-21 14:08:00.432041 [(17)]: Controller: MS_PC 4 0 2011-08-21 14:08:00.432041 [(17)]: control2:MS_PC 4 0 2011-08-21 14:08:00.442041 [(17)]: Controller: delete timeshift files C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts 2011-08-21 14:08:00.442041 [(17)]: card: StartTimeShifting 4 C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts 2011-08-21 14:08:00.442041 [(17)]: card: CAM enabled : True 2011-08-21 14:08:00.442041 [(17)]: subch:0 SetTimeShiftFileName:C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts 2011-08-21 14:08:00.442041 [(17)]: Set video / audio observer 2011-08-21 14:08:00.442041 [(17)]: subch:0 SetTimeShiftFileName fill in pids 2011-08-21 14:08:00.452041 [(17)]: subch:0-0 tswriter StartTimeshifting... 2011-08-21 14:08:00.452041 [(17)]: card: WaitForTimeShiftFile - waiting _eventAudio & _eventVideo 2011-08-21 14:08:00.492041 [(15)]: PID seen - type = Video 2011-08-21 14:08:00.492041 [(15)]: audioVideoEventHandler Video 2011-08-21 14:08:00.502041 [(15)]: PID seen - type = Audio 2011-08-21 14:08:00.502041 [(15)]: audioVideoEventHandler Audio 2011-08-21 14:08:00.502041 [(17)]: card: WaitForTimeShiftFile - video and audio are seen after 0,05 seconds 2011-08-21 14:08:00.512041 [(17)]: Timeshifting epg grabber started. 2011-08-21 14:08:00.512041 [(17)]: dvb:grab epg... 2011-08-21 14:08:00.512041 [(17)]: user:MS_PC card:4 sub:0 add stream:C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer 2011-08-21 14:08:00.512041 [(17)]: RTSP: add stream stream4.0 file:C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer 2011-08-21 14:08:00.512041 [(17)]: Controller: StartTimeShifting started on card:4 to C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer 2011-08-21 14:08:00.522041 [Channel state thread(25)]: Controller: DoSetChannelStates for 233 channels 2011-08-21 14:08:00.522041 [(17)]: CiMenuSupported called cardid 4 2011-08-21 14:08:00.522041 [(17)]: CiMenuSupported card BDA 2885 TVTuner C supported: False 2011-08-21 14:08:00.532041 [(15)]: PID seen - type = Audio 2011-08-21 14:08:00.582041 [(15)]: PID seen - type = Audio 2011-08-21 14:08:01.882043 [Channel state thread(25)]: ChannelStates.DoSetChannelStates took 1368 msec 2011-08-21 14:08:19.022066 [(15)]: OnLinkageReceived() 2011-08-21 14:08:19.022066 [Channel linkage update thread(24)]: ChannelLinkage received. 0 portal channels read 2011-08-21 14:08:23.792073 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:07:23.7719 , False 2011-08-21 14:08:23.792073 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:08:23.792073 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:True 2011-08-21 14:08:49.702109 [(22)]: Controller: TimeShiftingWouldUseCard Sky Select 91 2011-08-21 14:08:49.702109 [(22)]: Controller: find free card for channel Sky Select 2011-08-21 14:08:49.712109 [(22)]: Controller: got 1 tuning details for Sky Select 2011-08-21 14:08:49.712109 [(22)]: Controller: channel #1 DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:08:49.712109 [(22)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:08:49.712109 [(22)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:08:49.712109 [(22)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:08:49.712109 [(22)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:08:49.722109 [(22)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:08:49.722109 [(22)]: Controller: found 1 available 2011-08-21 14:08:49.722109 [(22)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 17 msec 2011-08-21 14:08:50.662110 [(22)]: Controller: StartTimeShifting Sky Select 91 2011-08-21 14:08:50.662110 [(22)]: Controller: find free card for channel Sky Select 2011-08-21 14:08:50.662110 [(22)]: Controller: got 1 tuning details for Sky Select 2011-08-21 14:08:50.672110 [(22)]: Controller: channel #1 DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:08:50.672110 [(22)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:08:50.672110 [(22)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:08:50.672110 [(22)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:08:50.672110 [(22)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:08:50.682110 [(22)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:08:50.682110 [(22)]: Controller: found 1 available 2011-08-21 14:08:50.682110 [(22)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 21 msec 2011-08-21 14:08:50.692110 [(22)]: tvcard:FreeSubChannel: subchannels count 1 subch#0 keep graph=True 2011-08-21 14:08:50.692110 [(22)]: tvcard:FreeSubChannel :0 - is timeshifting (skipped) 2011-08-21 14:08:50.692110 [(22)]: card: CardTune 4 Sky Select MS_PC:4:-1 2011-08-21 14:08:50.692110 [(22)]: card: Tune 4 to Sky Select 2011-08-21 14:08:50.692110 [(22)]: card: user: MS_PC:4:0 tune DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:08:50.702110 [(22)]: card: to different transponder 2011-08-21 14:08:50.702110 [(22)]: dvbc: Tune:DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:08:50.702110 [(22)]: dvb:Submiting tunerequest Channel:Sky Select subChannel:0 2011-08-21 14:08:50.702110 [(22)]: dvb:using existing subchannel:0 2011-08-21 14:08:50.702110 [(22)]: dvb:Submit tunerequest size:1 new:0 2011-08-21 14:08:50.702110 [(22)]: subch:0 OnBeforeTune 2011-08-21 14:08:50.702110 [(22)]: dvb:Submit tunerequest calling put_TuneRequest 2011-08-21 14:08:51.072111 [(22)]: dvb:Submit tunerequest done calling put_TuneRequest 2011-08-21 14:08:51.072111 [(22)]: subch:0 OnAfterTune 2011-08-21 14:08:52.902113 [(22)]: dvb: LockedInOnSignal waiting 20ms 2011-08-21 14:08:54.772116 [(22)]: dvb: LockedInOnSignal waiting 20ms 2011-08-21 14:08:54.792116 [(22)]: dvb: LockedInOnSignal could not lock onto channel - no signal or bad signal 2011-08-21 14:08:54.792116 [(22)]: tvcard:FreeSubChannel: subchannels count 1 subch#0 keep graph=False 2011-08-21 14:08:54.792116 [(22)]: tvcard:FreeSubChannel :0 - is timeshifting (skipped) 2011-08-21 14:08:54.792116 [(22)]: card2:MS_PC 4 0 2011-08-21 14:08:54.792116 [(22)]: Controller: MS_PC 4 0 2011-08-21 14:08:54.822116 [(22)]: Controller: StopTimeShifting 4 2011-08-21 14:08:54.832116 [(22)]: card BDA 2885 TVTuner C: StopTimeShifting user:MS_PC sub:0 2011-08-21 14:08:54.832116 [(22)]: card: StopTimeShifting user:MS_PC sub:0 2011-08-21 14:08:54.832116 [(22)]: card not IDLE - removing user: MS_PC 2011-08-21 14:08:54.832116 [(22)]: user:MS_PC remove 2011-08-21 14:08:54.832116 [(22)]: subch:0-0 tswriter StopTimeshifting... 2011-08-21 14:08:54.832116 [(22)]: tvcard:FreeSubChannel: subchannels count 1 subch#0 keep graph=False 2011-08-21 14:08:54.832116 [(22)]: DVB subch:0 Decompose() 2011-08-21 14:08:54.832116 [(22)]: FreeSubChannel CA: freeing sub channel : 0 2011-08-21 14:08:54.842116 [(22)]: tvcard:FreeSubChannel : no subchannels present, stopping graph 2011-08-21 14:08:54.842116 [(22)]: dvb:StopGraph called 2011-08-21 14:08:54.842116 [(22)]: tvcard:FreeAllSubChannels 2011-08-21 14:08:54.842116 [(22)]: dvb:StopGraph 2011-08-21 14:08:55.162116 [(22)]: dvb:StopGraph called 2011-08-21 14:08:55.162116 [(22)]: tvcard:FreeAllSubChannels 2011-08-21 14:08:55.162116 [TS_File_Cleanup(27)]: card: delete timeshift files C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts 2011-08-21 14:08:55.162116 [(22)]: dvb:StopGraph filterstate already stopped, returning. 2011-08-21 14:08:55.162116 [(22)]: user:MS_PC remove 2011-08-21 14:08:55.162116 [TS_File_Cleanup(27)]: card: trying to delete C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer 2011-08-21 14:08:55.162116 [(22)]: Controller:Timeshifting stopped on card:4 2011-08-21 14:08:55.162116 [(22)]: RTSP: remove stream stream4.0 2011-08-21 14:08:55.162116 [Channel state thread(29)]: Controller: DoSetChannelStates for 233 channels 2011-08-21 14:08:55.172116 [Channel state thread(29)]: ChannelStates.DoSetChannelStates took 1 msec 2011-08-21 14:09:00.162123 [TS_File_Cleanup(27)]: card: delete timeshift files C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts 2011-08-21 14:09:00.162123 [TS_File_Cleanup(27)]: card: trying to delete C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer 2011-08-21 14:09:00.162123 [TS_File_Cleanup(27)]: card: deleted file C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer 2011-08-21 14:09:00.162123 [TS_File_Cleanup(27)]: card: trying to delete C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer1.ts 2011-08-21 14:09:00.162123 [TS_File_Cleanup(27)]: card: deleted file C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer1.ts 2011-08-21 14:09:02.272126 [(31)]: Controller: find free card for channel Sky Bundesliga 2011-08-21 14:09:02.282126 [(31)]: Controller: got 1 tuning details for Sky Bundesliga 2011-08-21 14:09:02.282126 [(31)]: Controller: channel #1 DVBC:tv:SKY Sky Bundesliga Freq:378000 ONID:133 TSID:4 SID:223 PMT:0x66 FTA:False LCN:764 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:09:02.282126 [(31)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:09:02.282126 [(31)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:09:02.282126 [(31)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:09:02.282126 [(31)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:09:02.292126 [(31)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:09:02.292126 [(31)]: Controller: found 1 available 2011-08-21 14:09:02.292126 [(31)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 17 msec 2011-08-21 14:09:02.302126 [(31)]: Controller: TimeShiftingWouldUseCard 2. Liga Konf. 95 2011-08-21 14:09:02.302126 [(31)]: Controller: find free card for channel Sky Bundesliga 2011-08-21 14:09:02.302126 [(31)]: Controller: got 1 tuning details for Sky Bundesliga 2011-08-21 14:09:02.302126 [(31)]: Controller: channel #1 DVBC:tv:SKY Sky Bundesliga Freq:378000 ONID:133 TSID:4 SID:223 PMT:0x66 FTA:False LCN:764 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:09:02.302126 [(31)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:09:02.302126 [(31)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:09:02.302126 [(31)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:09:02.302126 [(31)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:09:02.312126 [(31)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:09:02.312126 [(31)]: Controller: found 1 available 2011-08-21 14:09:02.312126 [(31)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 16 msec 2011-08-21 14:09:02.312126 [(31)]: CiMenuSupported called cardid 4 2011-08-21 14:09:02.322126 [(31)]: CiMenuSupported card BDA 2885 TVTuner C supported: False 2011-08-21 14:09:02.322126 [(31)]: Controller: StartTimeShifting 2. Liga Konf. 95 2011-08-21 14:09:02.322126 [(31)]: Controller: find free card for channel Sky Bundesliga 2011-08-21 14:09:02.322126 [(31)]: Controller: got 1 tuning details for Sky Bundesliga 2011-08-21 14:09:02.322126 [(31)]: Controller: channel #1 DVBC:tv:SKY Sky Bundesliga Freq:378000 ONID:133 TSID:4 SID:223 PMT:0x66 FTA:False LCN:764 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:09:02.332126 [(31)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:09:02.332126 [(31)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:09:02.332126 [(31)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:09:02.332126 [(31)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:09:02.332126 [(31)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:09:02.332126 [(31)]: Controller: found 1 available 2011-08-21 14:09:02.332126 [(31)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 13 msec 2011-08-21 14:09:02.342126 [(31)]: card: CardTune 4 Sky Bundesliga MS_PC:4:-1 2011-08-21 14:09:02.342126 [(31)]: card: Tune 4 to Sky Bundesliga 2011-08-21 14:09:02.342126 [(31)]: card: user: MS_PC:4:-1 tune DVBC:tv:SKY Sky Bundesliga Freq:378000 ONID:133 TSID:4 SID:223 PMT:0x66 FTA:False LCN:764 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:09:02.352126 [(31)]: dvbc: Tune:DVBC:tv:SKY Sky Bundesliga Freq:378000 ONID:133 TSID:4 SID:223 PMT:0x66 FTA:False LCN:764 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:09:02.352126 [(31)]: dvb:Submiting tunerequest Channel:Sky Bundesliga subChannel:-1 2011-08-21 14:09:02.352126 [(31)]: dvb:Getting new subchannel 2011-08-21 14:09:02.352126 [(31)]: dvb:GetNewSubChannel:0 #0 2011-08-21 14:09:02.352126 [(31)]: TvDvbChannel ctor new subchIndex:0 2011-08-21 14:09:02.352126 [(31)]: dvb:Submit tunerequest size:1 new:0 2011-08-21 14:09:02.352126 [(31)]: subch:0 OnBeforeTune 2011-08-21 14:09:02.352126 [(31)]: dvb:Submit tunerequest calling put_TuneRequest 2011-08-21 14:09:02.352126 [(31)]: dvb:Submit tunerequest done calling put_TuneRequest 2011-08-21 14:09:02.352126 [(31)]: subch:0 OnAfterTune 2011-08-21 14:09:02.352126 [(31)]: subch:0 OnGraphStart 2011-08-21 14:09:02.352126 [(31)]: dvb: RunGraph 2011-08-21 14:09:03.962128 [(31)]: dvb: LockedInOnSignal waiting 20ms 2011-08-21 14:09:04.752130 [(31)]: dvb: LockedInOnSignal waiting 20ms 2011-08-21 14:09:05.552131 [(31)]: dvb: LockedInOnSignal waiting 20ms 2011-08-21 14:09:05.572131 [(31)]: dvb: LockedInOnSignal could not lock onto channel - no signal or bad signal 2011-08-21 14:09:05.572131 [(31)]: tvcard:FreeSubChannel: subchannels count 1 subch#0 keep graph=False 2011-08-21 14:09:05.572131 [(31)]: DVB subch:0 Decompose() 2011-08-21 14:09:05.572131 [(31)]: FreeSubChannel CA: freeing sub channel : 0 2011-08-21 14:09:05.572131 [(31)]: tvcard:FreeSubChannel : no subchannels present, stopping graph 2011-08-21 14:09:05.572131 [(31)]: dvb:StopGraph called 2011-08-21 14:09:05.572131 [(31)]: tvcard:FreeAllSubChannels 2011-08-21 14:09:05.582131 [(31)]: dvb:StopGraph 2011-08-21 14:09:05.992131 [(31)]: card2:MS_PC 4 -1 2011-08-21 14:09:05.992131 [(31)]: Controller: MS_PC 4 -1 2011-08-21 14:09:23.482155 [(24)]: Controller: find free card for channel Das Erste 2011-08-21 14:09:23.482155 [(24)]: Controller: got 1 tuning details for Das Erste 2011-08-21 14:09:23.482155 [(24)]: Controller: channel #1 DVBC:tv:ARD Das Erste Freq:410000 ONID:41985 TSID:1101 SID:28106 PMT:0x64 FTA:True LCN:101 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:09:23.492155 [(24)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:09:23.492155 [(24)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:09:23.492155 [(24)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:09:23.492155 [(24)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:09:23.492155 [(24)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:09:23.492155 [(24)]: Controller: found 1 available 2011-08-21 14:09:23.492155 [(24)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 15 msec 2011-08-21 14:09:23.502155 [(24)]: Controller: TimeShiftingWouldUseCard Das Erste 130 2011-08-21 14:09:23.502155 [(24)]: Controller: find free card for channel Das Erste 2011-08-21 14:09:23.502155 [(24)]: Controller: got 1 tuning details for Das Erste 2011-08-21 14:09:23.502155 [(24)]: Controller: channel #1 DVBC:tv:ARD Das Erste Freq:410000 ONID:41985 TSID:1101 SID:28106 PMT:0x64 FTA:True LCN:101 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:09:23.502155 [(24)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:09:23.502155 [(24)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:09:23.502155 [(24)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:09:23.502155 [(24)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:09:23.512155 [(24)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:09:23.512155 [(24)]: Controller: found 1 available 2011-08-21 14:09:23.512155 [(24)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 13 msec 2011-08-21 14:09:23.512155 [(24)]: CiMenuSupported called cardid 4 2011-08-21 14:09:23.512155 [(24)]: CiMenuSupported card BDA 2885 TVTuner C supported: False 2011-08-21 14:09:23.662156 [(24)]: Controller: StartTimeShifting Das Erste 130 2011-08-21 14:09:23.662156 [(24)]: Controller: find free card for channel Das Erste 2011-08-21 14:09:23.662156 [(24)]: Controller: got 1 tuning details for Das Erste 2011-08-21 14:09:23.662156 [(24)]: Controller: channel #1 DVBC:tv:ARD Das Erste Freq:410000 ONID:41985 TSID:1101 SID:28106 PMT:0x64 FTA:True LCN:101 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:09:23.672156 [(24)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:09:23.672156 [(24)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:09:23.672156 [(24)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:09:23.672156 [(24)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:09:23.682156 [(24)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:09:23.682156 [(24)]: Controller: found 1 available 2011-08-21 14:09:23.682156 [(24)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 20 msec 2011-08-21 14:09:23.682156 [(24)]: card: CardTune 4 Das Erste MS_PC:4:-1 2011-08-21 14:09:23.682156 [(24)]: card: Tune 4 to Das Erste 2011-08-21 14:09:23.682156 [(24)]: card: user: MS_PC:4:-1 tune DVBC:tv:ARD Das Erste Freq:410000 ONID:41985 TSID:1101 SID:28106 PMT:0x64 FTA:True LCN:101 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:09:23.692156 [(24)]: dvbc: Tune:DVBC:tv:ARD Das Erste Freq:410000 ONID:41985 TSID:1101 SID:28106 PMT:0x64 FTA:True LCN:101 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:09:23.702156 [(24)]: dvb:Submiting tunerequest Channel:Das Erste subChannel:-1 2011-08-21 14:09:23.702156 [(24)]: dvb:Getting new subchannel 2011-08-21 14:09:23.702156 [(24)]: dvb:GetNewSubChannel:0 #0 2011-08-21 14:09:23.702156 [(24)]: TvDvbChannel ctor new subchIndex:0 2011-08-21 14:09:23.702156 [(24)]: dvb:Submit tunerequest size:1 new:0 2011-08-21 14:09:23.702156 [(24)]: subch:0 OnBeforeTune 2011-08-21 14:09:23.702156 [(24)]: dvb:Submit tunerequest calling put_TuneRequest 2011-08-21 14:09:23.702156 [(24)]: dvb:Submit tunerequest done calling put_TuneRequest 2011-08-21 14:09:23.702156 [(24)]: subch:0 OnAfterTune 2011-08-21 14:09:23.702156 [(24)]: subch:0 OnGraphStart 2011-08-21 14:09:23.702156 [(24)]: dvb: RunGraph 2011-08-21 14:09:23.792156 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 14:08:23.7920 , False 2011-08-21 14:09:23.792156 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:09:23.792156 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 14:09:23.802156 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True 2011-08-21 14:09:25.332158 [(24)]: dvb: LockedInOnSignal ok 2011-08-21 14:09:25.332158 [(24)]: subch:0 OnGraphStarted 2011-08-21 14:09:25.342158 [(24)]: subch:0 SetupPmtGrabber:pid 64 sid:6DCA 2011-08-21 14:09:25.342158 [(24)]: subch:0 set pmt grabber pmt:64 sid:6DCA 2011-08-21 14:09:25.342158 [(24)]: subch:0 set ca grabber 2011-08-21 14:09:25.342158 [(24)]: WaitForPMT: Waiting for PMT 64 2011-08-21 14:09:25.572158 [(27)]: subch:OnCaReceived() 2011-08-21 14:09:25.582158 [(27)]: subch:0 OnPMTReceived() pmt:64 ran:True dynamic:False 2011-08-21 14:09:25.582158 [(24)]: WaitForPMT: Found PMT after 0,2400004 seconds. 2011-08-21 14:09:25.582158 [(24)]: subch:0 SendPmt:6DCA 6DCA FFFFFFFF A 2011-08-21 14:09:25.582158 [(24)]: Decode pmt 2011-08-21 14:09:25.582158 [(24)]: Set descriptor data with length 3 2011-08-21 14:09:25.582158 [(24)]: Set descriptor data with length 6 2011-08-21 14:09:25.582158 [(24)]: PROBLEM : descriptor lengths dont match 3 9 2011-08-21 14:09:25.582158 [(24)]: Set descriptor data with length 6 2011-08-21 14:09:25.582158 [(24)]: PROBLEM : descriptor lengths dont match 3 9 2011-08-21 14:09:25.582158 [(24)]: Set descriptor data with length 7 2011-08-21 14:09:25.582158 [(24)]: PROBLEM : descriptor lengths dont match 3 10 2011-08-21 14:09:25.582158 [(24)]: Set descriptor data with length 3 2011-08-21 14:09:25.582158 [(24)]: PROBLEM : descriptor lengths dont match 10 13 2011-08-21 14:09:25.582158 [(24)]: Set descriptor data with length 6 2011-08-21 14:09:25.582158 [(24)]: PROBLEM : descriptor lengths dont match 3 9 2011-08-21 14:09:25.582158 [(24)]: Set descriptor data with length 3 2011-08-21 14:09:25.582158 [(24)]: subch:0 SendPMT: Channel is FTA, nothing to do. 2011-08-21 14:09:25.582158 [(24)]: subch:0 SetMpegPidMapping 2011-08-21 14:09:25.582158 [(24)]: subch:0 pid:65 pcr 2011-08-21 14:09:25.582158 [(24)]: subch:0 pid:64 pmt 2011-08-21 14:09:25.582158 [(24)]: subch:0 pid:65 video type:MPEG-2 2011-08-21 14:09:25.582158 [(24)]: subch:0 map pid:65 video type:MPEG-2 2011-08-21 14:09:25.592158 [(24)]: subch:0 pid:66 audio lang:deu type:MPEG-1 2011-08-21 14:09:25.592158 [(24)]: subch:0 map pid:66 audio lang:deu type:MPEG-1 2011-08-21 14:09:25.592158 [(24)]: subch:0 pid:67 audio lang: type:MPEG-1 2011-08-21 14:09:25.592158 [(24)]: subch:0 pid:68 teletext type:6 2011-08-21 14:09:25.592158 [(24)]: subch:0 map pid:68 teletext type:6 2011-08-21 14:09:25.592158 [(24)]: subch:0 pid:69 subtitle type:6 2011-08-21 14:09:25.592158 [(24)]: subch:0 map pid:69 subtitle type:6 2011-08-21 14:09:25.592158 [(24)]: subch:0 pid:6A audio lang:deu type:AC3 2011-08-21 14:09:25.592158 [(24)]: subch:0 map pid:6A audio lang:deu type:AC3 2011-08-21 14:09:25.592158 [(24)]: subch:0 pid:816 type:5 2011-08-21 14:09:25.592158 [(24)]: subch:0 pid:87B type:B 2011-08-21 14:09:25.592158 [(24)]: Number of HWPIDS that needs to be sent to tuner :12 2011-08-21 14:09:25.592158 [(24)]: subch:0 stop tif 2011-08-21 14:09:25.592158 [(24)]: WaitForPmt: PMT handling took 0,01 seconds. 2011-08-21 14:09:26.362159 [(24)]: card: Tuner locked: True 2011-08-21 14:09:26.362159 [(24)]: ************************************************** 2011-08-21 14:09:26.362159 [(24)]: ***** SIGNAL LEVEL: 0, SIGNAL QUALITY: 50 ***** 2011-08-21 14:09:26.372159 [(24)]: ************************************************** 2011-08-21 14:09:26.372159 [(24)]: card: tuned user: MS_PC subchannel: 0 2011-08-21 14:09:26.372159 [(24)]: user:MS_PC add 2011-08-21 14:09:26.372159 [(24)]: card2:MS_PC 4 0 2011-08-21 14:09:26.372159 [(24)]: Controller: MS_PC 4 0 2011-08-21 14:09:26.372159 [(24)]: control2:MS_PC 4 0 2011-08-21 14:09:26.372159 [(24)]: Controller: delete timeshift files C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts 2011-08-21 14:09:26.372159 [(24)]: card: StartTimeShifting 4 C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts 2011-08-21 14:09:26.382159 [(24)]: card: CAM enabled : True 2011-08-21 14:09:26.382159 [(24)]: subch:0 SetTimeShiftFileName:C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts 2011-08-21 14:09:26.382159 [(24)]: Set video / audio observer 2011-08-21 14:09:26.382159 [(24)]: subch:0 SetTimeShiftFileName fill in pids 2011-08-21 14:09:26.382159 [(24)]: subch:0-0 tswriter StartTimeshifting... 2011-08-21 14:09:26.382159 [(24)]: card: WaitForTimeShiftFile - waiting _eventAudio & _eventVideo 2011-08-21 14:09:26.392159 [(27)]: PID seen - type = Audio 2011-08-21 14:09:26.392159 [(27)]: audioVideoEventHandler Audio 2011-08-21 14:09:26.402159 [(27)]: PID seen - type = Audio 2011-08-21 14:09:26.432159 [(27)]: PID seen - type = Video 2011-08-21 14:09:26.432159 [(27)]: audioVideoEventHandler Video 2011-08-21 14:09:26.432159 [(24)]: card: WaitForTimeShiftFile - video and audio are seen after 0,05 seconds 2011-08-21 14:09:26.432159 [(24)]: Timeshifting epg grabber started. 2011-08-21 14:09:26.432159 [(24)]: dvb:grab epg... 2011-08-21 14:09:26.442159 [(24)]: user:MS_PC card:4 sub:0 add stream:C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer 2011-08-21 14:09:26.442159 [(24)]: RTSP: add stream stream4.0 file:C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer 2011-08-21 14:09:26.442159 [(27)]: PID seen - type = Audio 2011-08-21 14:09:26.442159 [(24)]: Controller: StartTimeShifting started on card:4 to C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer 2011-08-21 14:09:26.442159 [Channel state thread(34)]: Controller: DoSetChannelStates for 233 channels 2011-08-21 14:09:26.462160 [(24)]: CiMenuSupported called cardid 4 2011-08-21 14:09:26.462160 [(24)]: CiMenuSupported card BDA 2885 TVTuner C supported: False 2011-08-21 14:09:27.792161 [Channel state thread(34)]: ChannelStates.DoSetChannelStates took 1351 msec 2011-08-21 14:09:44.002184 [(27)]: OnLinkageReceived() 2011-08-21 14:09:44.012184 [Channel linkage update thread(34)]: ChannelLinkage received. 0 portal channels read 2011-08-21 14:10:23.822239 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:09:23.8021 , False 2011-08-21 14:10:23.822239 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:10:23.822239 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:True 2011-08-21 14:10:37.972258 [EPG Update thread(34)]: schedule.SynchProgramStatesForAll 2011-08-21 14:11:23.832321 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 14:10:23.8222 , False 2011-08-21 14:11:23.832321 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:11:23.832321 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:True 2011-08-21 14:11:31.082331 [(29)]: Controller: StopTimeShifting 4 2011-08-21 14:11:31.082331 [(29)]: card BDA 2885 TVTuner C: StopTimeShifting user:MS_PC sub:0 2011-08-21 14:11:31.092332 [(29)]: card: StopTimeShifting user:MS_PC sub:0 2011-08-21 14:11:31.092332 [(29)]: card not IDLE - removing user: MS_PC 2011-08-21 14:11:31.092332 [(29)]: user:MS_PC remove 2011-08-21 14:11:31.092332 [(29)]: subch:0-0 tswriter StopTimeshifting... 2011-08-21 14:11:31.092332 [(29)]: tvcard:FreeSubChannel: subchannels count 1 subch#0 keep graph=False 2011-08-21 14:11:31.092332 [(29)]: DVB subch:0 Decompose() 2011-08-21 14:11:31.092332 [(29)]: FreeSubChannel CA: freeing sub channel : 0 2011-08-21 14:11:31.092332 [(29)]: tvcard:FreeSubChannel : no subchannels present, stopping graph 2011-08-21 14:11:31.092332 [(29)]: dvb:StopGraph called 2011-08-21 14:11:31.092332 [(29)]: tvcard:FreeAllSubChannels 2011-08-21 14:11:31.092332 [(29)]: dvb:StopGraph 2011-08-21 14:11:31.332332 [(29)]: dvb:StopGraph called 2011-08-21 14:11:31.332332 [(29)]: tvcard:FreeAllSubChannels 2011-08-21 14:11:31.332332 [TS_File_Cleanup(31)]: card: delete timeshift files C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts 2011-08-21 14:11:31.332332 [(29)]: dvb:StopGraph filterstate already stopped, returning. 2011-08-21 14:11:31.332332 [TS_File_Cleanup(31)]: card: trying to delete C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer 2011-08-21 14:11:31.332332 [(29)]: user:MS_PC remove 2011-08-21 14:11:31.332332 [(29)]: Controller:Timeshifting stopped on card:4 2011-08-21 14:11:31.332332 [(29)]: RTSP: remove stream stream4.0 2011-08-21 14:11:31.342332 [Channel state thread(25)]: Controller: DoSetChannelStates for 233 channels 2011-08-21 14:11:31.342332 [Channel state thread(25)]: ChannelStates.DoSetChannelStates took 0 msec 2011-08-21 14:11:36.332339 [TS_File_Cleanup(31)]: card: delete timeshift files C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts 2011-08-21 14:11:36.332339 [TS_File_Cleanup(31)]: card: trying to delete C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer 2011-08-21 14:11:36.332339 [TS_File_Cleanup(31)]: card: deleted file C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer 2011-08-21 14:11:36.342339 [TS_File_Cleanup(31)]: card: trying to delete C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer1.ts 2011-08-21 14:11:36.382339 [TS_File_Cleanup(31)]: card: deleted file C:\ProgramData\Team MediaPortal\MediaPortal TV Server\timeshiftbuffer\live4-0.ts.tsbuffer1.ts 2011-08-21 14:12:23.841502 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:11:23.8323 , False 2011-08-21 14:12:23.842502 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:12:23.842502 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 14:12:23.844502 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True 2011-08-21 14:13:23.852934 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 14:12:23.8445 , False 2011-08-21 14:13:23.852934 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:13:23.853934 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 14:13:23.856935 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True 2011-08-21 14:14:23.833116 [(31)]: Controller: DoSetChannelStates for 25 channels 2011-08-21 14:14:23.863116 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 14:13:23.8569 , False 2011-08-21 14:14:23.863116 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:14:23.863116 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 14:14:23.873116 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True 2011-08-21 14:14:23.963116 [(31)]: ChannelStates.DoSetChannelStates took 127 msec 2011-08-21 14:14:25.643118 [(31)]: Controller: DoSetChannelStates for 35 channels 2011-08-21 14:14:26.283119 [(31)]: ChannelStates.DoSetChannelStates took 638 msec 2011-08-21 14:14:26.353119 [(31)]: Controller: DoSetChannelStates for 25 channels 2011-08-21 14:14:26.483119 [(31)]: ChannelStates.DoSetChannelStates took 138 msec 2011-08-21 14:14:26.913120 [(31)]: Controller: DoSetChannelStates for 35 channels 2011-08-21 14:14:27.093120 [(31)]: ChannelStates.DoSetChannelStates took 179 msec 2011-08-21 14:14:31.213126 [(31)]: Controller: find free card for channel Sky Select 2011-08-21 14:14:31.213126 [(31)]: Controller: got 1 tuning details for Sky Select 2011-08-21 14:14:31.213126 [(31)]: Controller: channel #1 DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:14:31.223126 [(31)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:14:31.223126 [(31)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:14:31.223126 [(31)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:14:31.223126 [(31)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:14:31.233126 [(31)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:14:31.233126 [(31)]: Controller: found 1 available 2011-08-21 14:14:31.233126 [(31)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 20 msec 2011-08-21 14:14:31.243126 [(31)]: Controller: TimeShiftingWouldUseCard Sky Select 91 2011-08-21 14:14:31.243126 [(31)]: Controller: find free card for channel Sky Select 2011-08-21 14:14:31.243126 [(31)]: Controller: got 1 tuning details for Sky Select 2011-08-21 14:14:31.243126 [(31)]: Controller: channel #1 DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:14:31.253126 [(31)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:14:31.253126 [(31)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:14:31.253126 [(31)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:14:31.253126 [(31)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:14:31.253126 [(31)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:14:31.253126 [(31)]: Controller: found 1 available 2011-08-21 14:14:31.253126 [(31)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 16 msec 2011-08-21 14:14:31.263126 [(31)]: CiMenuSupported called cardid 4 2011-08-21 14:14:31.263126 [(31)]: CiMenuSupported card BDA 2885 TVTuner C supported: False 2011-08-21 14:14:31.263126 [(31)]: Controller: StartTimeShifting Sky Select 91 2011-08-21 14:14:31.263126 [(31)]: Controller: find free card for channel Sky Select 2011-08-21 14:14:31.273126 [(31)]: Controller: got 1 tuning details for Sky Select 2011-08-21 14:14:31.273126 [(31)]: Controller: channel #1 DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:14:31.273126 [(31)]: Controller: card:4 type:DvbC is available priority:5 #users:0 same transponder:True 2011-08-21 14:14:31.273126 [(31)]: Controller: card:3 type:DvbT is disabled 2011-08-21 14:14:31.273126 [(31)]: Controller: card:5 type:Analog is disabled 2011-08-21 14:14:31.273126 [(31)]: Controller: card:6 type:RadioWebStream is disabled 2011-08-21 14:14:31.283126 [(31)]: Controller: card:2 type:DvbC is tuned to different transponder 2011-08-21 14:14:31.283126 [(31)]: Controller: found 1 available 2011-08-21 14:14:31.283126 [(31)]: AdvancedCardAllocation.GetAvailableCardsForChannel took 13 msec 2011-08-21 14:14:31.283126 [(31)]: card: CardTune 4 Sky Select MS_PC:4:-1 2011-08-21 14:14:31.283126 [(31)]: card: Tune 4 to Sky Select 2011-08-21 14:14:31.283126 [(31)]: card: user: MS_PC:4:-1 tune DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:14:31.293126 [(31)]: dvbc: Tune:DVBC:tv:SKY Sky Select Freq:378000 ONID:133 TSID:4 SID:18 PMT:0x67 FTA:True LCN:789 SymbolRate:6900 Modulation:Mod256Qam 2011-08-21 14:14:31.293126 [(31)]: dvb:Submiting tunerequest Channel:Sky Select subChannel:-1 2011-08-21 14:14:31.293126 [(31)]: dvb:Getting new subchannel 2011-08-21 14:14:31.293126 [(31)]: dvb:GetNewSubChannel:0 #0 2011-08-21 14:14:31.293126 [(31)]: TvDvbChannel ctor new subchIndex:0 2011-08-21 14:14:31.293126 [(31)]: dvb:Submit tunerequest size:1 new:0 2011-08-21 14:14:31.293126 [(31)]: subch:0 OnBeforeTune 2011-08-21 14:14:31.293126 [(31)]: dvb:Submit tunerequest calling put_TuneRequest 2011-08-21 14:14:31.293126 [(31)]: dvb:Submit tunerequest done calling put_TuneRequest 2011-08-21 14:14:31.293126 [(31)]: subch:0 OnAfterTune 2011-08-21 14:14:31.293126 [(31)]: subch:0 OnGraphStart 2011-08-21 14:14:31.293126 [(31)]: dvb: RunGraph 2011-08-21 14:14:33.713129 [(31)]: dvb: LockedInOnSignal waiting 20ms 2011-08-21 14:14:35.363132 [(31)]: dvb: LockedInOnSignal waiting 20ms 2011-08-21 14:14:35.383132 [(31)]: dvb: LockedInOnSignal could not lock onto channel - no signal or bad signal 2011-08-21 14:14:35.383132 [(31)]: tvcard:FreeSubChannel: subchannels count 1 subch#0 keep graph=False 2011-08-21 14:14:35.383132 [(31)]: DVB subch:0 Decompose() 2011-08-21 14:14:35.383132 [(31)]: FreeSubChannel CA: freeing sub channel : 0 2011-08-21 14:14:35.383132 [(31)]: tvcard:FreeSubChannel : no subchannels present, stopping graph 2011-08-21 14:14:35.383132 [(31)]: dvb:StopGraph called 2011-08-21 14:14:35.383132 [(31)]: tvcard:FreeAllSubChannels 2011-08-21 14:14:35.393132 [(31)]: dvb:StopGraph 2011-08-21 14:14:35.693132 [(31)]: card2:MS_PC 4 -1 2011-08-21 14:14:35.693132 [(31)]: Controller: MS_PC 4 -1 2011-08-21 14:15:23.883215 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:14:23.8731 , False 2011-08-21 14:15:23.883215 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:15:23.883215 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 14:15:23.883215 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True 2011-08-21 14:16:23.903298 [Powerscheduler Timer(5)]: PowerScheduler: lastUserTime: 14:15:23.8832 , False 2011-08-21 14:16:23.903298 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:16:23.903298 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 14:16:23.903298 [Powerscheduler Timer(5)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True 2011-08-21 14:17:23.903380 [Powerscheduler Timer(16)]: PowerScheduler: lastUserTime: 14:16:23.9032 , False 2011-08-21 14:17:23.913380 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:GenericStandbyHandler DisAllowShutdown:False 2011-08-21 14:17:23.913380 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ActiveStreamsHandler DisAllowShutdown:False 2011-08-21 14:17:23.913380 [Powerscheduler Timer(16)]: PowerScheduler.DisAllowShutdown: inspecting handler:ControllerActiveHandler DisAllowShutdown:True [/CODE] [/QUOTE]
Insert quotes…
Verification
Post reply
Forums
Language specific support
Deutsches MediaPortal Forum
MediaPortal 1
Installationsprobleme?
Kein Signal mit MSI Digi Vox Trio
Contact us
RSS
Top
Bottom