Sometimes No TV picture (1 Viewer)

[mm1352000]

Having said that, this is interesting enough...
[2014-12-07 19:27:05,362] [Log ] [29 ] [INFO ] - Controller: delete timeshift files C:\timeshift\live5-0.ts
[2014-12-07 19:27:05,362] [Log ] [29 ] [INFO ] - Controller: delete C:\timeshift\live5-0.ts.tsbuffer
[2014-12-07 19:27:05,362] [Log ] [29 ] [DEBUG] - Controller: Error "The process cannot access the file 'C:\timeshift\live5-0.ts.tsbuffer' because it is being used by another process." on delete in CleanTimeshiftFiles
[2014-12-07 19:27:05,363] [Log ] [29 ] [INFO ] - Controller: delete C:\timeshift\live5-0.ts.tsbuffer1.ts
[2014-12-07 19:27:05,363] [Log ] [29 ] [DEBUG] - Controller: Error "The process cannot access the file 'C:\timeshift\live5-0.ts.tsbuffer1.ts' because it is being used by another process." on delete in CleanTimeshiftFiles
[2014-12-07 19:27:05,363] [Log ] [29 ] [INFO ] - Controller: delete C:\timeshift\live5-0.ts.tsbuffer2.ts
[2014-12-07 19:27:05,363] [Log ] [29 ] [DEBUG] - Controller: Error "The process cannot access the file 'C:\timeshift\live5-0.ts.tsbuffer2.ts' because it is being used by another process." on delete in CleanTimeshiftFiles

 

[mylle]

Thanks for helping out guys! Here is the tswriter log

 

[mylle]

Hi guys,

Now with debug log setting from client. Same version on both server and client.

Same thing. I tv does not work. stop and play a recording. Afterwards tv works again. Funny thing though. I accidently chose "resume" recording instead of chosing "play from beginning". That time going back to tv did NOT work. Went back and played the recording from the beginning this time. Now tv works..... Dont know if it was just a coincident?

/Jacob

 

[Owlsroost]

I can't tell why it's happening, but there seems to be a problem with accessing/deleting timeshift buffer files:

[2014-12-10 16:10:22,995] [Log    ] [25       ] [INFO ] - **************************************************
[2014-12-10 16:10:22,995] [Log    ] [25       ] [INFO ] - ***** SIGNAL LEVEL: 100, SIGNAL QUALITY: 100 *****
[2014-12-10 16:10:22,995] [Log    ] [25       ] [INFO ] - **************************************************
[2014-12-10 16:10:22,996] [Log    ] [25       ] [DEBUG] - card: tuned user: mediacenter subchannel: 0
[2014-12-10 16:10:22,996] [Log    ] [25       ] [INFO ] - user:mediacenter add
[2014-12-10 16:10:22,996] [Log    ] [25       ] [INFO ] - card2:mediacenter 5 0
[2014-12-10 16:10:22,996] [Log    ] [25       ] [INFO ] - Controller: delete timeshift files R:\timeshift\live5-0.ts
[2014-12-10 16:10:22,996] [Log    ] [25       ] [INFO ] - Controller:   delete R:\timeshift\live5-0.ts.tsbuffer
[2014-12-10 16:10:22,997] [Log    ] [25       ] [DEBUG] - Controller: Error "The process cannot access the file 'R:\timeshift\live5-0.ts.tsbuffer' because it is being used by another process." on delete in CleanTimeshiftFiles
[2014-12-10 16:10:22,997] [Log    ] [25       ] [INFO ] - Controller:   delete R:\timeshift\live5-0.ts.tsbuffer1.ts
[2014-12-10 16:10:22,997] [Log    ] [25       ] [DEBUG] - Controller: Error "The process cannot access the file 'R:\timeshift\live5-0.ts.tsbuffer1.ts' because it is being used by another process." on delete in CleanTimeshiftFiles
[2014-12-10 16:10:22,997] [Log    ] [25       ] [DEBUG] - TVServerXBMC: OnTvServerEvent: StartTimeShifting
[2014-12-10 16:10:22,997] [Log    ] [25       ] [INFO ] - Controller: epg stop
[2014-12-10 16:10:22,999] [Log    ] [25       ] [INFO ] - card: StartTimeShifting 5 R:\timeshift\live5-0.ts
[2014-12-10 16:10:22,999] [Log    ] [25       ] [INFO ] - card: CAM enabled : False
[2014-12-10 16:10:22,999] [Log    ] [25       ] [INFO ] - subch:0 SetTimeShiftFileName:R:\timeshift\live5-0.ts
[2014-12-10 16:10:23,000] [Log    ] [25       ] [INFO ] - Set video / audio observer
[2014-12-10 16:10:23,000] [Log    ] [25       ] [INFO ] - subch:0 SetTimeShiftFileName fill in pids
[2014-12-10 16:10:23,000] [Log    ] [25       ] [INFO ] - subch:0-0 tswriter StartTimeshifting...
[2014-12-10 16:10:23,000] [Log    ] [25       ] [INFO ] - card: WaitForFile - waiting _eventAudio & _eventVideo
[2014-12-10 16:10:23,007] [Log    ] [5        ] [INFO ] - PID seen - type = Video
[2014-12-10 16:10:23,007] [Log    ] [5        ] [INFO ] - audioVideoEventHandler Video
[2014-12-10 16:10:23,068] [Log    ] [5        ] [INFO ] - PID seen - type = Audio
[2014-12-10 16:10:23,068] [Log    ] [5        ] [INFO ] - audioVideoEventHandler Audio
[2014-12-10 16:10:23,068] [Log    ] [25       ] [INFO ] - card: WaitForFile - video and audio are seen after 0,0676976 seconds
[2014-12-10 16:10:23,070] [Log    ] [25       ] [INFO ] - user:mediacenter card:5 sub:0 add stream:R:\timeshift\live5-0.ts.tsbuffer
[2014-12-10 16:10:23,071] [Log    ] [25       ] [INFO ] - RTSP: add stream stream5.0 file:R:\timeshift\live5-0.ts.tsbuffer
[2014-12-10 16:10:23,071] [Log    ] [25       ] [INFO ] - Controller: StartTimeShifting started on card:5 to R:\timeshift\live5-0.ts.tsbuffer
[2014-12-10 16:10:23,071] [Log    ] [25       ] [DEBUG] - CardReservation.RemoveTuneTicket: removed reservation with id=144, tuningdetails=DVBC:tv:TV2 TV2 Zulu HD Freq:554000 ONID:100 TSID:11 SID:13942 PMT:0xBB9 FTA:True LCN:59 SymbolRate:6875 Modulation:Mod256Qam
[2014-12-10 16:10:23,071] [Log    ] [25       ] [INFO ] - card: SignalTuneEvent card: 5 / subch: 0
[2014-12-10 16:10:23,072] [Log    ] [25       ] [INFO ] - Controller: mediacenter 5 0
[2014-12-10 16:10:23,072] [Log    ] [25       ] [DEBUG] - TVServerXBMC: OnTvServerEvent: EndZapChannel
[2014-12-10 16:10:23,072] [Log    ] [25       ] [DEBUG] - CardReservation.CancelCardReservation id=145
[2014-12-10 16:10:23,072] [Log    ] [25       ] [INFO ] - control2:mediacenter 5 0
[2014-12-10 16:10:23,073] [Log    ] [34       ] [DEBUG] - Controller: DoSetChannelStates for 60 channels
[2014-12-10 16:10:23,076] [Log    ] [25       ] [DEBUG] - CiMenuSupported called cardid 5
[2014-12-10 16:10:23,076] [Log    ] [25       ] [DEBUG] - CiMenuSupported card Digital Devices DVB-C Tuner 1 supported: False
[2014-12-10 16:10:23,077] [Log    ] [34       ] [INFO ] - ChannelStates.GetAllTimeshiftingAndRecordingChannels took 0 msec
[2014-12-10 16:10:23,144] [Log    ] [5        ] [INFO ] - PID seen - type = Audio
[2014-12-10 16:10:23,144] [Log    ] [5        ] [INFO ] - audio last seen at 10-12-2014 16:10:23
[2014-12-10 16:10:23,274] [Log    ] [34       ] [INFO ] - ChannelStates.DoSetChannelStates took 200 msec
[2014-12-10 16:10:23,954] [Log    ] [19       ] [DEBUG] - TVServerXBMC: Handling command: GetDriveSpace
[2014-12-10 16:10:23,956] [Log    ] [19       ] [DEBUG] - TVServerXBMC: Handling command: GetChannelCount
[2014-12-10 16:10:23,966] [Log    ] [19       ] [DEBUG] - TVServerXBMC: Handling command: GetScheduleCount
[2014-12-10 16:10:23,969] [Log    ] [19       ] [DEBUG] - TVServerXBMC: Handling command: GetRecordingCount
[2014-12-10 16:10:25,377] [Log    ] [TS_File_Cleanup] [INFO ] - card: delete timeshift files R:\timeshift\live5-0.ts
[2014-12-10 16:10:25,377] [Log    ] [TS_File_Cleanup] [INFO ] - card:   trying to delete R:\timeshift\live5-0.ts.tsbuffer
[2014-12-10 16:10:33,980] [Log    ] [19       ] [DEBUG] - TVServerXBMC: Handling command: GetDriveSpace
[2014-12-10 16:10:33,983] [Log    ] [19       ] [DEBUG] - TVServerXBMC: Handling command: GetChannelCount
[2014-12-10 16:10:33,992] [Log    ] [19       ] [DEBUG] - TVServerXBMC: Handling command: GetScheduleCount
[2014-12-10 16:10:33,994] [Log    ] [19       ] [DEBUG] - TVServerXBMC: Handling command: GetRecordingCount
[2014-12-10 16:10:35,199] [Log    ] [3        ] [DEBUG] - TVServerXBMC: OnTvServerEvent: EndTimeShifting
[2014-12-10 16:10:35,199] [Log    ] [3        ] [INFO ] - Controller: StopTimeShifting 5

...note...
[2014-12-10 16:10:22,997] [Log ] [25 ] [DEBUG] - Controller: Error "The process cannot access the file 'R:\timeshift\live5-0.ts.tsbuffer'
...followed by.....
[2014-12-10 16:10:23,071] [Log ] [25 ] [INFO ] - Controller: StartTimeShifting started on card:5 to R:\timeshift\live5-0.ts.tsbuffer
...then.....
[2014-12-10 16:10:25,377] [Log ] [TS_File_Cleanup] [INFO ] - card: delete timeshift files R:\timeshift\live5-0.ts
[2014-12-10 16:10:25,377] [Log ] [TS_File_Cleanup] [INFO ] - card: trying to delete R:\timeshift\live5-0.ts.tsbuffer

i.e. it's trying to delete buffer files that are actually the current 'live' files TsWriter is trying to write to....

What's your system setup ?
How many clients do you have etc. and how are they connected ? Do they all use UNC paths for TV ?

 

[mylle]

hmmm. I actually noticed that mpextended sometimes leaves .ts files even though the client has disconnected. Could that cause a problem?

Im only use one client otherwise which is using UNC. When the problem occurs with the UNC client im still able to use Ampdroid for tv on my tablet

 

[Owlsroost]

Next time it happens, before you stop TV (because that will delete the buffer files), take a look in the timeshift folder on the server and find out what files are in there.

. I actually noticed that mpextended sometimes leaves .ts files even though the client has disconnected. Could that cause a problem?

The 'The process cannot access the file' error messages in the log are probably because another process has somehow left them locked or open in a non-shared mode. TsReader.ax opens them 'shared' to avoid that potential problem. I don't know what MPExtended does.