rendered paste body2010-07-29 21:43:15.528 mythfrontend version: trunk [Unknown] www.mythtv.org
2010-07-29 21:43:15.529 Using runtime prefix = /usr/local
2010-07-29 21:43:15.529 Using configuration directory = /home/mythtv-user/.mythtv
2010-07-29 21:43:16.347 Using localhost value of bedroom2
2010-07-29 21:43:16.359 New DB connection, total: 1
2010-07-29 21:43:21.392 Connected to database 'mythconverg' at host: 192.168.1.160
2010-07-29 21:43:21.393 Closing DB connection named 'DBManager0'
2010-07-29 21:43:21.393 Current locale en_US
2010-07-29 21:43:21.394 No locale defaults file for en_US, skipping
2010-07-29 21:43:21.412 ScreenSaverX11Private: Gnome screen saver support enabled
2010-07-29 21:43:21.413 DPMS is disabled.
2010-07-29 21:43:26.437 Connected to database 'mythconverg' at host: 192.168.1.160
2010-07-29 21:43:26.480 Desktop video mode: 244x163 16680 Hz
2010-07-29 21:43:26.529 max_width: 720 max_height: 480
2010-07-29 21:43:26.533 user: 1001 effective user: 1001 before privileged thread
2010-07-29 21:43:26.533 user: 1001 effective user: 1001 after privileged thread
2010-07-29 21:43:26.533 user: 1001 effective user: 1001 run_priv_thread
2010-07-29 21:43:26.533 Enabled verbose msgs: important general playback
2010-07-29 21:43:26.576 LIRC: Successfully initialized '/var/run/lirc/lircd' using '/home/mythtv-user/.mythtv/lircrc' config
2010-07-29 21:43:26.576 JoystickMenuThread: Joystick disabled - Failed to read /home/mythtv-user/.mythtv/joystickmenurc
2010-07-29 21:43:26.699 Using Frameless Window
2010-07-29 21:43:26.859 Using the Qt painter
2010-07-29 21:43:26.952 MythFontProperties, Warning: Attempting to define 'small'
with face 'DejaVu Sans', but it already exists with face 'Arial'
Location: /usr/local/share/mythtv/themes/MythCenter/base.xml @ 1006
Name: 'small' Type: 'fontdef'
2010-07-29 21:43:26.957 MythFontProperties, Error: Failed to load 'Thorndale', got 'DejaVu Sans' instead
Location: /usr/local/share/mythtv/themes/MythCenter/base.xml @ 1012
Name: 'medium' Type: 'fontdef'
2010-07-29 21:43:26.961 MythFontProperties, Error: Failed to load 'Thorndale', got 'DejaVu Sans' instead
Location: /usr/local/share/mythtv/themes/MythCenter/base.xml @ 1018
Name: 'large' Type: 'fontdef'
2010-07-29 21:43:26.965 MythFontProperties, Error: Failed to load 'Thorndale', got 'DejaVu Sans' instead
Location: /usr/local/share/mythtv/themes/MythCenter/base.xml @ 1024
Name: 'clock' Type: 'fontdef'
2010-07-29 21:43:26.983 Current MythTV Schema Version (DBSchemaVer): 1262
2010-07-29 21:43:26.984 VDP: decoder<->render support: ffmpeg null directfb xlib xshm xv-blit opengl vdpau
2010-07-29 21:43:26.984 VDP: decoder<->render support: libmpeg2 null directfb xlib xshm xv-blit opengl vdpau
2010-07-29 21:43:26.984 VDP: decoder<->render support: xvmc xvmc-blit
2010-07-29 21:43:26.984 VDP: decoder<->render support: xvmc-vld xvmc-blit
2010-07-29 21:43:26.984 VDP: decoder<->render support: vdpau vdpau
2010-07-29 21:43:26.993 VDP: Ignoring profile item 151 (OSD Renderer opengl is not supported w/renderer xvmc-blit (supported: chromakey,ia44blend))
2010-07-29 21:43:26.999 VDP: Ignoring profile item 149 (renderer quartz-blit is not supported w/decoder ffmpeg (supported: null,directfb,xlib,xshm,xv-blit,opengl,vdpau))
2010-07-29 21:43:27.002 VDP: Ignoring profile item 155 (decoder ivtv is not supported (supported: ffmpeg,libmpeg2,xvmc,xvmc-vld,vdpau))
2010-07-29 21:43:27.006 VDP: Ignoring profile item 162 (renderer quartz-blit is not supported w/decoder ffmpeg (supported: null,directfb,xlib,xshm,xv-blit,opengl,vdpau))
2010-07-29 21:43:27.006 VDP: Ignoring profile item 163 (renderer quartz-blit is not supported w/decoder ffmpeg (supported: null,directfb,xlib,xshm,xv-blit,opengl,vdpau))
2010-07-29 21:43:27.009 VDP: Ignoring profile item 166 (renderer quartz-blit is not supported w/decoder ffmpeg (supported: null,directfb,xlib,xshm,xv-blit,opengl,vdpau))
2010-07-29 21:43:27.009 VDP: Ignoring profile item 167 (renderer quartz-blit is not supported w/decoder ffmpeg (supported: null,directfb,xlib,xshm,xv-blit,opengl,vdpau))
2010-07-29 21:43:27.013 VDP: Ignoring profile item 170 (renderer quartz-blit is not supported w/decoder ffmpeg (supported: null,directfb,xlib,xshm,xv-blit,opengl,vdpau))
2010-07-29 21:43:27.013 VDP: Ignoring profile item 171 (renderer quartz-blit is not supported w/decoder ffmpeg (supported: null,directfb,xlib,xshm,xv-blit,opengl,vdpau))
2010-07-29 21:43:30.174 Registering Internal as a media playback plugin.
2010-07-29 21:43:30.182 Plugin mytharchive (0.23.20100717-1) binary version does not match libraries (0.23.20100728-1)
2010-07-29 21:43:30.182 Test Popup Version Failed
2010-07-29 21:43:30.183 Unable to initialize plugin 'mytharchive'.
2010-07-29 21:43:30.186 Plugin mythbrowser (0.23.20100717-1) binary version does not match libraries (0.23.20100728-1)
2010-07-29 21:43:30.186 Unable to initialize plugin 'mythbrowser'.
2010-07-29 21:43:30.192 Plugin mythgallery (0.23.20100717-1) binary version does not match libraries (0.23.20100728-1)
2010-07-29 21:43:30.192 Unable to initialize plugin 'mythgallery'.
2010-07-29 21:43:30.197 Plugin mythgame (0.23.20100717-1) binary version does not match libraries (0.23.20100728-1)
2010-07-29 21:43:30.197 libmythgame.so/main.o: binary version mismatch
2010-07-29 21:43:30.197 Unable to initialize plugin 'mythgame'.
2010-07-29 21:43:30.200 Plugin mythmovies (0.23.20100513-1) binary version does not match libraries (0.23.20100728-1)
2010-07-29 21:43:30.201 libmythmovies.so/main.o: binary version mismatch
2010-07-29 21:43:30.201 Unable to initialize plugin 'mythmovies'.
2010-07-29 21:43:30.232 Plugin mythmusic (0.23.20100717-1) binary version does not match libraries (0.23.20100728-1)
2010-07-29 21:43:30.232 Unable to initialize plugin 'mythmusic'.
2010-07-29 21:43:30.236 Plugin mythnetvision (0.23.20100717-1) binary version does not match libraries (0.23.20100728-1)
2010-07-29 21:43:30.236 Unable to initialize plugin 'mythnetvision'.
2010-07-29 21:43:30.239 Plugin mythnews (0.23.20100717-1) binary version does not match libraries (0.23.20100728-1)
2010-07-29 21:43:30.239 Unable to initialize plugin 'mythnews'.
2010-07-29 21:43:30.246 Plugin mythvideo (0.23.20100717-1) binary version does not match libraries (0.23.20100728-1)
2010-07-29 21:43:30.246 Unable to initialize plugin 'mythvideo'.
2010-07-29 21:43:30.250 Plugin mythweather (0.23.20100717-1) binary version does not match libraries (0.23.20100728-1)
2010-07-29 21:43:30.251 Unable to initialize plugin 'mythweather'.
2010-07-29 21:43:30.254 Plugin mythzoneminder (0.23.20100513-1) binary version does not match libraries (0.23.20100728-1)
2010-07-29 21:43:30.254 Unable to initialize plugin 'mythzoneminder'.
2010-07-29 21:43:30.304 MMUnix::AddDevice() Error: failed to stat /dev/bdi,
eno: No such file or directory (2)
2010-07-29 21:43:30.316 MMUnix::AddDevice() Error: failed to stat /dev/power,
eno: No such file or directory (2)
2010-07-29 21:43:30.329 MMUnix::AddDevice() Error: failed to stat /dev/trace,
eno: No such file or directory (2)
2010-07-29 21:43:30.342 MMUnix::AddDevice() Error: failed to stat /dev/bdi,
eno: No such file or directory (2)
2010-07-29 21:43:30.350 MMUnix::AddDevice() Error: failed to stat /dev/power,
eno: No such file or directory (2)
2010-07-29 21:43:30.356 MMUnix::AddDevice() Error: failed to stat /dev/trace,
eno: No such file or directory (2)
2010-07-29 21:43:30.373 NetworkControl: Listening for remote connections on port 7000
2010-07-29 21:43:30.529 Loading menu theme from /usr/local/share/mythtv/themes/defaultmenu//mainmenu.xml
2010-07-29 21:43:30.531 Found mainmenu.xml for theme 'MythCenter'
2010-07-29 21:43:30.578 MythCoreContext: Connecting to backend server: 192.168.1.160:6543 (try 1 of 1)
2010-07-29 21:43:30.582 Using protocol version 58
2010-07-29 21:43:30.591 SendReceiveStringList(QUERY_TIME_ZONE) called from UI thread
2010-07-29 21:43:33.898 Loading menu theme from /home/mythtv-user/.mythtv/library.xml
2010-07-29 21:43:33.901 ScreenSaverX11Private: Calling gnome-screensaver-command --poke
2010-07-29 21:43:34.710 SendReceiveStringList(QUERY_HOSTNAME) called from UI thread
2010-07-29 21:43:34.715 New DB connection, total: 2
2010-07-29 21:43:39.735 Connected to database 'mythconverg' at host: 192.168.1.160
2010-07-29 21:43:40.043 PlaybackBoxHelper: Requesting preview for 'myth://192.168.1.160:6543/4747_20100729210000.mpg.png'
2010-07-29 21:43:40.044 PlaybackBoxHelper: Requested preview for 'myth://192.168.1.160:6543/4747_20100729210000.mpg.png'
2010-07-29 21:43:40.045 MythCoreContext: Connecting to backend server: 192.168.1.160:6543 (try 1 of 1)
2010-07-29 21:43:40.049 Using protocol version 58
2010-07-29 21:43:40.535 PlaybackBoxHelper: Not requesting preview as it is already being generated
2010-07-29 21:43:41.162 PlaybackBoxHelper: Requesting preview for 'myth://192.168.1.160:6543/4004_20100729203000.mpg.png'
2010-07-29 21:43:41.162 PlaybackBoxHelper: Requested preview for 'myth://192.168.1.160:6543/4004_20100729203000.mpg.png'
2010-07-29 21:43:41.163 MythCoreContext: Connecting to backend server: 192.168.1.160:6543 (try 1 of 1)
2010-07-29 21:43:41.185 Using protocol version 58
2010-07-29 21:43:41.191 PlaybackBoxHelper: Requesting preview for 'myth://192.168.1.160:6543/4098_20100729180000.mpg.png'
2010-07-29 21:43:41.191 PlaybackBoxHelper: Requested preview for 'myth://192.168.1.160:6543/4098_20100729180000.mpg.png'
2010-07-29 21:43:41.192 MythCoreContext: Connecting to backend server: 192.168.1.160:6543 (try 1 of 1)
2010-07-29 21:43:41.251 Using protocol version 58
2010-07-29 21:43:41.426 PlaybackBoxHelper: Not requesting preview as it is already being generated
2010-07-29 21:43:41.432 PlaybackBoxHelper: Not requesting preview as it is already being generated
2010-07-29 21:43:41.439 PlaybackBoxHelper: Not requesting preview as it is already being generated
2010-07-29 21:43:41.445 PlaybackBoxHelper: Not requesting preview as it is already being generated
2010-07-29 21:43:41.539 PlaybackBoxHelper: Not requesting preview as it is already being generated
2010-07-29 21:43:41.565 Preview Error: Remote Preview failed, reason given: ERROR_UNKNOWN
2010-07-29 21:43:41.565 PlaybackBoxHelper: Preview for 'myth://192.168.1.160:6543/4098_20100729180000.mpg.png' done
2010-07-29 21:43:41.571 Preview: previewThreadDone took 6ms
2010-07-29 21:43:41.583 Preview Error: Remote Preview failed, reason given: ERROR_UNKNOWN
2010-07-29 21:43:41.583 PlaybackBoxHelper: Preview for 'myth://192.168.1.160:6543/4004_20100729203000.mpg.png' done
2010-07-29 21:43:41.589 Preview Error: Remote Preview failed, reason given: ERROR_UNKNOWN
2010-07-29 21:43:41.589 Preview: previewThreadDone took 6ms
2010-07-29 21:43:41.589 PlaybackBoxHelper: Preview for 'myth://192.168.1.160:6543/4747_20100729210000.mpg.png' done
2010-07-29 21:43:41.594 Preview: previewThreadDone took 6ms
2010-07-29 21:43:44.722 TV: StartTV() -- begin
2010-07-29 21:43:44.723 TV: ctor -- begin
2010-07-29 21:43:44.723 TV: ctor -- end
2010-07-29 21:43:44.723 TV: Init -- begin
2010-07-29 21:43:44.766 TV: Init -- end
2010-07-29 21:43:44.767 SendReceiveStringList(MESSAGE,SYSTEM_EVENT PLAY_STARTED HOSTNAME bedroom2 CHANID 4747 STARTTIME 2010-07-29T21:00:00 SENDER bedroom2) called from UI thread
2010-07-29 21:43:44.777 TV: tv->Playback() -- begin
2010-07-29 21:43:44.794 TV: tv->Playback() -- end
2010-07-29 21:43:44.794 TV: StartTV -- process events begin
2010-07-29 21:43:44.799 TV: HandleStateChange(0) -- begin
2010-07-29 21:43:44.799 TV: Attempting to change from None to WatchingRecording
2010-07-29 21:43:44.805 RingBuf(/living-video/4747_20100729210000.mpg): OpenFile(/living-video/4747_20100729210000.mpg, 12)
2010-07-29 21:43:44.820 RingBuf(/living-video/4747_20100729210000.mpg): CalcReadAheadThresh(0 KB)
-> threshhold(64 KB) min read(0 KB) blk size(32 KB)
2010-07-29 21:43:44.831 TV: DrawUnusedRects() -- begin
2010-07-29 21:43:44.831 TV: DrawUnusedRects() -- end
2010-07-29 21:43:44.832 SendReceiveStringList(GET_RECORDER_NUM,The Universe...) called from UI thread
2010-07-29 21:43:44.835 MythCoreContext: Connecting to backend server: 192.168.1.160:6543 (try 1 of 1)
2010-07-29 21:43:44.846 Using protocol version 58
2010-07-29 21:43:44.853 TV: StartPlayer(0, WatchingRecording, main) -- begin
2010-07-29 21:43:44.853 TV: Elapsed time since TV constructor was called: 130 ms
2010-07-29 21:43:44.920 AudioPlayer: Disabling Audio, params(0,2,44100)
2010-07-29 21:43:45.104 AO: Resampling from 44 kHz to 48 kHz with quality medium
2010-07-29 21:43:45.105 AO: Opening audio device 'default' ch 2(2) sr 48000 sf signed 32 bit reenc 0
2010-07-29 21:43:45.258 Opening ALSA audio device 'default'.
2010-07-29 21:43:45.360 AudioPlayer: Enabling Audio
2010-07-29 21:43:46.054 [indeo3 @ 0x7ff572ff8500]y/u/v offset outside buffer
2010-07-29 21:43:47.703 AFD: Stream #0, has id 0x1011 codec id INDEO3, type Video, bitrate 0 at 0x7ff554314460
2010-07-29 21:43:47.798 VDP: Accepting: cmp(>= 0 0) dec(vdpau) cpus(2) skiploop(disabled) rend(vdpau) osd(vdpau) osdfade(enabled) deint(vdpaubobdeint,vdpauonefield) filt()
2010-07-29 21:43:47.798 VDP: Accepting: cmp(>= 0 0) dec(ffmpeg) cpus(2) skiploop(disabled) rend(vdpau) osd(vdpau) osdfade(enabled) deint(vdpaubobdeint,vdpauonefield) filt()
2010-07-29 21:43:47.799 VDP: LoadBestPreferences(2048x2048, 0)
2010-07-29 21:43:47.799 VDP: LoadBestPreferences(2048x2048, 60)
2010-07-29 21:43:47.799 VDP: LoadBestPreferences(59651x768, 60)
2010-07-29 21:43:47.799 AFD: Using 2 CPUs for decoding
2010-07-29 21:43:47.799 AFD: InitVideoCodec() 0x7ff554314680 id(INDEO3) type (Video).
2010-07-29 21:43:47.800 NVP(0): detectInterlace(Detect Scan, Interlaced Scan, 89.9101, 768) ->Progressive Scan
2010-07-29 21:43:47.800 AFD: Using ffmpeg for video decoding
2010-07-29 21:43:47.800 AFD: Looking for decoder for INDEO3
2010-07-29 21:43:47.802 AFD: Opened codec 0x7ff554314680, id(INDEO3) type(Video)
2010-07-29 21:43:47.802 AFD: Stream #1, has id 0x1100 codec id AAC, type Audio, bitrate 118500 at 0x7ff554313480
2010-07-29 21:43:47.802 AFD: codec AAC has 2 channels
2010-07-29 21:43:47.802 AFD: Looking for decoder for AAC
2010-07-29 21:43:47.805 AFD: Opened codec 0x7ff5543136a0, id(AAC) type(Audio)
2010-07-29 21:43:47.806 RingBuf(/living-video/4747_20100729210000.mpg): CalcReadAheadThresh(0 KB)
-> threshhold(64 KB) min read(0 KB) blk size(32 KB)
2010-07-29 21:43:47.888 AO: Opening audio device 'default' ch 2(2) sr 48000 sf signed 32 bit reenc 0
2010-07-29 21:43:48.049 Opening ALSA audio device 'default'.
2010-07-29 21:43:48.149 Dec: Selected track #1 in the Unknown language(0)
2010-07-29 21:43:48.149 Dec: Resyncing position map. posmapStarted = 0 livetv(0) watchingRec(1)
2010-07-29 21:43:48.206 Position map filled from DB to: 78205
2010-07-29 21:43:48.206 Dec: SyncPositionMap watchingrecording, from DB: 612 entries
2010-07-29 21:43:48.206 NVP(0): Filling position map from 78206 to end
2010-07-29 21:43:48.220 Dec: Position map filled from Encoder to: 78333
2010-07-29 21:43:48.220 Dec: SyncPositionMap watchingrecording total: 613 entries
2010-07-29 21:43:48.220 Dec: SyncPositionMap, new totframes: 78333, new length: 871, posMap size: 613
2010-07-29 21:43:48.220 AFD: Partial position map found
2010-07-29 21:43:48.220 AFD: Successfully opened decoder for file: "/living-video/4747_20100729210000.mpg". novideo(0)
2010-07-29 21:43:48.321 VideoOutput: Allowed renderers: directfb,xv-blit,xshm,xlib,opengl,vdpau
2010-07-29 21:43:48.322 VideoOutput: Allowed renderers (filt: ffmpeg): directfb,xlib,xshm,xv-blit,opengl,vdpau
2010-07-29 21:43:48.386 VDP: Accepting: cmp(>= 0 0) dec(vdpau) cpus(2) skiploop(disabled) rend(vdpau) osd(vdpau) osdfade(enabled) deint(vdpaubobdeint,vdpauonefield) filt()
2010-07-29 21:43:48.386 VDP: Accepting: cmp(>= 0 0) dec(ffmpeg) cpus(2) skiploop(disabled) rend(vdpau) osd(vdpau) osdfade(enabled) deint(vdpaubobdeint,vdpauonefield) filt()
2010-07-29 21:43:48.386 VDP: LoadBestPreferences(2048x2048, 0)
2010-07-29 21:43:48.386 VDP: LoadBestPreferences(2048x2048, 60)
2010-07-29 21:43:48.386 VDP: LoadBestPreferences(59651x768, 60)
2010-07-29 21:43:48.386 VideoOutput: Trying video renderer: 'vdpau'
2010-07-29 21:43:48.421 VDP: Accepting: cmp(>= 0 0) dec(vdpau) cpus(2) skiploop(disabled) rend(vdpau) osd(vdpau) osdfade(enabled) deint(vdpaubobdeint,vdpauonefield) filt()
2010-07-29 21:43:48.421 VDP: Accepting: cmp(>= 0 0) dec(ffmpeg) cpus(2) skiploop(disabled) rend(vdpau) osd(vdpau) osdfade(enabled) deint(vdpaubobdeint,vdpauonefield) filt()
2010-07-29 21:43:48.421 VDP: LoadBestPreferences(2048x2048, 0)
2010-07-29 21:43:48.422 VDP: LoadBestPreferences(2048x2048, 60)
2010-07-29 21:43:48.434 VideoOutWindow::SetPIPState. pip_state: 0]
2010-07-29 21:43:48.434 Display Rect left: 0, top: 224, width: 646, height: 8, aspect: 1.33333
2010-07-29 21:43:48.435 Video Rect left: 0, top: 0, width: 59651, height: 768, aspect: 77.6706
2010-07-29 21:43:48.435 VDP: LoadBestPreferences(59664x768, 60)
2010-07-29 21:43:48.435 Display Rect left: 0, top: 224, width: 646, height: 8, aspect: 1.33333
2010-07-29 21:43:48.435 Video Rect left: 0, top: 0, width: 59651, height: 768, aspect: 77.6706
2010-07-29 21:43:48.435 VDP: SetVideoRenderer(vdpau)
2010-07-29 21:43:48.435 VDP: SetVideoRender(vdpau) == GetVideoRenderer()
2010-07-29 21:43:48.436 VideoOutput: Pixel dimensions: Screen 720x480, window 646x457
2010-07-29 21:43:48.436 VideoOutput: Actual display dimensions: 244x163 mm Aspect: 1.49693
2010-07-29 21:43:48.436 VideoOutput: Estimated window dimensions: 218x155 mm Aspect: 1.40645
2010-07-29 21:43:48.539 VDPAU: Created 2 output surfaces.
2010-07-29 21:43:48.539 VDPAU: Set colorkey to 0x20202
2010-07-29 21:43:48.539 VDPAU: Version 1
2010-07-29 21:43:48.539 VDPAU: Information NVIDIA VDPAU Driver Shared Library 195.36.24 Thu Apr 22 19:52:55 PDT 2010
2010-07-29 21:43:48.539 VDPAU: HQ Scaling not supported.
2010-07-29 21:43:48.539 VDPAU: MPEG4 hardware acceleration not supported.
2010-07-29 21:43:48.539 VDPAU: Created VDPAU render device 646x457
2010-07-29 21:43:48.539 VidOutVDPAU: Created VDPAU osd (646x457)
2010-07-29 21:43:48.559 VDPAU Error: Error at mythrender_vdpau.cpp:636 (#20, The size of a supplied object does not match the object it is being used with.)
2010-07-29 21:43:48.559 VDPAU Error: Failed to create video surface.
2010-07-29 21:43:48.559 VidOutVDPAU Error: Unable to create VDPAU buffers
2010-07-29 21:43:48.559 VidOutVDPAU Error: Unable to create VDPAU mixer
2010-07-29 21:43:48.559 VidOutVDPAU: DiscardFrames(1)
2010-07-29 21:43:48.559 VideoBuffers::DiscardFrames(1): AAAAAAAAAAAAAAAAA
2010-07-29 21:43:48.560 VideoBuffers::DiscardFrames(): AAAAAAAAAAAAAAAAA -- done()
2010-07-29 21:43:48.560 VideoBuffers::DiscardFrames(1): AAAAAAAAAAAAAAAAA -- done
2010-07-29 21:43:48.560 VidOutVDPAU: DiscardFrames() 3: AAAAAAAAAAAAAAAAA -- done()
2010-07-29 21:43:48.560 VidOutVDPAU: DiscardFrames(1)
2010-07-29 21:43:48.560 VideoBuffers::DiscardFrames(1):
2010-07-29 21:43:48.560 VideoBuffers::DiscardFrames(): ERROR, A not in available, pause, or displayed
2010-07-29 21:43:48.560 VideoBuffers::DiscardFrames(): ERROR, B not in available, pause, or displayed A
2010-07-29 21:43:48.560 VideoBuffers::DiscardFrames(): ERROR, C not in available, pause, or displayed AA
2010-07-29 21:43:48.560 VideoBuffers::DiscardFrames(): ERROR, D not in available, pause, or displayed AAA
2010-07-29 21:43:48.560 VideoBuffers::DiscardFrames(): ERROR, E not in available, pause, or displayed AAAA
2010-07-29 21:43:48.560 VideoBuffers::DiscardFrames(): ERROR, F not in available, pause, or displayed AAAAA
2010-07-29 21:43:48.560 VideoBuffers::DiscardFrames(): ERROR, G not in available, pause, or displayed AAAAAA
2010-07-29 21:43:48.561 VideoBuffers::DiscardFrames(): ERROR, H not in available, pause, or displayed AAAAAAA
2010-07-29 21:43:48.561 VideoBuffers::DiscardFrames(): ERROR, a not in available, pause, or displayed AAAAAAAA
2010-07-29 21:43:48.561 VideoBuffers::DiscardFrames(): ERROR, b not in available, pause, or displayed AAAAAAAAA
2010-07-29 21:43:48.561 VideoBuffers::DiscardFrames(): ERROR, c not in available, pause, or displayed AAAAAAAAAA
2010-07-29 21:43:48.561 VideoBuffers::DiscardFrames(): ERROR, d not in available, pause, or displayed AAAAAAAAAAA
2010-07-29 21:43:48.561 VideoBuffers::DiscardFrames(): ERROR, e not in available, pause, or displayed AAAAAAAAAAAA
2010-07-29 21:43:48.561 VideoBuffers::DiscardFrames(): ERROR, f not in available, pause, or displayed AAAAAAAAAAAAA
2010-07-29 21:43:48.561 VideoBuffers::DiscardFrames(): ERROR, g not in available, pause, or displayed AAAAAAAAAAAAAA
2010-07-29 21:43:48.561 VideoBuffers::DiscardFrames(): ERROR, h not in available, pause, or displayed AAAAAAAAAAAAAAA
2010-07-29 21:43:48.561 VideoBuffers::DiscardFrames(): ERROR, 0 not in available, pause, or displayed AAAAAAAAAAAAAAAA
2010-07-29 21:43:48.561 VideoBuffers::DiscardFrames(): AAAAAAAAAAAAAAAAA -- done()
2010-07-29 21:43:48.561 VideoBuffers::DiscardFrames(1): AAAAAAAAAAAAAAAAA -- done
2010-07-29 21:43:48.561 VidOutVDPAU: DiscardFrames() 3: AAAAAAAAAAAAAAAAA -- done()
2010-07-29 21:43:48.562 VDPAU Painter: Clearing VDPAU painter cache.
2010-07-29 21:43:48.573 VidOutVDPAU: DiscardFrames(1)
2010-07-29 21:43:48.573 VideoBuffers::DiscardFrames(1):
2010-07-29 21:43:48.573 VideoBuffers::DiscardFrames(): ERROR, A not in available, pause, or displayed
2010-07-29 21:43:48.574 VideoBuffers::DiscardFrames(): ERROR, B not in available, pause, or displayed A
2010-07-29 21:43:48.574 VideoBuffers::DiscardFrames(): ERROR, C not in available, pause, or displayed AA
2010-07-29 21:43:48.574 VideoBuffers::DiscardFrames(): ERROR, D not in available, pause, or displayed AAA
2010-07-29 21:43:48.574 VideoBuffers::DiscardFrames(): ERROR, E not in available, pause, or displayed AAAA
2010-07-29 21:43:48.574 VideoBuffers::DiscardFrames(): ERROR, F not in available, pause, or displayed AAAAA
2010-07-29 21:43:48.574 VideoBuffers::DiscardFrames(): ERROR, G not in available, pause, or displayed AAAAAA
2010-07-29 21:43:48.574 VideoBuffers::DiscardFrames(): ERROR, H not in available, pause, or displayed AAAAAAA
2010-07-29 21:43:48.574 VideoBuffers::DiscardFrames(): ERROR, a not in available, pause, or displayed AAAAAAAA
2010-07-29 21:43:48.574 VideoBuffers::DiscardFrames(): ERROR, b not in available, pause, or displayed AAAAAAAAA
2010-07-29 21:43:48.574 VideoBuffers::DiscardFrames(): ERROR, c not in available, pause, or displayed AAAAAAAAAA
2010-07-29 21:43:48.574 VideoBuffers::DiscardFrames(): ERROR, d not in available, pause, or displayed AAAAAAAAAAA
2010-07-29 21:43:48.574 VideoBuffers::DiscardFrames(): ERROR, e not in available, pause, or displayed AAAAAAAAAAAA
2010-07-29 21:43:48.574 VideoBuffers::DiscardFrames(): ERROR, f not in available, pause, or displayed AAAAAAAAAAAAA
2010-07-29 21:43:48.574 VideoBuffers::DiscardFrames(): ERROR, g not in available, pause, or displayed AAAAAAAAAAAAAA
2010-07-29 21:43:48.575 VideoBuffers::DiscardFrames(): ERROR, h not in available, pause, or displayed AAAAAAAAAAAAAAA
2010-07-29 21:43:48.575 VideoBuffers::DiscardFrames(): ERROR, 0 not in available, pause, or displayed AAAAAAAAAAAAAAAA
2010-07-29 21:43:48.575 VideoBuffers::DiscardFrames(): AAAAAAAAAAAAAAAAA -- done()
2010-07-29 21:43:48.575 VideoBuffers::DiscardFrames(1): AAAAAAAAAAAAAAAAA -- done
2010-07-29 21:43:48.575 VidOutVDPAU: DiscardFrames() 3: AAAAAAAAAAAAAAAAA -- done()
2010-07-29 21:43:48.575 VideoOutput: Trying video renderer: 'xv-blit'
2010-07-29 21:43:48.581 VDP: Accepting: cmp(>= 0 0) dec(vdpau) cpus(2) skiploop(disabled) rend(vdpau) osd(vdpau) osdfade(enabled) deint(vdpaubobdeint,vdpauonefield) filt()
2010-07-29 21:43:48.581 VDP: Accepting: cmp(>= 0 0) dec(ffmpeg) cpus(2) skiploop(disabled) rend(vdpau) osd(vdpau) osdfade(enabled) deint(vdpaubobdeint,vdpauonefield) filt()
2010-07-29 21:43:48.581 VDP: LoadBestPreferences(2048x2048, 0)
2010-07-29 21:43:48.581 VDP: LoadBestPreferences(2048x2048, 60)
2010-07-29 21:43:48.583 VideoOutputXv: ctor
2010-07-29 21:43:48.583 VideoOutWindow::SetPIPState. pip_state: 0]
2010-07-29 21:43:48.584 VideoOutputXv: Creating gc
2010-07-29 21:43:48.584 VideoOutputXv: XJ_screen_num: '0'
2010-07-29 21:43:48.584 VideoOutputXv: XJ_curwin: '23068678'
2010-07-29 21:43:48.584 VideoOutputXv: XJ_win: '23068678'
2010-07-29 21:43:48.584 VideoOutputXv: XJ_root: '291'
2010-07-29 21:43:48.584 VideoOutputXv: XJ_gc: '0x7ff554438ad0'
2010-07-29 21:43:48.585 Display Rect left: 0, top: 224, width: 646, height: 8, aspect: 1.33333
2010-07-29 21:43:48.585 Video Rect left: 0, top: 0, width: 59651, height: 768, aspect: 77.6706
2010-07-29 21:43:48.585 VDP: LoadBestPreferences(59664x768, 60)
2010-07-29 21:43:48.585 Display Rect left: 0, top: 224, width: 646, height: 8, aspect: 1.33333
2010-07-29 21:43:48.585 Video Rect left: 0, top: 0, width: 59651, height: 768, aspect: 77.6706
2010-07-29 21:43:48.586 VideoOutput: Pixel dimensions: Screen 720x480, window 646x457
2010-07-29 21:43:48.586 VideoOutput: Actual display dimensions: 244x163 mm Aspect: 1.49693
2010-07-29 21:43:48.586 VideoOutput: Estimated window dimensions: 218x155 mm Aspect: 1.40645
2010-07-29 21:43:48.587 VideoOutputXv: InitSetupBuffers() render: vdpau, allowed: xv-blit,xshm,xlib
2010-07-29 21:43:48.587 VideoOutputXv: Desired video renderer 'vdpau' not available.
codec 'MPEG2' makes 'xv-blit,xshm,xlib,' available, using 'xv-blit' instead.
2010-07-29 21:43:48.587 VDP: SetVideoRenderer(xv-blit)
2010-07-29 21:43:48.588 VDP: Old preferences: rend(vdpau) osd(vdpau) deint(vdpaubobdeint,vdpauonefield) filt()
2010-07-29 21:43:48.588 VDP: New preferences: rend(xv-blit) osd(softblend) deint(onefield,onefield) filt()
2010-07-29 21:43:48.593 VDP: Accepting: cmp(>= 0 0) dec(vdpau) cpus(2) skiploop(disabled) rend(vdpau) osd(vdpau) osdfade(enabled) deint(vdpaubobdeint,vdpauonefield) filt()
2010-07-29 21:43:48.594 VDP: Accepting: cmp(>= 0 0) dec(ffmpeg) cpus(2) skiploop(disabled) rend(vdpau) osd(vdpau) osdfade(enabled) deint(vdpaubobdeint,vdpauonefield) filt()
2010-07-29 21:43:48.594 VDP: LoadBestPreferences(2048x2048, 0)
2010-07-29 21:43:48.594 VDP: LoadBestPreferences(2048x2048, 60)
2010-07-29 21:43:48.594 VDP: LoadBestPreferences(59664x768, 60)
2010-07-29 21:43:48.594 VideoOutputXv: @ j=0 Looking for flag[s]: XvInputMask XvImageMask 10
2010-07-29 21:43:48.594 VideoOutputXv: Adaptor#0: NV17 Video Texture has flag[s]: XvInputMask XvImageMask
2010-07-29 21:43:48.594 VideoOutputXv: Has XVideo flags...
2010-07-29 21:43:48.595 VideoOutputXv: Has XV_BRIGHTNESS...
2010-07-29 21:43:48.595 VideoOutputXv: Here...
2010-07-29 21:43:48.595 VideoOutputXv: Grabbed xv port 254
2010-07-29 21:43:48.595 VideoOutputXv: XVideo surface found on port 254
2010-07-29 21:43:48.595 VideoOutputXv: XV_SET_DEFAULTS is supported on this port
2010-07-29 21:43:48.595 VideoOutputXv: XVideo Adaptor Name: 'NV17 Video Texture'
2010-07-29 21:43:48.595 VideoOutputXv: XVideo Format #0 is 'YUY2'
2010-07-29 21:43:48.595 VideoOutputXv: XVideo Format #1 is 'YV12'
2010-07-29 21:43:48.595 VideoOutputXv: XVideo Format #2 is 'UYVY'
2010-07-29 21:43:48.595 VideoOutputXv: XVideo Format #3 is 'I420'
2010-07-29 21:43:48.596 VideoOutputXv: Using XVideo Format 'YV12'
2010-07-29 21:43:48.596 VideoOutputXv: CreateShmImages(32): video_dim: 59664x768
2010-07-29 21:43:48.596 VideoOutputXv Error: CreateXvShmImages(): XvShmCreateImage() failed to create image of the requested size.
2010-07-29 21:43:48.596 VideoOutputXv Error: CreateXvShmImages(): XvShmCreateImage() failed to create image.
2010-07-29 21:43:48.596 VideoOutputXv: Falling back to X11 video output over a network socket.
*** May be very slow ***
2010-07-29 21:43:48.596 VideoOutputXv Error: XCreateImage failed: XJ_disp(0x7ff554437880) visual(0x7ff554571010)
depth(24) WxH(646x457) bpl(1938)
2010-07-29 21:43:48.602 VDP: Accepting: cmp(>= 0 0) dec(vdpau) cpus(2) skiploop(disabled) rend(vdpau) osd(vdpau) osdfade(enabled) deint(vdpaubobdeint,vdpauonefield) filt()
2010-07-29 21:43:48.602 VDP: Accepting: cmp(>= 0 0) dec(ffmpeg) cpus(2) skiploop(disabled) rend(vdpau) osd(vdpau) osdfade(enabled) deint(vdpaubobdeint,vdpauonefield) filt()
2010-07-29 21:43:48.603 VDP: LoadBestPreferences(2048x2048, 0)
2010-07-29 21:43:48.603 VDP: LoadBestPreferences(2048x2048, 60)
2010-07-29 21:43:48.603 VDP: LoadBestPreferences(59664x768, 60)
2010-07-29 21:43:48.603 VideoOutputXv: @ j=0 Looking for flag[s]: XvInputMask XvImageMask 10
2010-07-29 21:43:48.603 VideoOutputXv: Adaptor#0: NV17 Video Texture has flag[s]: XvInputMask XvImageMask
2010-07-29 21:43:48.603 VideoOutputXv: Has XVideo flags...
2010-07-29 21:43:48.603 VideoOutputXv: Has XV_BRIGHTNESS...
2010-07-29 21:43:48.603 VideoOutputXv: Here...
2010-07-29 21:43:48.603 VideoOutputXv: Grabbed xv port 254
2010-07-29 21:43:48.604 VideoOutputXv: XVideo surface found on port 254
2010-07-29 21:43:48.604 VideoOutputXv: XV_SET_DEFAULTS is supported on this port
2010-07-29 21:43:48.604 VideoOutputXv: XVideo Adaptor Name: 'NV17 Video Texture'
2010-07-29 21:43:48.604 VideoOutputXv: XVideo Format #0 is 'YUY2'
2010-07-29 21:43:48.604 VideoOutputXv: XVideo Format #1 is 'YV12'
2010-07-29 21:43:48.604 VideoOutputXv: XVideo Format #2 is 'UYVY'
2010-07-29 21:43:48.604 VideoOutputXv: XVideo Format #3 is 'I420'
2010-07-29 21:43:48.604 VideoOutputXv: Using XVideo Format 'YV12'
2010-07-29 21:43:48.604 VideoOutputXv: CreateShmImages(32): video_dim: 59664x768
2010-07-29 21:43:48.604 VideoOutputXv Error: CreateXvShmImages(): XvShmCreateImage() failed to create image of the requested size.
2010-07-29 21:43:48.604 VideoOutputXv Error: CreateXvShmImages(): XvShmCreateImage() failed to create image.
2010-07-29 21:43:48.605 VideoOutputXv: Falling back to X shared memory video output.
*** May be slow ***
2010-07-29 21:43:48.605 VideoOutputXv: CreateShmImages(1): video_dim: 59664x768
2010-07-29 21:43:50.715 VDP: SetVideoRenderer(xshm)
2010-07-29 21:43:50.715 VDP: Old preferences: rend(xv-blit) osd(softblend) deint(onefield,onefield) filt()
2010-07-29 21:43:50.715 VDP: New preferences: rend(xshm) osd(softblend) deint(onefield,onefield) filt()
2010-07-29 21:43:50.715 Display Rect left: 0, top: 224, width: 646, height: 8, aspect: 1.40645
2010-07-29 21:43:50.715 Video Rect left: 0, top: 0, width: 59651, height: 768, aspect: 77.6706
2010-07-29 21:43:50.723 Over/underscan. V: 0, H: 0
2010-07-29 21:43:50.723 Display Rect left: 0, top: 224, width: 646, height: 8, aspect: 1.40645
2010-07-29 21:43:50.723 Video Rect left: 0, top: 0, width: 59651, height: 768, aspect: 77.6706
2010-07-29 21:43:50.723 VDP: LoadBestPreferences(59664x768, 89.9101)
2010-07-29 21:43:50.723 NVP(0): LoadFilters(''..) -> 0x0
2010-07-29 21:43:50.727 OSD: Base theme size: 800x600
2010-07-29 21:43:50.727 NVP(0): Decoder thread starting.
2010-07-29 21:43:50.727 OSD: Scaling factors: 74.5638x1.28
2010-07-29 21:43:50.733 OSD: Loaded window osd_message
2010-07-29 21:43:50.736 OSD: Loaded window osd_input
2010-07-29 21:43:50.745 OSD: Loaded window program_info
2010-07-29 21:43:50.748 OSD: Loaded window browse_info
2010-07-29 21:43:50.751 OSD: Loaded window osd_status
2010-07-29 21:43:50.755 OSD: Loaded window osd_program_editor
2010-07-29 21:43:50.755 OSD: Loaded OSD: size 59651x768 offset 0+0
2010-07-29 21:43:50.755 OSD: Base theme size: 800x600
2010-07-29 21:43:50.755 OSD: Scaling factors: 74.5638x1.28
2010-07-29 21:43:50.764 OSD: Base theme size: 800x600
2010-07-29 21:43:50.764 OSD: Scaling factors: 74.5638x1.28
2010-07-29 21:43:50.765 NVP(0): ClearAfterSeek(1)
2010-07-29 21:43:50.765 VideoOutputXv: ClearAfterSeek()
2010-07-29 21:43:50.765 VideoOutputXv: DiscardFrames(0)
2010-07-29 21:43:50.765 VideoBuffers::DiscardFrames(0): AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:50.765 VideoBuffers::DiscardFrames(0): AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA -- done
2010-07-29 21:43:50.765 VideoOutputXv: DiscardFrames() 3: AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA -- done()
2010-07-29 21:43:50.766 VDP: GetFilteredDeint() : xshm -> 'vdpaubobdeint'
2010-07-29 21:43:50.767 Failed to approve 'vdpaubobdeint' deinterlacer as a software deinterlacer
2010-07-29 21:43:50.767 VideoOutput, Error: Couldn't load deinterlace filter
2010-07-29 21:43:50.767 VideoOutput: Using deinterlace method
2010-07-29 21:43:50.767 VSYNC: DRMVideoSync: Could not open device /dev/dri/card0, No such file or directory
2010-07-29 21:43:50.770 VSYNC: OpenGLVideoSync()
2010-07-29 21:43:50.794 OpenGL: OpenGL vendor : NVIDIA Corporation
2010-07-29 21:43:50.794 OpenGL: OpenGL renderer: GeForce 8400 GS/PCI/SSE2
2010-07-29 21:43:50.794 OpenGL: OpenGL version : 3.2.0 NVIDIA 195.36.24
2010-07-29 21:43:50.794 OpenGL: Max texture size: 8192 x 8192
2010-07-29 21:43:50.794 OpenGL: Max texture units: 4
2010-07-29 21:43:50.794 OpenGL: Direct rendering: Yes
2010-07-29 21:43:50.794 OpenGL: Initialised MythRenderOpenGL
2010-07-29 21:43:50.804 NVP(0): Video timing method: SGI OpenGL
2010-07-29 21:43:50.804 NVP(0): Refresh rate: 16680, frame interval: 11122
2010-07-29 21:43:50.820 playCtx: StartPlaying(): took 0 ms to start player.
2010-07-29 21:43:50.820 TV: StartPlayer(0, WatchingRecording, main) -- end ok
2010-07-29 21:43:50.820 SendReceiveStringList(MESSAGE,COMMFLAG_REQUEST 4747_2010-07-29T21:00:00) called from UI thread
2010-07-29 21:43:50.836 TV: Changing from None to WatchingRecording
2010-07-29 21:43:50.890 TV: HandleStateChange(0) -- end
2010-07-29 21:43:50.911 ScreenSaverX11Private: ResetTimer -- begin
2010-07-29 21:43:50.912 ScreenSaverX11Private: StopTimer
2010-07-29 21:43:50.955 ScreenSaverX11Private: StartTimer
2010-07-29 21:43:50.955 ScreenSaverX11Private: ResetTimer -- end
2010-07-29 21:43:50.958 NVP(0): Waiting for video buffers...
2010-07-29 21:43:51.005 PlaybackBoxHelper: Not requesting preview as it is already being generated
2010-07-29 21:43:51.206 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:51.589 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:51.956 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:51.973 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:52.211 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:52.724 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:52.741 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:52.859 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:52.997 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:53.261 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:53.374 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:53.491 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:53.508 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:53.629 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:53.875 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:54.142 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:54.259 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:54.276 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:54.396 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:54.542 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:54.909 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:54.926 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:55.030 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:55.043 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:55.163 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:55.677 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:55.693 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:55.798 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:55.931 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:56.198 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:56.444 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:56.845 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:56.965 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:57.099 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:57.462 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:57.595 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:57.612 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:57.716 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:57.862 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:57.997 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:58.116 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:58.613 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:58.630 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:58.747 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:58.763 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:58.883 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:59.020 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:59.381 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:59.764 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:59.781 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:43:59.901 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:00.035 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:00.302 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:00.532 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:00.932 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:01.069 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:01.300 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:01.566 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:01.683 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:01.700 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:01.950 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:01.966 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:02.220 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:02.717 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:02.838 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:02.971 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:03.118 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:03.372 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:03.485 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:03.868 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:03.885 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:03.989 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:04.389 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:04.636 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:05.036 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:05.157 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:05.653 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:05.787 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:05.804 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:05.907 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:06.054 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:06.421 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:06.437 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:06.555 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:06.675 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:06.821 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:06.942 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:06.955 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:07.188 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:07.572 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:07.589 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:07.843 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:07.972 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:08.110 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:08.339 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:08.356 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:08.606 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:08.740 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:08.860 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:09.374 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:09.491 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:09.507 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:09.758 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:09.774 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:09.878 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:09.891 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:10.028 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:10.158 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:10.525 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:10.925 NVP(0): Waited 100ms for video buffers AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:10.962 NVP(0), Error: Waited too long for decoder to fill video buffers. Exiting..
2010-07-29 21:44:11.201 TV: HandleStateChange(0) -- begin
2010-07-29 21:44:11.201 TV: Attempting to change from WatchingRecording to None
2010-07-29 21:44:11.206 TV: StopStuff() for player ctx 0 -- begin
2010-07-29 21:44:11.206 TV: SetActive(0,w/o OSD) 0 -> 0 -- begin
2010-07-29 21:44:11.206 TV: SetActive(0,w/o OSD) 0 -> 0 -- end
2010-07-29 21:44:11.206 NVP(0): StopPlaying - begin
2010-07-29 21:44:11.307 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:11.407 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:11.508 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:11.608 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:11.709 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:11.809 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:11.910 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:12.010 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:12.110 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:12.211 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:12.311 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:12.412 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:12.512 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:12.613 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:12.714 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:12.814 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:12.915 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:13.015 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:13.116 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:13.216 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:13.316 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:13.417 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:13.517 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:13.618 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:13.719 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:13.819 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:13.919 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:14.020 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:14.120 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:14.221 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:14.322 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:14.422 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:14.522 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:14.623 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:14.723 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:14.824 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:14.924 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:15.025 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:15.125 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:15.226 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:15.327 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:15.427 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:15.528 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:15.628 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:15.729 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:15.829 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:15.930 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:16.031 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:16.131 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:16.232 NVP(0): Waited 100ms for decoder loop to stop
2010-07-29 21:44:16.333 NVP(0), Error: Failed to stop decoder loop.
2010-07-29 21:44:16.334 VSYNC: ~OpenGLVideoSync()
2010-07-29 21:44:16.334 OpenGL: Deleting OpenGL Resources
2010-07-29 21:44:16.336 VideoOutputXv: dtor
2010-07-29 21:44:16.336 VideoOutputXv: DiscardFrames(1)
2010-07-29 21:44:16.336 VideoBuffers::DiscardFrames(1): AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:16.336 VideoBuffers::DiscardFrames(): AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA -- done()
2010-07-29 21:44:16.336 VideoBuffers::DiscardFrames(1): AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA -- done
2010-07-29 21:44:16.336 VideoOutputXv: DiscardFrames() 3: AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA -- done()
2010-07-29 21:44:16.336 VideoOutputXv: DiscardFrames(1)
2010-07-29 21:44:16.337 VideoBuffers::DiscardFrames(1): AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA
2010-07-29 21:44:16.337 VideoBuffers::DiscardFrames(): AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA -- done()
2010-07-29 21:44:16.337 VideoBuffers::DiscardFrames(1): AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA -- done
2010-07-29 21:44:16.337 VideoOutputXv: DiscardFrames() 3: AAAAAAAAAAAAAAAAAAAAAAAAAAAAAAA -- done()
2010-07-29 21:44:16.582 VideoOutputXv: Closing XVideo port 254
2010-07-29 21:44:16.820 NVP(0): StopPlaying - end
2010-07-29 21:44:16.820 TV: StopStuff(): stopping ring buffer
2010-07-29 21:44:16.820 NVP(0): Decoder thread exiting.
2010-07-29 21:44:17.130 TV: StopStuff(): stopping player
2010-07-29 21:44:17.130 TV: StopStuff() -- end
2010-07-29 21:44:17.130 TV: Changing from WatchingRecording to None
2010-07-29 21:44:17.134 TV: HandleStateChange(0) -- end
2010-07-29 21:44:17.156 ScreenSaverX11Private: StopTimer
2010-07-29 21:44:17.156 TV: HandleStateChange(0) -- begin
2010-07-29 21:44:17.156 TV: Attempting to change from None to None
2010-07-29 21:44:17.159 TV: HandleStateChange(0) -- end
2010-07-29 21:44:17.159 TV: StartTV -- process events end
2010-07-29 21:44:17.159 TV: tv->Playback() -- begin
2010-07-29 21:44:17.173 TV: tv->Playback() -- end
2010-07-29 21:44:17.173 TV: StartTV -- process events begin
2010-07-29 21:44:17.194 TV: HandleStateChange(0) -- begin
2010-07-29 21:44:17.194 TV: Attempting to change from None to WatchingRecording
2010-07-29 21:44:17.198 RingBuf(/living-video/4747_20100729210000.mpg): OpenFile(/living-video/4747_20100729210000.mpg, 12)
2010-07-29 21:44:17.213 RingBuf(/living-video/4747_20100729210000.mpg): CalcReadAheadThresh(0 KB)
-> threshhold(64 KB) min read(0 KB) blk size(32 KB)
2010-07-29 21:44:17.215 SendReceiveStringList(GET_RECORDER_NUM,The Universe...) called from UI thread
2010-07-29 21:44:17.224 MythCoreContext: Connecting to backend server: 192.168.1.160:6543 (try 1 of 1)
2010-07-29 21:44:17.242 Using protocol version 58
2010-07-29 21:44:17.246 TV: StartPlayer(0, WatchingRecording, main) -- begin
2010-07-29 21:44:17.246 TV: Elapsed time since TV constructor was called: 32523 ms
2010-07-29 21:44:17.246 playCtx, Error: Attempting to setup a player, but it already exists.
2010-07-29 21:44:17.246 TV: StartPlayer(0, WatchingRecording, main) -- end error
2010-07-29 21:44:17.249 TV: HandleStateChange(0) -- end
2010-07-29 21:44:17.270 ScreenSaverX11Private: ResetTimer -- begin
2010-07-29 21:44:17.270 ScreenSaverX11Private: StopTimer
2010-07-29 21:44:17.270 ScreenSaverX11Private: StartTimer
2010-07-29 21:44:17.270 ScreenSaverX11Private: ResetTimer -- end
2010-07-29 21:44:17.277 PlaybackBoxHelper: Not requesting preview as it is already being generated
2010-07-29 21:44:22.182 TV: StartTV -- process events end
2010-07-29 21:44:22.182 TV: StartTV -- process events 2 begin
2010-07-29 21:44:22.182 TV: StartTV -- process events 2 end
2010-07-29 21:44:22.185 TV::~TV() -- begin
2010-07-29 21:44:22.196 TV::~TV() -- lock
2010-07-29 21:44:22.196 NVP(0): StopPlaying - begin
2010-07-29 21:44:22.196 NVP(0): Exited decoder loop.
2010-07-29 21:44:22.196 NVP(0): StopPlaying - end
2010-07-29 21:44:22.202 TV::~TV() -- end
2010-07-29 21:44:22.203 SendReceiveStringList(MESSAGE,SYSTEM_EVENT PLAY_STOPPED HOSTNAME bedroom2 CHANID 4747 STARTTIME 2010-07-29T21:00:00 SENDER bedroom2) called from UI thread
2010-07-29 21:44:22.210 TV: StartTV -- end
2010-07-29 21:44:22.267 PlaybackBoxHelper: Not requesting preview as it is already being generated
2010-07-29 21:44:24.647 ScreenSaverX11Private: Calling gnome-screensaver-command --poke
2010-07-29 21:44:24.660 ScreenSaverX11Private: Calling gnome-screensaver-command --poke
2010-07-29 21:44:29.850 Deleting UPnP client...