Need help interpreting log please.

[deen]

Can anyone please comment on likely reasons for this failure in the log below?
I doubt the system was particularly heavily loaded at the time this happened.
Showed on recording status page as recording, ended with zero size file.

21:59:00.046 INFO BDARecorder:::StartRecording(Hauppauge Nova-T (90002), 1, E:\GBPVR_DATA\Jonathan Ross Asian Invasion\Jonathan Ross Asian Invasion_20060110_22002300.mpg, T:C51,714166,0,0,8~P:16832~V:201~A:401~PMT:702~N:>BBC FOUR)
21:59:00.062 INFO Initializing DVB-T tuning request.
21:59:00.062 INFO tuning@1
21:59:00.062 INFO tuning@2
21:59:00.062 INFO tuning@3
21:59:00.062 INFO tuning@4
21:59:00.062 INFO tuning@5
21:59:00.062 INFO tuning@6
21:59:00.062 INFO tuning@7
21:59:00.062 INFO tuning@8
21:59:00.062 INFO tuning@8
21:59:00.062 VERBOSE getSetting(BDAMultiplexer)
21:59:00.093 VERBOSE getSetting(BDAAutoDetectTuner)
21:59:00.093 VERBOSE About to auto detect correct tuner filter
21:59:00.093 VERBOSE Looking for associated filter
21:59:00.093 VERBOSE - Hauppauge WinTV 88x TS Capture
21:59:00.093 VERBOSE Successfully auto detected tuner filter: Hauppauge WinTV 88x TS Capture
21:59:00.093 VERBOSE ConnectPins: 'MPEG2 Transport' to 'MPEG-2 Stream'
21:59:00.093 VERBOSE getSetting(BDAUsePsiParser)
21:59:00.093 VERBOSE getSetting(EPGProcessingMode)
21:59:00.156 VERBOSE Creating Video pin mapped to PID 201
21:59:00.156 VERBOSE Creating Audio pin mapped to PID 401
21:59:00.156 VERBOSE Initialzing Cyberlink mux
21:59:00.156 VERBOSE Setting IID_IMpgMuxer
21:59:00.156 VERBOSE Setting IID_IMpgMuxer3
21:59:00.156 VERBOSE Setting IID_IMpgMuxerInfo
21:59:00.156 VERBOSE Finished initialzing Cyberlink mux
21:59:00.171 VERBOSE ConnectPins: 'Video' to 'Video In'
21:59:00.171 VERBOSE ConnectPins: 'Audio' to 'Audio In'
21:59:00.171 VERBOSE ConnectPins: 'Output' to 'Input'
21:59:00.171 VERBOSE locked=0 present=0 strength=-41000 quality=0
21:59:00.171 VERBOSE BDARecorder::StopRecording()
21:59:00.437 ERROR Failed to start BDA Graph
21:59:00.437 VERBOSE ERROR_NO_SYSTEM_RESOURCES
21:59:00.437 VERBOSE getSetting(ListGraphFilters)
21:59:00.437 VERBOSE Graph contains the following filters:
21:59:00.437 VERBOSE - MPEG-2 Sections and Tables
21:59:00.437 VERBOSE - BDA MPEG2 Transport Information Filter
21:59:00.437 VERBOSE - GB-PVR Writer
21:59:00.437 VERBOSE - GB-PVR PSI Parser
21:59:00.437 VERBOSE - CyberLink MPEG Muxer
21:59:00.437 VERBOSE - MPEG-2 Demultiplexer
21:59:00.437 VERBOSE - Hauppauge WinTV 88x TS Capture
21:59:00.437 VERBOSE - Hauppauge WinTV 88x DVB-T Tuner/Demod
21:59:00.437 VERBOSE - Microsoft DVBT Network Provider
21:59:00.437 VERBOSE getSetting(SaveGraphFiles)
21:59:00.437 VERBOSE BDARecorder::StartRecording() finished
23:06:00.015 VERBOSE BDARecorder::StopRecording()
23:06:00.140 VERBOSE BDARecorder::StopRecording() finished

[deen]

More logging. from GBPVRRecordingService.exe

10/01/2006 21:59:00.031 INFO [41] Found new programme requiring recording: Jonathan Ross' Asian Invasion
10/01/2006 21:59:00.031 VERBOSE [41] Changing to channel (GBPVR.Backend.Common.NullTunerController): 15
10/01/2006 21:59:00.031 VERBOSE [41] Requesting IRecordingSource to start recording: E:\GBPVR_DATA\Jonathan Ross Asian Invasion\Jonathan Ross Asian Invasion_20060110_22002300.mpg
10/01/2006 21:59:00.046 VERBOSE [41] BDARecordingSource about to start recording oid:6 channel:T:C51,714166,0,0,8~P:16832~V:201~A:401~PMT:702~N:>BBC FOUR
10/01/2006 21:59:00.171 ERROR [54] Unexpected failed in DvbEpgReader.LoadChannels(): System.NullReferenceException: Object reference not set to an instance of an object.
at NativeUtilities.BDARecorder.GetPsiParserEPG()
at GBPVR.Backend.Common.DvbEpgReader.LoadChannels(IEpgUpdateProgressCallback x421ce789b9741187)
10/01/2006 21:59:00.437 VERBOSE [41] Programme is now recording
10/01/2006 21:59:00.437 VERBOSE [41] RecordingFactory.save()
10/01/2006 21:59:00.437 VERBOSE [41] Save(): Updated existing scheduled recording
10/01/2006 21:59:00.437 VERBOSE [41] Adding E:\GBPVR_DATA\Jonathan Ross Asian Invasion\Jonathan Ross Asian Invasion_20060110_22002300.mpg to parallel processing queue
10/01/2006 21:59:00.437 VERBOSE [41] RecordingFactory.getExtrasForGroup(93)
10/01/2006 21:59:10.000 VERBOSE [426] File does not yet exist (may fail): E:\GBPVR_DATA\Jonathan Ross Asian Invasion\Jonathan Ross Asian Invasion_20060110_22002300.mpg
10/01/2006 23:06:00.015 VERBOSE [41] Recording has passed endtime+padding. Stopping.
10/01/2006 23:06:00.015 VERBOSE [41] Stopping recording oid:6
10/01/2006 23:06:00.140 VERBOSE [41] Adding E:\GBPVR_DATA\Jonathan Ross Asian Invasion\Jonathan Ross Asian Invasion_20060110_22002300.mpg to commercial detection queue
10/01/2006 23:06:00.140 VERBOSE [41] Not adding E:\GBPVR_DATA\Jonathan Ross Asian Invasion\Jonathan Ross Asian Invasion_20060110_22002300.mpg to conversion detection queue. Conversions are currently disabled.
10/01/2006 23:06:00.140 VERBOSE [41] RecordingStatus is now RecordingStatus.RECORDING_COMPETED
10/01/2006 23:06:00.140 VERBOSE [41] RecordingFactory.save()

[sub]

I dont know. Could the device already have been in use by a different process?

[deen]

It should not have been Sub, there should have been choice of 2 x tuners available at that time.

Fyi, Family made about 10 other good recordings in last 24 hours, only 1 lost.

I also noticed in GBPVRRecordingService.exe-native log that the same error happened yesterday during the scheduled epg update, so the error I had tonight is not a one off.

21:07:58.031 INFO BDARecorder:::StartRecording(Hauppauge Nova-T (90002), 1, c:\gbepg.mpg, T:C47,682166,0,0,8)
21:07:58.031 INFO Initializing DVB-T tuning request.
21:07:58.031 INFO tuning@1
21:07:58.031 INFO tuning@2
21:07:58.031 INFO tuning@3
21:07:58.031 INFO tuning@4
21:07:58.031 INFO tuning@5
21:07:58.031 INFO tuning@6
21:07:58.031 INFO tuning@7
21:07:58.031 INFO tuning@8
21:07:58.031 INFO tuning@8
21:07:58.031 VERBOSE getSetting(BDAMultiplexer)
21:07:58.046 VERBOSE getSetting(BDAAutoDetectTuner)
21:07:58.046 VERBOSE About to auto detect correct tuner filter
21:07:58.046 VERBOSE Looking for associated filter
21:07:58.062 VERBOSE - Hauppauge WinTV 88x TS Capture
21:07:58.062 VERBOSE Successfully auto detected tuner filter: Hauppauge WinTV 88x TS Capture
21:07:58.062 VERBOSE ConnectPins: 'MPEG2 Transport' to 'MPEG-2 Stream'
21:07:58.062 VERBOSE getSetting(BDAUsePsiParser)
21:07:58.062 VERBOSE getSetting(EPGProcessingMode)
21:07:58.062 VERBOSE Creating Video pin mapped to PID 101
21:07:58.062 VERBOSE Creating Audio pin mapped to PID 102
21:07:58.078 VERBOSE Initialzing Cyberlink mux
21:07:58.078 VERBOSE Setting IID_IMpgMuxer
21:07:58.078 VERBOSE Setting IID_IMpgMuxer3
21:07:58.078 VERBOSE Setting IID_IMpgMuxerInfo
21:07:58.078 VERBOSE Finished initialzing Cyberlink mux
21:07:58.078 VERBOSE ConnectPins: 'Video' to 'Video In'
21:07:58.078 VERBOSE ConnectPins: 'Audio' to 'Audio In'
21:07:58.078 VERBOSE ConnectPins: 'Output' to 'Input'
21:07:58.093 VERBOSE locked=0 present=0 strength=-41000 quality=0
21:07:58.296 ERROR Failed to start BDA Graph
21:07:58.296 VERBOSE ERROR_NO_SYSTEM_RESOURCES

[sub]

You're not running on Windows Media Center? If so, that can be holding the devices in use in the back ground. Thats about the only thing I can think of that might lead to that error (or something is wrong with the drivers).

[deen]

No media edition, just plain old XP here.

If this error didn't ring a bell for you then I'll cut and run and make a re-install of gb-pvr and see if that clears it.

Was all working quite well with only occasional zero files with no logged error which I put down to mux issues before this. Hopefully after a clean up and reinstall I can be back where I was.

Thanks again for your help.