All pastes #489494 Raw Edit

Something

public text v1 · immutable
·published 2007-05-15 15:46 UTC
rendered paste body
17:02:12 M: 54452224  NOTICE: -----------------------------------------------------------------------
17:02:12 M: 54431744  NOTICE: Starting XBoxMediaCenter.  Built on May 14 2007
17:02:12 M: 54431744  NOTICE: Q is mapped to: E:\xbmc2
17:02:12 M: 54431744  NOTICE: The executeable running is: E:\xbmc2\default.xbe
17:02:12 M: 54431744  NOTICE: Log File is located: Q:\xbmc.log
17:02:12 M: 54431744  NOTICE: -----------------------------------------------------------------------
17:02:12 M: 54431744  NOTICE: Unmapped drive T
17:02:12 M: 54431744  NOTICE: Mapping drive T to Harddisk0\Partition1\xbmc2\userdata
17:02:12 M: 54431744  NOTICE: Setup DirectX
17:02:12 M: 54407168  NOTICE: Mapping drive C to Harddisk0\Partition2
17:02:12 M: 54407168  NOTICE: Mapping drive E to Harddisk0\Partition1
17:02:12 M: 54407168  NOTICE: Unmapped drive D
17:02:12 M: 54407168  NOTICE: Mapping drive D to Cdrom0
17:02:12 M: 54407168  NOTICE: Mapping drive F to Harddisk0\Partition6
17:02:12 M: 54407168  NOTICE: Mapping drive G to Harddisk0\Partition7
17:02:12 M: 54407168  NOTICE: Mapping drive X to Harddisk0\Partition3
17:02:12 M: 54407168  NOTICE: Mapping drive Y to Harddisk0\Partition4
17:02:12 M: 54407168  NOTICE: Unmapped drive Z
17:02:12 M: 54407168  NOTICE: Mapping drive Z to Harddisk0\Partition5
17:02:12 M: 54407168  NOTICE: load settings...
17:02:12 M: 54407168  NOTICE: Mapping drive P to Harddisk0\Partition1\xbmc2\userdata
17:02:12 M: 54407168  NOTICE: loading T:\guisettings.xml
17:02:12 M: 54259712  NOTICE: Getting hardware information now...
17:02:12 M: 54259712  NOTICE: Checking resolution 10
17:02:12 M: 54259712  NOTICE: Setting autoresolution mode 6
17:02:12 M: 54259712  NOTICE: Per AV pack settings are on
17:02:12 M: 54259712  NOTICE: Scart found : loading T:\avpacksettings.xml
17:02:12 M: 54235136  NOTICE: Getting hardware information now...
17:02:12 M: 54214656  NOTICE: Checking resolution 10
17:02:12 M: 54214656  NOTICE: Setting autoresolution mode 6
17:02:12 M: 54358016  NOTICE: q:\userdata\sources.xml
17:02:12 M: 54358016   ERROR:     Missing or invalid <name> and/or <path> in bookmark
17:02:12 M: 54358016   ERROR:     Missing or invalid <name> and/or <path> in bookmark
17:02:12 M: 54358016   ERROR:     Missing or invalid <name> and/or <path> in bookmark
17:02:12 M: 54358016   ERROR:     Missing or invalid <name> and/or <path> in bookmark
17:02:12 M: 54358016   ERROR:     Missing or invalid <name> and/or <path> in bookmark
17:02:12 M: 54358016   ERROR:     Missing or invalid <name> and/or <path> in bookmark
17:02:12 M: 54353920    INFO: Key combination detected for full debug logging (X+Y)
17:02:12 M: 54353920    INFO: Checking skinpath existance, and existence of keymap.xml:Q:\skin...
17:02:12 M: 47677440    INFO: load language info file:Q:\language\German\langinfo.xml
17:02:12 M: 47153152    INFO: load language file:Q:\language\German\strings.xml
17:02:12 M: 46989312    INFO: load keymapping
17:02:12 M: 47013888    INFO: Loading P:\keymap.xml
17:02:13 M: 46940160    INFO: Checking skin version of: Project Mayhem III
17:02:13 M: 46940160    INFO: Skin version is: 2.1
17:02:13 M: 46944256    INFO:  GUI format 720x576 PAL 4:3
17:02:13 M: 46944256    INFO: install unhandled exception filter
17:02:13 M: 46944256    INFO: creating subdirectories
17:02:13 M: 46944256    INFO: userdata folder: q:\userdata
17:02:13 M: 46944256    INFO:   recording folder:
17:02:13 M: 46944256    INFO:   screenshots folder:
17:02:13 M: 46944256    INFO:   thumbnails folder:q:\userdata\Thumbnails
17:02:13 M: 46931968  NOTICE: Checking the Date!
17:02:13 M: 46931968    INFO: - Current Date is: 15-5-2007
17:02:13 M: 46931968  NOTICE: start dvd mediatype detection
17:02:13 M: 46866432  NOTICE: initializing playlistplayer
17:02:13 M: 46866432  NOTICE: DONE initializing playlistplayer
17:02:13 M: 46866432    INFO: lcd not used
17:02:13 M: 46858240  NOTICE: load default skin:[Project Mayhem III]
17:02:13 M: 46858240    INFO:   load skin from:Q:\skin\Project Mayhem III
17:02:13 M: 46858240    INFO:   delete old skin...
17:02:13 M: 46858240    INFO: Default 4:3 resolution directory is Q:\skin\Project Mayhem III\pal
17:02:13 M: 46858240    INFO: Default 16:9 resolution directory is Q:\skin\Project Mayhem III\pal16x9
17:02:13 M: 46858240    INFO: Skin version is: 2.1
17:02:13 M: 46858240    INFO: Loading skin includes from Q:\skin\Project Mayhem III\pal\includes.xml
17:02:13 M: 46104576    INFO:   load fonts for skin...
17:02:13 M: 46104576    INFO: Loading fonts from Q:\skin\Project Mayhem III\pal\font.xml
17:02:13 M: 46104576    INFO: Load font:common-font10.xpr path:Q:\skin\Project Mayhem III\fonts\common-font10.xpr
17:02:13 M: 46039040    INFO: Load font:common-font12.xpr path:Q:\skin\Project Mayhem III\fonts\common-font12.xpr
17:02:13 M: 45928448    INFO: Load font:common-font13.xpr path:Q:\skin\Project Mayhem III\fonts\common-font13.xpr
17:02:13 M: 45797376    INFO: Load font:special-normal-pal.xpr path:Q:\skin\Project Mayhem III\fonts\special-normal-pal.xpr
17:02:13 M: 45654016    INFO: Load font:special-bold-pal.xpr path:Q:\skin\Project Mayhem III\fonts\special-bold-pal.xpr
17:02:13 M: 45498368    INFO:   load new skin...
17:02:13 M: 45502464    INFO: Skin version is: 2.1
17:02:13 M: 45502464    INFO: Loading skin file: home.xml
17:02:13 M: 44699648    INFO: Loading user windows, path Q:\skin\Project Mayhem III\pal
17:02:13 M: 44699648    INFO: Loading skin file: Q:\skin\Project Mayhem III\pal\custom2_SkinSettings.xml
17:02:13 M: 44699648    INFO:   initialize new skin...
17:02:13 M: 44699648    INFO: Loading skin file: Pointer.xml
17:02:13 M: 44691456  NOTICE: Unmapped drive D
17:02:13 M: 44666880  NOTICE: Mapping drive D to Cdrom0
17:02:13 M: 44666880    INFO: Loading skin file: DialogVolumeBar.xml
17:02:13 M: 44666880    INFO: Detecting DVD-ROM media filesystem...
17:02:13 M: 44658688    INFO: Loading skin file: DialogSeekbar.xml
17:02:13 M: 44601344    INFO: Loading skin file: DialogKaiToast.xml
17:02:13 M: 44593152    INFO: CD Analysis Report
17:02:13 M: 44589056    INFO: __________________________________
17:02:13 M: 44593152    INFO: Loading skin file: DialogMuteBug.xml
17:02:13 M: 44195840    INFO:   skin loaded...
17:02:14 M: 43659264    INFO: CD-ROM with CD-RTOS and ISO 9660 filesystem
17:02:14 M: 43638784    INFO: ISO 9660: 300 blocks, label `Swat2                           '
17:02:14 M: 43618304    INFO: XA sectors
17:02:14 M: 43618304    INFO: Session #2 starts at track  2, LSN:    450, ISO 9660 blocks:    300
17:02:14 M: 43589632    INFO: ISO 9660: 300 blocks, label ''
17:02:14 M: 43610112    INFO: Tracks overall:2; Audio tracks:0; Data tracks:2
17:02:14 M: 43692032    INFO: Using protocol iso9660://
17:02:14 M: 43692032    INFO: Disc label: Swat2
17:02:14 M: 43692032   DEBUG: MEDIA_DETECT::CDetectDVDMedia::SetNewDVDShareUrl: looking for disc thumb:[iso9660://folder.jpg]
17:02:14 M: 44216320   DEBUG: Activating window ID: 12999
17:02:14 M: 44216320   DEBUG: Checking if window ID 12999 is locked.
17:02:14 M: 44216320    INFO: Loading skin file: Startup.xml
17:02:14 M: 44216320 WARNING: use dashboard
17:02:14 M: 43376640    INFO: removing tempfiles
17:02:14 M: 43376640   DEBUG: - Detected TSOP/ModChip: Unknown/Onboard TSOP (protected)
17:02:14 M: 43376640  NOTICE: initialize done
17:02:14 M: 43376640   DEBUG: - Detected TSOP/ModChip: Unknown/Onboard TSOP (protected)
17:02:14 M: 43376640    INFO: Key combination detected for full debug logging (X+Y)
17:02:14 M: 43376640   DEBUG: - Detected ModChip: SmartXX V1/V2
17:02:14 M: 42323968  NOTICE: Running the application...
17:02:14 M: 42233856    INFO: CNetwork::LogState - Link: full duplex
17:02:14 M: 42233856    INFO: CNetwork::LogState - Link: 100 mbps
17:02:14 M: 41172992    INFO: CNetwork::LogState - ip:
17:02:14 M: 41172992    INFO: CNetwork::LogState - subnet:
17:02:14 M: 41172992    INFO: CNetwork::LogState - gateway:
17:02:14 M: 41484288    INFO: CNetwork::LogState - dns: ,
17:02:14 M: 39223296   DEBUG: CApplication::OnMessage : Translating ReplaceWindow(Home)
17:02:14 M: 39223296   DEBUG: CApplication::OnMessage : To ReplaceWindow(Home)
17:02:14 M: 39223296   DEBUG: Activating window ID: 10000
17:02:14 M: 39223296   DEBUG: Checking if window ID 10000 is locked.
17:02:14 M: 39223296    INFO: CNetwork::LogState - Link: full duplex
17:02:14 M: 39223296    INFO: CNetwork::LogState - Link: 100 mbps
17:02:14 M: 39223296    INFO: CNetwork::LogState - State: dns
17:02:14 M: 39223296    INFO: CNetwork::LogState - State: static
17:02:14 M: 39223296    INFO: CNetwork::LogState - ip: 192.168.2.222
17:02:14 M: 39223296    INFO: CNetwork::LogState - subnet: 255.255.255.0
17:02:14 M: 39223296    INFO: CNetwork::LogState - gateway: 192.168.2.1
17:02:14 M: 39223296    INFO: CNetwork::LogState - dns: 192.168.2.1, 0.0.0.0
17:02:14 M: 39223296    INFO: WEATHER: Downloading weather
17:02:14 M: 39223296    INFO: Get URL: http://xoap.weather.com/weather/local/GMXX0154?cc=*&unit=m&dayf=4&prod=xoap&par=1004124588&key=079f24145f208494
17:02:15 M: 39223296    INFO: WEATHER: Weather download successful
17:02:15 M: 37572608   DEBUG: CNetwork::NetworkMessage - Starting network services
17:02:15 M: 37306368  NOTICE: start timeserver client
17:02:15 M: 37240832  NOTICE: XBFileZilla: Starting...
17:02:15 M: 33521664    INFO: Get URL: http://feeds.feedburner.com/XboxScene
17:02:16 M: 33329152    INFO: ------------------- BIOS Detection Log ------------------
17:02:16 M: 33312768    INFO: 256k BIOSES: Checksums are (256)
17:02:16 M: 33312768    INFO:   1.Bios > Unknown
17:02:16 M: 33312768    INFO:   Add this to BiosIDs.ini: (256)BiosNameHere = C4396FF1A24E4700789AB6D3643620C4
17:02:16 M: 33579008    INFO: ---------------------------------------------------------
17:02:17 M: 34701312   DEBUG: - XBOX Kernel Qfe= 67
17:02:17 M: 34680832   DEBUG: - XBOX Kernel Drive FG result= 67
17:02:17 M: 34381824   DEBUG: - CPU Speed: 731.312377MHz
17:02:17 M: 34652160   DEBUG: Video Encoder: CONNEXANT
17:02:17 M: 34652160   DEBUG: - XBOX production info: Country: Hungary, LineNumber: 1, Week 16, Year 2002
17:02:17 M: 33763328  NOTICE: XBFileZilla: Started
17:02:18 M: 34029568    INFO: 302 Redirected: http://www.google.de/
17:02:18 M: 38854656  NOTICE: HDD: SMART is supported.
17:02:18 M: 38854656  NOTICE: HDD: SMART is enabled.
17:02:18 M: 39407616   DEBUG: Got rss feed: http://feeds.feedburner.com/XboxScene
17:02:18 M: 39407616   DEBUG: RSS feed encoding: UTF-8
17:02:18 M: 39387136   DEBUG: Parsed rss feed: http://feeds.feedburner.com/XboxScene
17:02:20 M: 39530496   ERROR: Unable to wait for NTP reply from the SNTP server, GetLastError returns 10060
17:02:22 M: 39596032   DEBUG: CApplication::OnKey: 271 pressed, action is 4
17:02:22 M: 39596032   DEBUG: CApplication::OnKey: 271 pressed, action is 4
17:02:24 M: 39596032   DEBUG: CApplication::OnKey: 256 pressed, action is 7
17:02:24 M: 39596032   DEBUG: CApplication::OnMessage : Translating ActivateWindow(MyVideos)
17:02:24 M: 39596032   DEBUG: CApplication::OnMessage : To ActivateWindow(MyVideos)
17:02:24 M: 39596032   DEBUG: Activating window ID: 10024
17:02:24 M: 39596032   DEBUG: Checking if window ID 10024 is locked.
17:02:25 M: 40341504   DEBUG: FreeVisualisation() started
17:02:25 M: 40341504   DEBUG: FreeVisualisation() done
17:02:25 M: 43110400    INFO: Attempting to default to:
17:02:25 M: 43098112    INFO: Loading skin file: MyVideo.xml
17:02:25 M: 42541056   DEBUG: CGUIMediaWindow::GetDirectory ()
17:02:25 M: 42565632   DEBUG:   ParentPath = []
17:02:25 M: 42602496   DEBUG: CURL::CURL - Url has no protocol .tbn, empty CURL created
17:02:25 M: 42602496   DEBUG: CURL::CURL - Url has no protocol \folder.jpg, empty CURL created
17:02:25 M: 42602496   DEBUG: CURL::CURL - Url has no protocol add, empty CURL created
17:02:27 M: 41238528   DEBUG: CApplication::OnKey: 256 pressed, action is 7
17:02:27 M: 41238528   DEBUG: Clearing cached fileitems [iso9660://]
17:02:27 M: 41238528   ERROR: XFILE::CFile::Delete - Error deleting file Z:\r-a399b4ee.fi
17:02:27 M: 41414656   DEBUG: CGUIMediaWindow::GetDirectory (iso9660://)
17:02:27 M: 41414656   DEBUG:   ParentPath = []
17:02:28 M: 41287680   DEBUG: CApplication::OnKey: 271 pressed, action is 4
17:02:29 M: 41287680   DEBUG: CApplication::OnKey: 271 pressed, action is 4
17:02:33 M: 41287680   DEBUG: CApplication::OnKey: 256 pressed, action is 7
17:02:33 M: 41287680   DEBUG: Clearing cached fileitems [iso9660://MPEG2/]
17:02:33 M: 41287680   ERROR: XFILE::CFile::Delete - Error deleting file Z:\r-c180ad26.fi
17:02:33 M: 41414656   DEBUG: CGUIMediaWindow::GetDirectory (iso9660://MPEG2/)
17:02:33 M: 41414656   DEBUG:   ParentPath = [iso9660://]
17:02:34 M: 41287680   DEBUG: CApplication::OnKey: 271 pressed, action is 4
17:02:35 M: 41287680   DEBUG: CApplication::OnKey: 256 pressed, action is 7
17:02:35 M: 41287680   DEBUG: CPlayerCoreFactor::GetPlayers(iso9660://MPEG2/AVSEQ01.MPG)
17:02:35 M: 40763392    INFO: mplayer play:iso9660://MPEG2/AVSEQ01.MPG cachesize:2048
17:02:35 M: 40763392   DEBUG: CUtil::CacheSubtitles: START
17:02:35 M: 40763392   DEBUG: CUtil::CacheSubtitles: Checking for common subirs...
17:02:35 M: 40763392   DEBUG: CUtil::CacheSubtitles: Done (time: 4 ms)
17:02:35 M: 40763392   DEBUG: CUtil::CacheSubtitles: Searching for subtitles...
17:02:35 M: 40763392   DEBUG: CUtil::CacheSubtitles: Done (time: 1 ms)
17:02:35 M: 40763392   DEBUG: CUtil::CacheSubtitles: END (total time: 7 ms)
17:02:35 M: 33693696   DEBUG:   msg:  set audio functions called
17:02:35 M: 33693696   DEBUG:   msg:  done
17:02:35 M: 33693696    INFO: Using -subcp enca:__:CP1252 to detect the subtitle charset
17:02:35 M: 33693696    INFO: Flipping bi-directional subtitles disabled
17:02:35 M: 33693696   DEBUG:   msg: mplayer_init()
17:02:35 M: 33693696   DEBUG:   msg: enable mplayer osd
17:02:35 M: 33693696   DEBUG:   msg: MPlayer XBMC-SVN-r8532 (C) 2000-2004 MPlayer Team
17:02:35 M: 33693696   DEBUG:   msg: CPU: Intel Celeron 2/Pentium III Coppermine,Geyserville
17:02:35 M: 33693696   DEBUG:   msg: (Family: 6, Stepping: 10)
17:02:35 M: 33693696   DEBUG:   msg: Detected cache-line size is 32 bytes
17:02:35 M: 33693696   DEBUG:   msg: CPUflags:  MMX: 1 MMX2: 1 3DNow: 0 3DNow2: 0 SSE: 0 SSE2: 0
17:02:35 M: 33693696   DEBUG:   msg: Compiled for x86 CPU with extensions:
17:02:35 M: 33693696   DEBUG:   msg:  MMX
17:02:35 M: 33693696   DEBUG:   msg:  MMX2
17:02:35 M: 33693696   DEBUG:   msg:  SSE
17:02:35 M: 33693696   DEBUG:   msg:
17:02:35 M: 33681408   DEBUG:   msg:
17:02:35 M: 33693696   DEBUG:   msg: Creating config file: Q:\system\players\mplayer\config
17:02:35 M: 33681408   DEBUG:   msg:
17:02:35 M: 33693696   DEBUG:   msg: get_path('codecs.conf') -> 'Q:\system\players\mplayer\codecs.conf'
17:02:35 M: 33693696   DEBUG:   msg: Reading Q:\system\players\mplayer\codecs.conf:
17:02:35 M: 33374208   DEBUG:   msg: 107 audio & 226 video codecs
17:02:35 M: 33374208   DEBUG:   msg: CommandLine:
17:02:35 M: 33374208   DEBUG:   msg:  '-dr'
17:02:35 M: 33374208   DEBUG:   msg:  '-v'
17:02:35 M: 33374208   DEBUG:   msg:  '-subcp'
17:02:35 M: 33374208   DEBUG:   msg:  'enca:__:CP1252'
17:02:35 M: 33374208   DEBUG:   msg:  '-channels'
17:02:35 M: 33374208   DEBUG:   msg:  '6'
17:02:35 M: 33374208   DEBUG:   msg:  '-a52drc'
17:02:35 M: 33374208   DEBUG:   msg:  '1'
17:02:35 M: 33374208   DEBUG:   msg:  '-noflip-hebrew'
17:02:35 M: 33374208   DEBUG:   msg:  '-noflip-hebrew-commas'
17:02:35 M: 33374208   DEBUG:   msg:  '-fs'
17:02:35 M: 33374208   DEBUG:   msg:  '1.avi'
17:02:35 M: 33374208   DEBUG:   msg:
17:02:35 M: 33374208   DEBUG:   msg: get_path('font/font.desc') -> 'Q:\system\players\mplayer\font/font.desc'
17:02:35 M: 32841728   DEBUG:   msg: font: can't open file: Q:\system\players\mplayer\font/font.desc
17:02:35 M: 32841728   DEBUG:   msg: font: can't open file: Q:\system\players\mplayer/font/font.desc
17:02:35 M: 33370112   DEBUG:   msg: Using MMX (with tiny bit MMX2) Optimized OnScreenDisplay
17:02:35 M: 33345536   DEBUG:   msg: Using XBOX High Resolution Timers for timing
17:02:35 M: 33345536   DEBUG:   msg: get_path('input.conf') -> 'Q:\system\players\mplayer\input.conf'
17:02:35 M: 33345536   DEBUG:   msg: Parsing input config file Q:\system\players\mplayer\input.conf
17:02:35 M: 33329152   DEBUG:   msg: Input config file Q:\system\players\mplayer\input.conf parsed: 51 binds
17:02:35 M: 33329152   DEBUG:   msg: mplayer_open_file(iso9660://MPEG2/AVSEQ01.MPG)
17:02:35 M: 33329152   DEBUG:   msg: get_path('AVSEQ01.MPG.conf') -> 'Q:\system\players\mplayer\AVSEQ01.MPG.conf'
17:02:35 M: 33329152   DEBUG:   msg: 
                             Playing iso9660://MPEG2/AVSEQ01.MPG.
17:02:35 M: 33329152   DEBUG:   msg: find subtitles
17:02:35 M: 33329152   DEBUG:   msg: auto open Z:\subtitle
17:02:35 M: 33329152   DEBUG:   msg: Filename for url is now iso9660://MPEG2/AVSEQ01.MPG
17:02:35 M: 33329152   DEBUG:   msg: protocol:iso9660
17:02:35 M: 33329152   DEBUG:   msg: use standard file for protocol:iso9660
17:02:35 M: 33329152   DEBUG:   msg: Option stream url: This URL doesn't have a hostname part.
17:02:35 M: 33308672   DEBUG:   msg: WINSOCK2 init: 0
17:02:35 M: 33284096   DEBUG:   msg: [file] File size is 806604624 bytes
17:02:35 M: 33284096   DEBUG:   msg: STREAM: [file] iso9660://MPEG2/AVSEQ01.MPG
17:02:35 M: 33284096   DEBUG:   msg: STREAM: Description: File
17:02:35 M: 33284096   DEBUG:   msg: STREAM: Author: Albeu
17:02:35 M: 33284096   DEBUG:   msg: STREAM: Comment: based on the code from ??? (probably Arpi)
17:02:35 M: 30629888   DEBUG:   msg: CACHE_PRE_INIT: 0 [0] 0  pre:0  eof:0
17:02:35 M: 30629888   DEBUG:   msg: 
Cache fill:  0.00% (0 bytes)
17:02:35 M: 30629888   DEBUG:   msg: 
Cache fill:  0.00% (0 bytes)
17:02:36 M: 30629888   DEBUG:   msg: 
Cache fill:  0.00% (0 bytes)
17:02:36 M: 30629888   DEBUG:   msg: 
Cache fill:  3.13% (65536 bytes)
17:02:36 M: 30629888   DEBUG:   msg: 
Cache fill:  3.13% (65536 bytes)
17:02:36 M: 30629888    INFO: Loading skin file: DialogBusy.xml
17:02:36 M: 30433280   DEBUG:   msg: 
Cache fill:  6.25% (131072 bytes)
17:02:36 M: 30433280   DEBUG:   msg: 
Cache fill:  9.38% (196608 bytes)
17:02:36 M: 30433280   DEBUG:   msg: 
Cache fill:  9.38% (196608 bytes)
17:02:36 M: 30433280   DEBUG:   msg: 
Cache fill: 12.50% (262144 bytes)
17:02:36 M: 30433280   DEBUG:   msg: 
Cache fill: 12.50% (262144 bytes)
17:02:36 M: 30433280   DEBUG:   msg: 
Cache fill: 15.63% (327680 bytes)
17:02:36 M: 30433280   DEBUG:   msg: 
Cache fill: 15.63% (327680 bytes)
17:02:36 M: 30433280   DEBUG:   msg: 
Cache fill: 18.75% (393216 bytes)
17:02:36 M: 30433280   DEBUG:   msg: 
Cache fill: 18.75% (393216 bytes)
17:02:36 M: 30433280   DEBUG:   msg: demux_open(00C90010,0,-1,-1,-1)
17:02:36 M: 30433280   DEBUG:   msg: Checking for YUV4MPEG2
17:02:36 M: 30433280   DEBUG:   msg: ASF_check: not ASF guid!
17:02:36 M: 30433280   DEBUG:   msg: Checking for Nullsoft Streaming Video
17:02:36 M: 30433280   DEBUG:   msg: Checking for NuppelVideo
17:02:36 M: 30433280   DEBUG:   msg: Checking for REAL
17:02:36 M: 30433280   DEBUG:   msg: Checking for SMJPEG
17:02:36 M: 30433280   DEBUG:   msg: SUB: opened iconv descriptor.
17:02:36 M: 30433280   DEBUG:   msg: Searching demuxer type for filename iso9660://MPEG2/AVSEQ01.MPG ext: .MPG
17:02:36 M: 30433280   DEBUG:   msg: Checking for MOV
17:02:36 M: 30433280   DEBUG:   msg: Checking for VIVO
17:02:36 M: 30433280   DEBUG:   msg: SUB: opened iconv descriptor.
17:02:36 M: 30420992   DEBUG:   msg: SUB: closed iconv descriptor.
17:02:36 M: 30433280   DEBUG:   msg: Checking for PVA
17:02:36 M: 30433280   DEBUG:   msg: Checking for MPEG-TS...
17:02:36 M: 30433280   DEBUG:   msg: TRIED UP TO POSITION 72257, FOUND 47, packet_size= 0, SEEMS A TS? 0
17:02:36 M: 30433280   DEBUG:   msg: Checking for LMLM4 Stream Format
17:02:36 M: 30433280   DEBUG:   msg: Invalid packet in LMLM4 stream: ch=255 size=-9
17:02:36 M: 30433280   DEBUG:   msg: LMLM4 Stream Format not found
17:02:36 M: 30433280   DEBUG:   msg: system stream synced at 0x25 (37)!
17:02:36 M: 30433280   DEBUG:   msg: ==> Found video stream: 0
17:02:36 M: 30433280   DEBUG:   msg: ==> Found audio stream: 0
17:02:37 M: 30433280   DEBUG:   msg: MPEG-PS file format detected.
17:02:37 M: 30433280   DEBUG:   msg: Searching for sequence header...
17:02:37 M: 30433280   DEBUG:   msg: OK!
17:02:37 M: 29380608   DEBUG:   msg: VIDEO:  MPEG2  480x480  (aspect 2)  29.970 fps  2520.0 kbps (315.0 kbyte/s)
17:02:37 M: 29380608   DEBUG:   msg: [V] filefmt:2  fourcc:0x10000002  size:480x480  fps:29.97  ftime:=0.0334
17:02:37 M: 29380608   DEBUG:   msg: get_path('sub/') -> 'Q:\system\players\mplayer\sub/'
17:02:37 M: 29380608   DEBUG:   msg: Starting lookup for subs
17:02:37 M: 29380608   DEBUG:   msg: Global Subsize: 0 - VOBSUB: -1, DEMUX: -1, SUBS: -1
17:02:37 M: 29380608   DEBUG:   msg: Global Subpos : -1
17:02:37 M: 29380608   DEBUG:   msg: ==========================================================================
17:02:37 M: 29380608   DEBUG:   msg: Opening audio decoder: [mp3lib] MPEG layer-2, layer-3
17:02:37 M: 29380608   DEBUG:   msg: dec_audio: Allocating 4608 + 65536 = 70144 bytes for output buffer.
17:02:37 M: 29306880   DEBUG:   msg: mp3lib: made decode tables with MMX optimization
17:02:37 M: 29306880   DEBUG:   msg: mp3lib: using MMX optimized decore!
17:02:37 M: 29306880   DEBUG:   msg: MP3lib: init layer2&3 finished, tables done
17:02:37 M: 29306880   DEBUG:   msg: 
MPEG 1.0, Layer II, 44100 Hz 192 kbit Stereo, BPF: 627
17:02:37 M: 29306880   DEBUG:   msg: Channels: 2, copyright: No, original: No, CRC: Yes, emphasis: 0
17:02:37 M: 29306880   DEBUG:   msg: AUDIO: 44100 Hz, 2 ch, 16 bit (0x10), ratio: 24000->176400 (192.0 kbit)
17:02:37 M: 29306880   DEBUG:   msg: Selected audio codec: [mp3] afm:mp3lib (mp3lib MPEG layer-2, layer-3)
17:02:37 M: 29306880   DEBUG:   msg: ==========================================================================
17:02:37 M: 29306880   DEBUG: CXBoxRenderManager::PreInit - Selected RGB-Renderer
17:02:37 M: 29306880   DEBUG:   msg: ==========================================================================
17:02:37 M: 29306880   DEBUG:   msg: Opening video decoder: [mpegpes] MPEG 1/2 Video passthrough
17:02:37 M: 29306880   DEBUG:   msg: VDec: vo config request - 480 x 480 (preferred colorspace: Mpeg PES)
17:02:37 M: 29306880   DEBUG:   msg: Trying filter chain:
17:02:37 M: 29306880   DEBUG:   msg:  vo
17:02:37 M: 29306880   DEBUG:   msg:
17:02:37 M: 29306880   DEBUG:   msg: Could not find matching colorspace - retrying with -vf scale...
17:02:37 M: 29306880   DEBUG:   msg: Opening video filter: [scale]
17:02:37 M: 29306880   DEBUG:   msg: SwScale params: -1 x -1 (-1=no scaling)
17:02:37 M: 29306880   DEBUG:   msg: Trying filter chain:
17:02:37 M: 29306880   DEBUG:   msg:  scale
17:02:37 M: 29306880   DEBUG:   msg:  vo
17:02:37 M: 29306880   DEBUG:   msg:
17:02:37 M: 29306880   DEBUG:   msg: The selected video_out device is incompatible with this codec.
                             Try adding the scale filter, e.g. -vf spp,scale instead of -vf spp.
17:02:37 M: 29306880   DEBUG:   msg: VDecoder init failed :(
17:02:37 M: 29306880   DEBUG:   msg: Opening video decoder: [libmpeg2] MPEG 1/2 Video decoder libmpeg2-v0.4.0b
17:02:37 M: 28061696   DEBUG:   msg: Selected video codec: [mpeg12] vfm:libmpeg2 (MPEG-1 or 2 (libmpeg2))
17:02:37 M: 28061696   DEBUG:   msg: ==========================================================================
17:02:37 M: 28061696   DEBUG:   msg: Checking audio filter chain for 44100Hz/2ch/16bit -> 44100Hz/6ch/16bit...
17:02:37 M: 28061696   DEBUG:   msg: [libaf] Adding filter dummy
17:02:37 M: 28061696   DEBUG:   msg: [dummy] Was reinitialized, rate=44100Hz, nch = 2, format = 0x00000001 and bps = 2
17:02:37 M: 28061696   DEBUG:   msg: AF_pre: af format: 2 bps, 2 ch, 44100 hz, little endian signed int
17:02:37 M: 28061696   DEBUG:   msg: AF_pre: 44100Hz 2ch Signed 16-bit (Little-Endian)
17:02:37 M: 28016640   DEBUG:   msg: AO: [win32] 44100Hz 2ch Signed 16-bit (Little-Endian) (2 bps)
17:02:37 M: 28016640   DEBUG:   msg: AO: Description: Windows waveOut audio output
                             AO: Author: SaschaSommer <saschasommer@freenet.de>
17:02:37 M: 28016640   DEBUG:   msg: Building audio filter chain for 44100Hz/2ch/16bit -> 44100Hz/2ch/16bit...
17:02:37 M: 28016640   DEBUG:   msg: [dummy] Was reinitialized, rate=44100Hz, nch = 2, format = 0x00000001 and bps = 2
17:02:37 M: 28016640   DEBUG:   msg: [dummy] Was reinitialized, rate=44100Hz, nch = 2, format = 0x00000001 and bps = 2
17:02:37 M: 27947008   DEBUG:   msg: Starting playback...
17:02:37 M: 27947008   DEBUG:   msg: mplayer_open_file(iso9660://MPEG2/AVSEQ01.MPG) done 1.0000
17:02:37 M: 27480064    INFO: Loading skin file: VideoOverlay.xml
17:02:37 M: 27480064   DEBUG: Playback has started
17:02:37 M: 27951104   DEBUG: CGUIInfoManager::SetCurrentMovie(iso9660://MPEG2/AVSEQ01.MPG)
17:02:37 M: 27779072   DEBUG:   msg: VDec: vo config request - 480 x 480 (preferred colorspace: Planar YV12)
17:02:37 M: 27779072   DEBUG:   msg: Trying filter chain:
17:02:37 M: 27820032   DEBUG:   msg:  vo
17:02:37 M: 27721728   DEBUG:   msg:
17:02:37 M: 27721728   DEBUG:   msg: VDec: using Planar YV12 as output csp (no 0)
17:02:37 M: 27762688   DEBUG: CVideoDatabase::GetMovieInfo(iso9660://MPEG2/AVSEQ01.MPG), query = select idMovie from movie where idFile=1
17:02:37 M: 27721728   DEBUG:   msg: Movie-Aspect is 1.33:1 - prescaling to correct movie aspect.
17:02:37 M: 27721728   DEBUG:   msg: VO Config (480x480->640x480,flags=1,'MPlayer',0x32315659)
17:02:37 M: 27762688   DEBUG:   msg: VO: [directx] 480x480 => 640x480 Planar YV12  [fs]
17:02:37 M: 27762688   DEBUG: CVideoDatabase::GetEpisodeInfo(iso9660://MPEG2/AVSEQ01.MPG), query = select idEpisode from episode where idFile=1
17:02:37 M: 27721728   DEBUG:   msg: VO: Description: XBOX Direct3D8 YUY2 renderer
17:02:37 M: 27721728   DEBUG:   msg: VO: Author: Frodo/JCMarshall
17:02:37 M: 27762688   DEBUG: mplayer::video_config(480, 480, 640, 480, 1, 842094169)
17:02:37 M: 27828224  NOTICE: Display resolution AUTO : PAL 4:3 (6)
17:02:37 M: 27303936   DEBUG: Activating window ID: 12005
17:02:37 M: 27303936   DEBUG: Checking if window ID 12005 is locked.
17:02:37 M: 28753920   DEBUG: Setting resolution 6
17:02:37 M: 29638656   DEBUG: We set resolution 6
17:02:37 M: 29270016   DEBUG: Created YV12 texture 0
17:02:37 M: 29270016    INFO: Loading skin file: VideoFullscreen.xml
17:02:37 M: 29270016    INFO: Loading skin file: VideoOSD.xml
17:02:37 M: 28676096    INFO: Loading skin file: VideoOSDSettings.xml
17:02:37 M: 27967488    INFO: Loading skin file: VideoOSDSettings.xml
17:02:37 M: 27881472   DEBUG: CGUIFontTTF::Load Scaled size of font Q:\Media\Fonts\Arial.ttf (28): width = 76, height = 39
17:02:37 M: 27500544   DEBUG:   msg: *** [vo] Allocating mp_image_t, 480x480x12bpp YUV planar, 345600 bytes
17:02:37 M: 27152384   DEBUG:   msg: *** [vo] Allocating mp_image_t, 480x480x12bpp YUV planar, 345600 bytes
17:02:38 M: 26267648   DEBUG:   msg: *** [vo] Allocating (slices) mp_image_t, 480x480x12bpp YUV planar, 345600 bytes
17:02:38 M: 26406912   DEBUG:   msg: 
                             demux_mpg: 24000/1001fps progressive NTSC content detected, switching framerate.
17:02:44 M: 26439680   DEBUG: CApplication::OnKey: 260 pressed, action is 27
17:02:58 M: 26370048   DEBUG: CApplication::OnKey: 260 pressed, action is 27
17:03:06 M: 26357760   DEBUG:   msg: VDec: vo config request - 480 x 480 (preferred colorspace: Planar YV12)
17:03:06 M: 26374144   DEBUG:   msg: Trying filter chain:
17:03:06 M: 26374144   DEBUG:   msg:  vo
17:03:06 M: 26374144   DEBUG:   msg:
17:03:06 M: 26374144   DEBUG:   msg: VDec: using Planar YV12 as output csp (no 0)
17:03:06 M: 26374144   DEBUG:   msg: Movie-Aspect is 1.48:1 - prescaling to correct movie aspect.
17:03:06 M: 26374144   DEBUG:   msg: VO Config (480x480->712x480,flags=1,'MPlayer',0x32315659)
17:03:06 M: 26374144   DEBUG:   msg: VO: [directx] 480x480 => 712x480 Planar YV12  [fs]
17:03:06 M: 26374144   DEBUG:   msg: VO: Description: XBOX Direct3D8 YUY2 renderer
17:03:06 M: 26374144   DEBUG:   msg: VO: Author: Frodo/JCMarshall
17:03:06 M: 26374144   DEBUG: mplayer::video_config(480, 480, 712, 480, 1, 842094169)
17:03:06 M: 26374144  NOTICE: Display resolution AUTO : PAL 4:3 (6)
17:03:07 M: 25333760   DEBUG:   msg: VDec: vo config request - 480 x 480 (preferred colorspace: Planar YV12)
17:03:07 M: 25333760   DEBUG:   msg: Trying filter chain:
17:03:07 M: 25333760   DEBUG:   msg:  vo
17:03:07 M: 25333760   DEBUG:   msg:
17:03:07 M: 25333760   DEBUG:   msg: VDec: using Planar YV12 as output csp (no 0)
17:03:07 M: 25333760   DEBUG:   msg: Movie-Aspect is 1.33:1 - prescaling to correct movie aspect.
17:03:07 M: 25333760   DEBUG:   msg: VO Config (480x480->640x480,flags=1,'MPlayer',0x32315659)
17:03:07 M: 25333760   DEBUG:   msg: VO: [directx] 480x480 => 640x480 Planar YV12  [fs]
17:03:07 M: 25333760   DEBUG:   msg: VO: Description: XBOX Direct3D8 YUY2 renderer
17:03:07 M: 25333760   DEBUG:   msg: VO: Author: Frodo/JCMarshall
17:03:07 M: 25333760   DEBUG: mplayer::video_config(480, 480, 640, 480, 1, 842094169)
17:03:07 M: 25333760  NOTICE: Display resolution AUTO : PAL 4:3 (6)
17:03:11 M: 24289280   DEBUG: CApplication::OnKey: 257 pressed, action is 13
17:03:11 M: 24301568   DEBUG:   msg:  mplayer_close_file()
17:03:11 M: 24301568   DEBUG:   msg:
17:03:11 M: 24301568   DEBUG:   msg:  uninit_player
17:03:11 M: 26963968   DEBUG:   msg: WINSOCK2 uninit
17:03:11 M: 26980352   DEBUG:   msg: Uninit audio filters...
17:03:11 M: 26980352   DEBUG:   msg: [libaf] Removing filter dummy
17:03:11 M: 26980352   DEBUG:   msg: Uninit audio: mp3lib
17:03:11 M: 27111424   DEBUG:   msg: Uninit video: libmpeg2
17:03:11 M: 30912512   DEBUG: Deleted YV12 texture 0
17:03:11 M: 31289344   DEBUG:   msg:  uninit_player - done
17:03:11 M: 31289344   DEBUG: Freeing FS segment @ 0xb04650
17:03:11 M: 42074112  NOTICE: Saving Scart settings in T:\avpacksettings.xml
17:03:11 M: 43593728   DEBUG: Setting resolution 6
17:03:11 M: 42708992   DEBUG: We set resolution 6
17:03:11 M: 42934272    INFO: Loading skin file: MyVideo.xml
17:03:11 M: 42463232   DEBUG: CGUIMediaWindow::GetDirectory (iso9660://MPEG2/)
17:03:11 M: 42504192   DEBUG:   ParentPath = [iso9660://MPEG2/]
17:03:13 M: 41209856   DEBUG: CApplication::OnKey: 257 pressed, action is 9
17:03:13 M: 41336832   DEBUG: CGUIMediaWindow::GetDirectory (iso9660://)
17:03:13 M: 41336832   DEBUG:   ParentPath = []
17:03:13 M: 41209856   DEBUG: CApplication::OnKey: 257 pressed, action is 9
17:03:13 M: 41336832   DEBUG: CGUIMediaWindow::GetDirectory ()
17:03:14 M: 41336832   DEBUG:   ParentPath = []
17:03:14 M: 41336832   DEBUG: CURL::CURL - Url has no protocol .tbn, empty CURL created
17:03:14 M: 41336832   DEBUG: CURL::CURL - Url has no protocol \folder.jpg, empty CURL created
17:03:14 M: 41336832   DEBUG: CURL::CURL - Url has no protocol add, empty CURL created
17:03:14 M: 41160704   DEBUG: CApplication::OnKey: 257 pressed, action is 9
17:03:14 M: 42967040    INFO: Loading skin file: Home.xml
17:03:16 M: 38440960   DEBUG: CApplication::OnKey: 273 pressed, action is 2
17:03:19 M: 38449152   DEBUG: CApplication::OnKey: 256 pressed, action is 7
17:03:19 M: 38449152   DEBUG: CApplication::OnMessage : Translating XBMC.PlayDVD()
17:03:19 M: 38449152   DEBUG: CApplication::OnMessage : To XBMC.PlayDVD()
17:03:19 M: 38449152   DEBUG: CPlayerCoreFactor::GetPlayers(iso9660://MPEG2/AVSEQ01.MPG)
17:03:19 M: 37924864    INFO: mplayer play:iso9660://MPEG2/AVSEQ01.MPG cachesize:2048
17:03:19 M: 37924864   DEBUG: CUtil::CacheSubtitles: START
17:03:19 M: 37924864   DEBUG: CUtil::CacheSubtitles: Checking for common subirs...
17:03:19 M: 37924864   DEBUG: CUtil::CacheSubtitles: Done (time: 4 ms)
17:03:19 M: 37924864   DEBUG: CUtil::CacheSubtitles: Searching for subtitles...
17:03:19 M: 37924864   DEBUG: CUtil::CacheSubtitles: Done (time: 1 ms)
17:03:19 M: 37924864   DEBUG: CUtil::CacheSubtitles: END (total time: 6 ms)
17:03:19 M: 37924864   DEBUG: Initializing FS_SEG..
17:03:19 M: 37924864   DEBUG: FS segment @ 0xb04650
17:03:20 M: 30846976   DEBUG:   msg:  set audio functions called
17:03:20 M: 30846976   DEBUG:   msg:  done
17:03:20 M: 30846976    INFO: Using -subcp enca:__:CP1252 to detect the subtitle charset
17:03:20 M: 30846976    INFO: Flipping bi-directional subtitles disabled
17:03:20 M: 30846976   DEBUG:   msg: mplayer_init()
17:03:20 M: 30846976   DEBUG:   msg: enable mplayer osd
17:03:20 M: 30846976   DEBUG:   msg: MPlayer XBMC-SVN-r8532 (C) 2000-2004 MPlayer Team
17:03:20 M: 30846976   DEBUG:   msg: CPU: Intel Celeron 2/Pentium III Coppermine,Geyserville
17:03:20 M: 30846976   DEBUG:   msg: (Family: 6, Stepping: 10)
17:03:20 M: 30846976   DEBUG:   msg: Detected cache-line size is 32 bytes
17:03:20 M: 30846976   DEBUG:   msg: CPUflags:  MMX: 1 MMX2: 1 3DNow: 0 3DNow2: 0 SSE: 0 SSE2: 0
17:03:20 M: 30846976   DEBUG:   msg: Compiled for x86 CPU with extensions:
17:03:20 M: 30846976   DEBUG:   msg:  MMX
17:03:20 M: 30846976   DEBUG:   msg:  MMX2
17:03:20 M: 30846976   DEBUG:   msg:  SSE
17:03:20 M: 30846976   DEBUG:   msg:
17:03:20 M: 30834688   DEBUG:   msg:
17:03:20 M: 30846976   DEBUG:   msg: Creating config file: Q:\system\players\mplayer\config
17:03:20 M: 30834688   DEBUG:   msg:
17:03:20 M: 30846976   DEBUG:   msg: get_path('codecs.conf') -> 'Q:\system\players\mplayer\codecs.conf'
17:03:20 M: 30846976   DEBUG:   msg: Reading Q:\system\players\mplayer\codecs.conf:
17:03:20 M: 30515200   DEBUG:   msg: 107 audio & 226 video codecs
17:03:20 M: 30515200   DEBUG:   msg: CommandLine:
17:03:20 M: 30515200   DEBUG:   msg:  '-dr'
17:03:20 M: 30515200   DEBUG:   msg:  '-v'
17:03:20 M: 30515200   DEBUG:   msg:  '-subcp'
17:03:20 M: 30515200   DEBUG:   msg:  'enca:__:CP1252'
17:03:20 M: 30515200   DEBUG:   msg:  '-channels'
17:03:20 M: 30515200   DEBUG:   msg:  '6'
17:03:20 M: 30515200   DEBUG:   msg:  '-a52drc'
17:03:20 M: 30515200   DEBUG:   msg:  '1'
17:03:20 M: 30515200   DEBUG:   msg:  '-noflip-hebrew'
17:03:20 M: 30515200   DEBUG:   msg:  '-noflip-hebrew-commas'
17:03:20 M: 30515200   DEBUG:   msg:  '-fs'
17:03:20 M: 30515200   DEBUG:   msg:  '1.avi'
17:03:20 M: 30515200   DEBUG:   msg:
17:03:20 M: 30515200   DEBUG:   msg: get_path('font/font.desc') -> 'Q:\system\players\mplayer\font/font.desc'
17:03:20 M: 29986816   DEBUG:   msg: font: can't open file: Q:\system\players\mplayer\font/font.desc
17:03:20 M: 29986816   DEBUG:   msg: font: can't open file: Q:\system\players\mplayer/font/font.desc
17:03:20 M: 30515200   DEBUG:   msg: Using MMX (with tiny bit MMX2) Optimized OnScreenDisplay
17:03:20 M: 30482432   DEBUG:   msg: Using XBOX High Resolution Timers for timing
17:03:20 M: 30482432   DEBUG:   msg: get_path('input.conf') -> 'Q:\system\players\mplayer\input.conf'
17:03:20 M: 30482432   DEBUG:   msg: Parsing input config file Q:\system\players\mplayer\input.conf
17:03:20 M: 30478336   DEBUG:   msg: Input config file Q:\system\players\mplayer\input.conf parsed: 51 binds
17:03:20 M: 30478336   DEBUG:   msg: mplayer_open_file(iso9660://MPEG2/AVSEQ01.MPG)
17:03:20 M: 30478336   DEBUG:   msg: get_path('AVSEQ01.MPG.conf') -> 'Q:\system\players\mplayer\AVSEQ01.MPG.conf'
17:03:20 M: 30478336   DEBUG:   msg: 
                             Playing iso9660://MPEG2/AVSEQ01.MPG.
17:03:20 M: 30478336   DEBUG:   msg: find subtitles
17:03:20 M: 30478336   DEBUG:   msg: auto open Z:\subtitle
17:03:20 M: 30478336   DEBUG:   msg: Filename for url is now iso9660://MPEG2/AVSEQ01.MPG
17:03:20 M: 30478336   DEBUG:   msg: protocol:iso9660
17:03:20 M: 30478336   DEBUG:   msg: use standard file for protocol:iso9660
17:03:20 M: 30478336   DEBUG:   msg: Option stream url: This URL doesn't have a hostname part.
17:03:20 M: 30457856   DEBUG:   msg: WINSOCK2 init: 0
17:03:20 M: 30433280   DEBUG:   msg: [file] File size is 806604624 bytes
17:03:20 M: 30433280   DEBUG:   msg: STREAM: [file] iso9660://MPEG2/AVSEQ01.MPG
17:03:20 M: 30433280   DEBUG:   msg: STREAM: Description: File
17:03:20 M: 30433280   DEBUG:   msg: STREAM: Author: Albeu
17:03:20 M: 30433280   DEBUG:   msg: STREAM: Comment: based on the code from ??? (probably Arpi)
17:03:20 M: 27787264   DEBUG:   msg: CACHE_PRE_INIT: 0 [0] 0  pre:0  eof:0
17:03:20 M: 27787264   DEBUG:   msg: 
Cache fill:  0.00% (0 bytes)
17:03:20 M: 27787264   DEBUG:   msg: 
Cache fill:  0.00% (0 bytes)
17:03:20 M: 27787264   DEBUG:   msg: 
Cache fill:  0.00% (0 bytes)
17:03:20 M: 27729920    INFO: Loading skin file: DialogBusy.xml
17:03:20 M: 27590656   DEBUG:   msg: 
Cache fill:  3.13% (65536 bytes)
17:03:20 M: 27590656   DEBUG:   msg: 
Cache fill:  6.25% (131072 bytes)
17:03:20 M: 27590656   DEBUG:   msg: 
Cache fill:  9.38% (196608 bytes)
17:03:20 M: 27590656   DEBUG:   msg: 
Cache fill:  9.38% (196608 bytes)
17:03:20 M: 27590656   DEBUG:   msg: 
Cache fill:  9.38% (196608 bytes)
17:03:20 M: 27590656   DEBUG:   msg: 
Cache fill: 12.50% (262144 bytes)
17:03:20 M: 27590656   DEBUG:   msg: 
Cache fill: 12.50% (262144 bytes)
17:03:20 M: 27590656   DEBUG:   msg: 
Cache fill: 15.63% (327680 bytes)
17:03:20 M: 27590656   DEBUG:   msg: 
Cache fill: 15.63% (327680 bytes)
17:03:20 M: 27590656   DEBUG:   msg: 
Cache fill: 18.75% (393216 bytes)
17:03:20 M: 27590656   DEBUG:   msg: 
Cache fill: 18.75% (393216 bytes)
17:03:20 M: 27590656   DEBUG:   msg: demux_open(00E38010,0,-1,-1,-1)
17:03:20 M: 27590656   DEBUG:   msg: Checking for YUV4MPEG2
17:03:20 M: 27590656   DEBUG:   msg: ASF_check: not ASF guid!
17:03:20 M: 27590656   DEBUG:   msg: Checking for Nullsoft Streaming Video
17:03:20 M: 27590656   DEBUG:   msg: Checking for NuppelVideo
17:03:20 M: 27590656   DEBUG:   msg: Checking for REAL
17:03:20 M: 27590656   DEBUG:   msg: Checking for SMJPEG
17:03:20 M: 27590656   DEBUG:   msg: SUB: opened iconv descriptor.
17:03:20 M: 27590656   DEBUG:   msg: Searching demuxer type for filename iso9660://MPEG2/AVSEQ01.MPG ext: .MPG
17:03:20 M: 27590656   DEBUG:   msg: Checking for MOV
17:03:20 M: 27590656   DEBUG:   msg: Checking for VIVO
17:03:20 M: 27590656   DEBUG:   msg: SUB: opened iconv descriptor.
17:03:20 M: 27578368   DEBUG:   msg: SUB: closed iconv descriptor.
17:03:20 M: 27590656   DEBUG:   msg: Checking for PVA
17:03:20 M: 27590656   DEBUG:   msg: Checking for MPEG-TS...
17:03:20 M: 27590656   DEBUG:   msg: TRIED UP TO POSITION 72257, FOUND 47, packet_size= 0, SEEMS A TS? 0
17:03:20 M: 27590656   DEBUG:   msg: Checking for LMLM4 Stream Format
17:03:20 M: 27590656   DEBUG:   msg: Invalid packet in LMLM4 stream: ch=255 size=-9
17:03:20 M: 27590656   DEBUG:   msg: LMLM4 Stream Format not found
17:03:20 M: 27590656   DEBUG:   msg: system stream synced at 0x25 (37)!
17:03:20 M: 27590656   DEBUG:   msg: ==> Found video stream: 0
17:03:20 M: 27590656   DEBUG:   msg: ==> Found audio stream: 0
17:03:21 M: 27590656   DEBUG:   msg: MPEG-PS file format detected.
17:03:21 M: 27590656   DEBUG:   msg: Searching for sequence header...
17:03:21 M: 27590656   DEBUG:   msg: OK!
17:03:21 M: 26533888   DEBUG:   msg: VIDEO:  MPEG2  480x480  (aspect 2)  29.970 fps  2520.0 kbps (315.0 kbyte/s)
17:03:21 M: 26533888   DEBUG:   msg: [V] filefmt:2  fourcc:0x10000002  size:480x480  fps:29.97  ftime:=0.0334
17:03:21 M: 26533888   DEBUG:   msg: get_path('sub/') -> 'Q:\system\players\mplayer\sub/'
17:03:21 M: 26533888   DEBUG:   msg: Starting lookup for subs
17:03:21 M: 26533888   DEBUG:   msg: Global Subsize: 0 - VOBSUB: -1, DEMUX: -1, SUBS: -1
17:03:21 M: 26533888   DEBUG:   msg: Global Subpos : -1
17:03:21 M: 26533888   DEBUG:   msg: ==========================================================================
17:03:21 M: 26533888   DEBUG:   msg: Opening audio decoder: [mp3lib] MPEG layer-2, layer-3
17:03:21 M: 26533888   DEBUG:   msg: dec_audio: Allocating 4608 + 65536 = 70144 bytes for output buffer.
17:03:21 M: 26460160   DEBUG:   msg: mp3lib: made decode tables with MMX optimization
17:03:21 M: 26460160   DEBUG:   msg: mp3lib: using MMX optimized decore!
17:03:21 M: 26460160   DEBUG:   msg: MP3lib: init layer2&3 finished, tables done
17:03:21 M: 26460160   DEBUG:   msg: 
MPEG 1.0, Layer II, 44100 Hz 192 kbit Stereo, BPF: 627
17:03:21 M: 26460160   DEBUG:   msg: Channels: 2, copyright: No, original: No, CRC: Yes, emphasis: 0
17:03:21 M: 26460160   DEBUG:   msg: AUDIO: 44100 Hz, 2 ch, 16 bit (0x10), ratio: 24000->176400 (192.0 kbit)
17:03:21 M: 26460160   DEBUG:   msg: Selected audio codec: [mp3] afm:mp3lib (mp3lib MPEG layer-2, layer-3)
17:03:21 M: 26460160   DEBUG:   msg: ==========================================================================
17:03:21 M: 26460160   DEBUG: CXBoxRenderManager::PreInit - Selected RGB-Renderer
17:03:21 M: 26464256   DEBUG:   msg: ==========================================================================
17:03:21 M: 26464256   DEBUG:   msg: Opening video decoder: [mpegpes] MPEG 1/2 Video passthrough
17:03:21 M: 26464256   DEBUG:   msg: VDec: vo config request - 480 x 480 (preferred colorspace: Mpeg PES)
17:03:21 M: 26464256   DEBUG:   msg: Trying filter chain:
17:03:21 M: 26464256   DEBUG:   msg:  vo
17:03:21 M: 26464256   DEBUG:   msg:
17:03:21 M: 26464256   DEBUG:   msg: Could not find matching colorspace - retrying with -vf scale...
17:03:21 M: 26464256   DEBUG:   msg: Opening video filter: [scale]
17:03:21 M: 26464256   DEBUG:   msg: SwScale params: -1 x -1 (-1=no scaling)
17:03:21 M: 26464256   DEBUG:   msg: Trying filter chain:
17:03:21 M: 26464256   DEBUG:   msg:  scale
17:03:21 M: 26464256   DEBUG:   msg:  vo
17:03:21 M: 26464256   DEBUG:   msg:
17:03:21 M: 26464256   DEBUG:   msg: The selected video_out device is incompatible with this codec.
                             Try adding the scale filter, e.g. -vf spp,scale instead of -vf spp.
17:03:21 M: 26464256   DEBUG:   msg: VDecoder init failed :(
17:03:21 M: 26464256   DEBUG:   msg: Opening video decoder: [libmpeg2] MPEG 1/2 Video decoder libmpeg2-v0.4.0b
17:03:21 M: 25219072   DEBUG:   msg: Selected video codec: [mpeg12] vfm:libmpeg2 (MPEG-1 or 2 (libmpeg2))
17:03:21 M: 25219072   DEBUG:   msg: ==========================================================================
17:03:21 M: 25219072   DEBUG:   msg: Checking audio filter chain for 44100Hz/2ch/16bit -> 44100Hz/6ch/16bit...
17:03:21 M: 25219072   DEBUG:   msg: [libaf] Adding filter dummy
17:03:21 M: 25219072   DEBUG:   msg: [dummy] Was reinitialized, rate=44100Hz, nch = 2, format = 0x00000001 and bps = 2
17:03:21 M: 25219072   DEBUG:   msg: AF_pre: af format: 2 bps, 2 ch, 44100 hz, little endian signed int
17:03:21 M: 25219072   DEBUG:   msg: AF_pre: 44100Hz 2ch Signed 16-bit (Little-Endian)
17:03:21 M: 25174016   DEBUG:   msg: AO: [win32] 44100Hz 2ch Signed 16-bit (Little-Endian) (2 bps)
17:03:21 M: 25174016   DEBUG:   msg: AO: Description: Windows waveOut audio output
                             AO: Author: SaschaSommer <saschasommer@freenet.de>
17:03:21 M: 25174016   DEBUG:   msg: Building audio filter chain for 44100Hz/2ch/16bit -> 44100Hz/2ch/16bit...
17:03:21 M: 25174016   DEBUG:   msg: [dummy] Was reinitialized, rate=44100Hz, nch = 2, format = 0x00000001 and bps = 2
17:03:21 M: 25174016   DEBUG:   msg: [dummy] Was reinitialized, rate=44100Hz, nch = 2, format = 0x00000001 and bps = 2
17:03:21 M: 25104384   DEBUG:   msg: Starting playback...
17:03:21 M: 25104384   DEBUG:   msg: mplayer_open_file(iso9660://MPEG2/AVSEQ01.MPG) done 1.0000
17:03:21 M: 24629248   DEBUG: Playback has started
17:03:21 M: 24952832   DEBUG: CGUIInfoManager::SetCurrentMovie(iso9660://MPEG2/AVSEQ01.MPG)
17:03:21 M: 24936448   DEBUG:   msg: VDec: vo config request - 480 x 480 (preferred colorspace: Planar YV12)
17:03:22 M: 24825856   DEBUG:   msg: Trying filter chain:
17:03:22 M: 24825856   DEBUG:   msg:  vo
17:03:22 M: 24866816   DEBUG:   msg:
17:03:22 M: 24825856   DEBUG:   msg: VDec: using Planar YV12 as output csp (no 0)
17:03:22 M: 24866816   DEBUG:   msg: Movie-Aspect is 1.33:1 - prescaling to correct movie aspect.
17:03:22 M: 24825856   DEBUG:   msg: VO Config (480x480->640x480,flags=1,'MPlayer',0x32315659)
17:03:22 M: 24866816   DEBUG: CVideoDatabase::GetMovieInfo(iso9660://MPEG2/AVSEQ01.MPG), query = select idMovie from movie where idFile=1
17:03:22 M: 24825856   DEBUG:   msg: VO: [directx] 480x480 => 640x480 Planar YV12  [fs]
17:03:22 M: 24825856   DEBUG:   msg: VO: Description: XBOX Direct3D8 YUY2 renderer
17:03:22 M: 24866816   DEBUG:   msg: VO: Author: Frodo/JCMarshall
17:03:22 M: 24866816   DEBUG: CVideoDatabase::GetEpisodeInfo(iso9660://MPEG2/AVSEQ01.MPG), query = select idEpisode from episode where idFile=1
17:03:22 M: 24866816   DEBUG: mplayer::video_config(480, 480, 640, 480, 1, 842094169)
17:03:22 M: 24825856  NOTICE: Display resolution AUTO : PAL 4:3 (6)
17:03:22 M: 24412160   DEBUG: Activating window ID: 12005
17:03:22 M: 24412160   DEBUG: Checking if window ID 12005 is locked.
17:03:22 M: 25157632   DEBUG: FreeVisualisation() started
17:03:22 M: 25157632   DEBUG: FreeVisualisation() done
17:03:22 M: 28782592   DEBUG: Setting resolution 6
17:03:22 M: 29667328   DEBUG: We set resolution 6
17:03:22 M: 29298688   DEBUG: Created YV12 texture 0
17:03:22 M: 29298688    INFO: Loading skin file: VideoFullscreen.xml
17:03:22 M: 29298688    INFO: Loading skin file: VideoOSD.xml
17:03:22 M: 28704768    INFO: Loading skin file: VideoOSDSettings.xml
17:03:22 M: 27996160    INFO: Loading skin file: VideoOSDSettings.xml
17:03:22 M: 27897856   DEBUG: CGUIFontTTF::Load Scaled size of font Q:\Media\Fonts\Arial.ttf (28): width = 76, height = 39
17:03:22 M: 27512832   DEBUG:   msg: *** [vo] Allocating mp_image_t, 480x480x12bpp YUV planar, 345600 bytes
17:03:22 M: 27164672   DEBUG:   msg: *** [vo] Allocating mp_image_t, 480x480x12bpp YUV planar, 345600 bytes
17:03:22 M: 26419200   DEBUG:   msg: *** [vo] Allocating (slices) mp_image_t, 480x480x12bpp YUV planar, 345600 bytes
17:03:22 M: 26406912   DEBUG:   msg: 
                             demux_mpg: 24000/1001fps progressive NTSC content detected, switching framerate.
17:03:51 M: 26464256   DEBUG:   msg: VDec: vo config request - 480 x 480 (preferred colorspace: Planar YV12)
17:03:51 M: 26464256   DEBUG:   msg: Trying filter chain:
17:03:51 M: 26464256   DEBUG:   msg:  vo
17:03:51 M: 26464256   DEBUG:   msg:
17:03:51 M: 26464256   DEBUG:   msg: VDec: using Planar YV12 as output csp (no 0)
17:03:51 M: 26464256   DEBUG:   msg: Movie-Aspect is 1.48:1 - prescaling to correct movie aspect.
17:03:51 M: 26464256   DEBUG:   msg: VO Config (480x480->712x480,flags=1,'MPlayer',0x32315659)
17:03:51 M: 26464256   DEBUG:   msg: VO: [directx] 480x480 => 712x480 Planar YV12  [fs]
17:03:51 M: 26464256   DEBUG:   msg: VO: Description: XBOX Direct3D8 YUY2 renderer
17:03:51 M: 26464256   DEBUG:   msg: VO: Author: Frodo/JCMarshall
17:03:51 M: 26464256   DEBUG: mplayer::video_config(480, 480, 712, 480, 1, 842094169)
17:03:51 M: 26464256  NOTICE: Display resolution AUTO : PAL 4:3 (6)
17:03:51 M: 25419776   DEBUG:   msg: VDec: vo config request - 480 x 480 (preferred colorspace: Planar YV12)
17:03:51 M: 25419776   DEBUG:   msg: Trying filter chain:
17:03:51 M: 25419776   DEBUG:   msg:  vo
17:03:51 M: 25419776   DEBUG:   msg:
17:03:51 M: 25419776   DEBUG:   msg: VDec: using Planar YV12 as output csp (no 0)
17:03:51 M: 25419776   DEBUG:   msg: Movie-Aspect is 1.33:1 - prescaling to correct movie aspect.
17:03:51 M: 25419776   DEBUG:   msg: VO Config (480x480->640x480,flags=1,'MPlayer',0x32315659)
17:03:51 M: 25419776   DEBUG:   msg: VO: [directx] 480x480 => 640x480 Planar YV12  [fs]
17:03:51 M: 25419776   DEBUG:   msg: VO: Description: XBOX Direct3D8 YUY2 renderer
17:03:51 M: 25419776   DEBUG:   msg: VO: Author: Frodo/JCMarshall
17:03:51 M: 25419776   DEBUG: mplayer::video_config(480, 480, 640, 480, 1, 842094169)
17:03:51 M: 25419776  NOTICE: Display resolution AUTO : PAL 4:3 (6)
17:03:52 M: 24104960   DEBUG: CApplication::OnKey: 257 pressed, action is 13
17:03:53 M: 24104960   DEBUG:   msg:  mplayer_close_file()
17:03:53 M: 24121344   DEBUG:   msg:
17:03:53 M: 24121344   DEBUG:   msg:  uninit_player
17:03:53 M: 26783744   DEBUG:   msg: WINSOCK2 uninit
17:03:53 M: 26800128   DEBUG:   msg: Uninit audio filters...
17:03:53 M: 26800128   DEBUG:   msg: [libaf] Removing filter dummy
17:03:53 M: 26800128   DEBUG:   msg: Uninit audio: mp3lib
17:03:53 M: 26931200   DEBUG:   msg: Uninit video: libmpeg2
17:03:53 M: 30699520   DEBUG: Deleted YV12 texture 0
17:03:53 M: 30986240   DEBUG:   msg:  uninit_player - done
17:03:53 M: 30986240   DEBUG: Freeing FS segment @ 0xb04650
17:03:53 M: 41758720  NOTICE: Saving Scart settings in T:\avpacksettings.xml
17:03:53 M: 43261952   DEBUG: Setting resolution 6
17:03:53 M: 42377216   DEBUG: We set resolution 6
17:03:53 M: 42602496    INFO: Loading skin file: Home.xml