Problem with playing recordings

[joeuser]

Occasionally when playing recordings, the playback position of the recording is not determined correctly. It will show "1315:00/25:22" - with "1315:00" always being the same and the length (25:22) showing correctly. The graphic shows the playback is at the very end and it does not show anything for time remaining. The recording plays fine and pause/play works ok, but if you try to jump forward or backward the playback stops immediately as if it reached the end of the recording. The position time increases as the recording is played and would be correct if you subtract the 1315:00 offset. Sometimes the real position will display for a second then it goes back to displaying the incorrect position. (ie. 1322:00/25:22 -> then 7:00/25:22 -> then back to 1322:00/25:22 ) When this problem occurs, it affects ALL recordings. It does not seem to affect other media files (mpg,mp4, etc) - only the ts file recordings. It also occurs whether or not the playback position of a partially played recording is saved. If a playback position was saved, the recording plays from the beginning and does not try to continue from previous playback position. Even if I reset the playback position, the problem still occurs. Exiting and restarting the movie player does not resolve the problem.

Here is the serial console output when the problem occurs:

playing 1:0:0:0:0:0:0:0:0:0:/hdd/movie/20150421 1142 - channel - title.ts
eFilePushThread stopping thread
FILEPUSH THREAD STOP
resolved to PLAY
eDVBServicePlay::unpause
decoder state: play, vpid=2298, apid=3304
VIDEO_CONTINUE - ok
VIDEO_SLOWMOTION(0) - ok
VIDEO_FAST_FORWARD(0) - ok
AUDIO_CONTINUE - ok
decoder state: play, vpid=-1, apid=-1
DEMUX_STOP - video - ok
VIDEO_STOP - ok
AUDIO_STOP - ok
DEMUX_STOP - audio - ok
AUDIO_CONTINUE - ok
cleaning up
TuxTxt cache cleared
getResolvedKey config.usage.remote_fallback failed !! (Typo??)
alloc PVR
allocate demux
loading streaminfo for /hdd/movie/20150421 1142 - channel - title.ts
cuts file has 2 entries
[@ML] m_streaminfo.getLastFrame returned 106220, 5656005866 (62844s), fixup to: 106220, 24047 (0s)
eventNewProgramInfo 0 0
have 1 video stream(s) (08fa), and 1 audio stream(s) (0ce8), and the pcr pid is 08fa, and the text pid is ffffffff
setIoPrio best-effort level 0 ok
FILEPUSH THREAD START
TuxTxt cache cleared
decoder state: play, vpid=2298, apid=3304
DMX_SET_PES_FILTER(0xce8) - audio - ok
AUDIO_SET_BYPASS(1) - ok
AUDIO_PLAY - ok
Video Device: /dev/dvb/adapter0/video0
demux device: /dev/dvb/adapter0/demux3
VIDEO_SET_STREAMTYPE 0 - ok
DMX_SET_PES_FILTER(0x8fa) - video - ok
VIDEO_PLAY - ok
VIDEO_CONTINUE - ok
VIDEO_SLOWMOTION(0) - ok
VIDEO_FAST_FORWARD(0) - ok
AUDIO_CONTINUE - ok
disable teletext subtitles page ffffffffffffffff (und)
eDVBServicePlay::seekTo: jump 0
seek.
FILEPUSH waiting for pause
FILEPUSH THREAD PAUSED
AUDIO_CLEAR_BUFFER - ok
VIDEO_CLEAR_BUFFER - ok
ok, resolved skip (rel: 0, diff 0), now at 00000000
[__evUpdatedInfo]
[writeChannelName]
vfd display text: TITLE
[showCrypted]
[showDolby]
[showMp3]
RemovePopup, id = ZapError
[__evUpdatedEventInfo]
[__evUpdatedEventInfo]
[__evStart]
[__evSeekableStatusChanged]
resolved to PLAY
eDVBServicePlay::unpause
RemovePopup, id = ZapError
eDVBChannel: pvrEvent evtStopped
VIDEO_GET_EVENT - ok
unhandled DVBAPI Video Event 9
VIDEO_GET_EVENT - ok
[__evVideoSizeChanged]
VIDEO_GET_EVENT - ok
VIDEO_GET_EVENT - ok
unhandled DVBAPI Video Event 12
use pmtpid 00dc for service_id 1d5f
eventNewProgramInfo 0 0
have 1 video stream(s) (08fa), and 2 audio stream(s) (0ce7, 0ce8), and the pcr pid is 08fa, and the text pid is ffffffff
decoder state: play, vpid=2298, apid=3304
VIDEO_CONTINUE - ok
VIDEO_SLOWMOTION(0) - ok
VIDEO_FAST_FORWARD(0) - ok
AUDIO_CONTINUE - ok
[__evUpdatedInfo]
[writeChannelName]
vfd display text: TITLE
[showCrypted]
[showDolby]
[showMp3]

[joeuser]

Yesterday I installed HDMU_13796_E2_spark7162_217_git_3590_nodebug_mix_U SB.tar.gz and there is still a problem.

[thom]

Hallo

ich hatte das von joeuser beschriebene Problem auch schon einige male. Der Fehler ließ sich immer nur durch einen kompletten Neustart des Receivers beheben. Also ein einfacher Reboot reicht nicht, man muss den Receiver richtig vom Netz trennen bzw am Netzschalter ausschalten.

[joeuser]

Still a problem today. No ideas anyone??? Can you make a debug image?

[joeuser]

Problem still exists with latest image. (HDMU_14053_E2_spark7162_217_git_3894) I was hoping the gstreamer change would help, but it does not. I understand it could be a problem with the pti kernel module, but I have used three different pti modules and with all the same problem exists.

[santa]

Morly will fix the actualy problems with gst 1.5.2, maybe after this he have time to look for this issue

[joeuser]

Thanks. I have a serial console and can log any debug versions you create. Can someone build a kernel with printk enabled? I do not need a full image, just the uImage. Also, if there are some debugging options for any modules that you think would be helpful, I can enable them.

[joeuser]

I just installed the latest PKT Hyperion v5.1 and have seen the same problem. So I guess it is part of the underlying duckbox-developers base. I will ask over there if they have any ideas as to the problem...