$ vlc -vvv Formula.1.Gran.pri.Malazii.Kvalifik.2011.avi
VLC media player 1.1.3 The Luggage (revision exported)
[0x85288fc] main libvlc debug: VLC media player - 1.1.3 The Luggage
[0x85288fc] main libvlc debug: Copyright © 1996-2010 the VideoLAN team
[0x85288fc] main libvlc debug: revision exported
[0x85288fc] main libvlc debug: configured with ./configure '--build=i486-linux-gnu' '--config-cache' '--disable-maintainer-mode' '--disable-silent-rules' '--disable-update-check' '--enable-fast-install' '--prefix=/usr' '--sysconfdir=/etc' '--with-binary-version=1squeeze6' '--enable-a52' '--enable-aa' '--enable-bonjour' '--enable-caca' '--enable-dca' '--enable-dirac' '--enable-dvb' '--enable-dvbpsi' '--enable-dvdnav' '--enable-faad' '--enable-flac' '--enable-fluidsynth' '--enable-freetype' '--enable-fribidi' '--enable-ggi' '--enable-gnutls' '--enable-jack' '--enable-kate' '--enable-libass' '--enable-libmpeg2' '--enable-libproxy' '--enable-libxml2' '--enable-lirc' '--enable-live555' '--enable-mad' '--enable-mkv' '--enable-mod' '--enable-mozilla' '--enable-mpc' '--enable-mtp' '--enable-mux_ogg' '--enable-ncurses' '--enable-notify' '--enable-ogg' '--enable-pulse' '--enable-qt4' '--enable-realrtsp' '--enable-schroedinger' '--enable-sdl' '--enable-shout' '--enable-skins2' '--enable-smb' '--enable-speex' '--enable-svg' '--enable-taglib' '--enable-theora' '--enable-twolame' '--enable-upnp' '--enable-vcd' '--enable-vcdx' '--enable-vorbis' '--enable-zvbi' '--with-kde-solid=/usr/share/kde4/apps/' '--with-mozilla-pkg=libxul' '--disable-dxva2' '--disable-gnomevfs' '--disable-goom' '--disable-libva' '--disable-osso_screensaver' '--disable-portaudio' '--disable-projectm' '--disable-sqlite' '--disable-telx' '--disable-x264' '--enable-alsa' '--enable-atmo' '--enable-dc1394' '--enable-dv' '--enable-pvr' '--enable-udev' '--enable-v4l' '--enable-v4l2' '--enable-svgalib' 'build_alias=i486-linux-gnu' 'CFLAGS=-g -O2' 'LDFLAGS=-Wl,--as-needed' 'CPPFLAGS=' 'CXXFLAGS=-g -O2'
[0x85288fc] main libvlc debug: translation test: code is "C"
[0x85288fc] main libvlc debug: checking plugin modules
[0x85288fc] main libvlc debug: loading plugins cache file /usr/lib/vlc/plugins/plugins-04041e-38.dat
[0x85288fc] main libvlc debug: recursively browsing `/usr/lib/vlc/plugins'
[0x85288fc] main libvlc debug: saving plugins cache /usr/lib/vlc/plugins/plugins-04041e-38.dat
[0x85288fc] main libvlc debug: module bank initialized (391 modules)
[0x85288fc] main libvlc debug: opening config file (/home/rte/.config/vlc/vlcrc)
[0x85288fc] main libvlc debug: CPU has capabilities MMX 3DNow! MMXEXT FPU
[0x85288fc] main libvlc debug: looking for memcpy module: 4 candidates
[0x85288fc] main libvlc debug: using memcpy module "memcpymmxext"
[0x85d1b0c] main input debug: Creating an input for 'Media Library'
[0x85d1b0c] main input debug: Input is a meta file: disabling unneeded options
[0x85d1b0c] main input debug: using timeshift granularity of 50 MiB
[0x85d1b0c] main input debug: using timeshift path '/tmp'
[0x85d1b0c] main input debug: `file/xspf-open:///home/rte/.local/share/vlc/ml.xspf' gives access `file' demux `xspf-open' path `/home/rte/.local/share/vlc/ml.xspf'
[0x85d1b0c] main input debug: creating demux: access='file' demux='xspf-open' path='/home/rte/.local/share/vlc/ml.xspf'
[0x85d0624] main demux debug: looking for access_demux module: 2 candidates
[0x85d0624] main demux debug: no access_demux module matching "file" could be loaded
[0x85d0624] main demux debug: TIMER module_need() : 0.303 ms - Total 0.303 ms / 1 intvls (Avg 0.303 ms)
[0x85d1b0c] main input debug: creating access 'file' path='/home/rte/.local/share/vlc/ml.xspf'
[0x85c85f4] main access debug: looking for access module: 2 candidates
[0x85c85f4] filesystem access debug: opening file `/home/rte/.local/share/vlc/ml.xspf'
[0x85c85f4] main access debug: using access module "filesystem"
[0x85c85f4] main access debug: TIMER module_need() : 0.149 ms - Total 0.149 ms / 1 intvls (Avg 0.149 ms)
[0x85cf14c] main stream debug: Using AStream*Stream
[0x85cf14c] main stream debug: pre buffering
[0x85cf14c] main stream debug: received first data after 0 ms
[0x85cf14c] main stream debug: pre-buffering done 296 bytes in 0s - 36132 KiB/s
[0x85cef0c] main stream debug: looking for stream_filter module: 5 candidates
[0x85cef0c] main stream debug: no stream_filter module matching "any" could be loaded
[0x85cef0c] main stream debug: TIMER module_need() : 0.222 ms - Total 0.222 ms / 1 intvls (Avg 0.222 ms)
[0x85cef0c] main stream debug: looking for stream_filter module: 1 candidate
[0x85cef0c] main stream debug: using stream_filter module "stream_filter_record"
[0x85cef0c] main stream debug: TIMER module_need() : 0.076 ms - Total 0.076 ms / 1 intvls (Avg 0.076 ms)
[0x85d1b0c] main input debug: creating demux: access='file' demux='xspf-open' path='/home/rte/.local/share/vlc/ml.xspf'
[0x85c8e94] main demux debug: looking for demux module: 1 candidate
[0x85c8e94] playlist demux debug: using XSPF playlist reader
[0x85c8e94] main demux debug: using demux module "playlist"
[0x85c8e94] main demux debug: TIMER module_need() : 0.130 ms - Total 0.130 ms / 1 intvls (Avg 0.130 ms)
[0x85c987c] main demux meta debug: looking for meta reader module: 2 candidates
[0x85c987c] lua demux meta debug: Trying Lua scripts in /home/rte/.local/share/vlc/lua/meta/reader
[0x85c987c] lua demux meta debug: Trying Lua scripts in /usr/lib/vlc/lua/meta/reader
[0x85c987c] lua demux meta debug: Trying Lua playlist script /usr/lib/vlc/lua/meta/reader/filename.luac
[0x85c987c] lua demux meta debug: Trying Lua scripts in /usr/share/vlc/lua/meta/reader
[0x85c987c] main demux meta debug: no meta reader module matching "any" could be loaded
[0x85c987c] main demux meta debug: TIMER module_need() : 2.360 ms - Total 2.360 ms / 1 intvls (Avg 2.360 ms)
[0x85d1b0c] main input debug: `file/xspf-open:///home/rte/.local/share/vlc/ml.xspf' successfully opened
[0x85c987c] main xml debug: looking for xml module: 2 candidates
[0x85c987c] main xml debug: using xml module "xml"
[0x85c987c] main xml debug: TIMER module_need() : 0.311 ms - Total 0.311 ms / 1 intvls (Avg 0.311 ms)
[0x85c8e94] playlist demux debug: parsed 0 tracks successfully
[0x85c987c] main xml debug: removing module "xml"
[0x85d1b0c] main input debug: EOF reached
[0x85c8e94] main demux debug: removing module "playlist"
[0x85cef0c] main stream debug: removing module "stream_filter_record"
[0x85c85f4] main access debug: removing module "filesystem"
[0x85d1b0c] main input debug: TIMER input launching for 'Media Library' : 3.534 ms - Total 3.534 ms / 1 intvls (Avg 3.534 ms)
[0x85cef0c] main interface debug: looking for interface module: 1 candidate
[0x85cef0c] main interface debug: using interface module "hotkeys"
[0x85cef0c] main interface debug: TIMER module_need() : 0.115 ms - Total 0.115 ms / 1 intvls (Avg 0.115 ms)
[0x85c987c] main interface debug: looking for interface module: 1 candidate
Blocked: call to unsetenv("DBUS_ACTIVATION_ADDRESS")
Blocked: call to unsetenv("DBUS_ACTIVATION_BUS_TYPE")
Warning: call to signal(13, 0x1)
[0x85d0d74] main playlist debug: Activated
[0x85c987c] main interface debug: using interface module "inhibit"
[0x85c987c] main interface debug: TIMER module_need() : 1.645 ms - Total 1.645 ms / 1 intvls (Avg 1.645 ms)
[0x85d0d74] main playlist debug: adding item `Formula.1.Gran.pri.Malazii.Kvalifik.2011.avi' ( file:///home/rte/Formula.1.Gran.pri.Malazii.Kvalifik.2011.avi )
[0x85bc124] main interface debug: looking for interface module: 1 candidate
[0x85bc124] main interface debug: using interface module "signals"
[0x85bc124] main interface debug: TIMER module_need() : 0.127 ms - Total 0.127 ms / 1 intvls (Avg 0.127 ms)
[0x85c439c] main interface debug: looking for interface module: 1 candidate
[0x85b8904] main input debug: Creating an input for 'Formula.1.Gran.pri.Malazii.Kvalifik.2011.avi'
[0x85c439c] main interface debug: using interface module "globalhotkeys"
[0x85c439c] main interface debug: TIMER module_need() : 1.179 ms - Total 1.179 ms / 1 intvls (Avg 1.179 ms)
[0x85cad04] main interface debug: looking for interface module: 1 candidate
[0x85d0d74] main playlist debug: rebuilding array of current - root Playlist
[0x85d0d74] main playlist debug: rebuild done - 1 items, index -1
Blocked: call to setlocale(6, "")
Blocked: call to sigaction(17, 0xb44790d4, 0xb4479048)
[0x85d0d74] main playlist debug: no fetch required for (null) (art currently (null))
Warning: call to signal(13, 0x1)
Warning: call to srand(1328823248)
Warning: call to rand()
Blocked: call to setlocale(6, "")
(process:5565): Gtk-WARNING **: Locale not supported by C library.
Using the fallback 'C' locale.
Warning: call to signal(13, 0x1)
[0x8712e24] main generic debug: looking for extension module: 1 candidate
[0x8712e24] lua generic debug: Opening EXPERIMENTAL Lua Extension module
[0x8712e24] lua generic debug: Trying Lua scripts in /home/rte/.local/share/vlc/lua/extensions
[0x8712e24] lua generic debug: Trying Lua scripts in /usr/lib/vlc/lua/extensions
[0x8712e24] lua generic debug: Trying Lua playlist script /usr/lib/vlc/lua/extensions/allocine-fr.luac
[0x8712e24] lua generic debug: Scanning Lua script /usr/lib/vlc/lua/extensions/allocine-fr.luac
[0x8712e24] lua generic debug: Script /usr/lib/vlc/lua/extensions/allocine-fr.luac has the following capability flags: 0xc
[0x8712e24] lua generic debug: Trying Lua scripts in /usr/share/vlc/lua/extensions
[0x8712e24] main generic debug: using extension module "lua"
[0x8712e24] main generic debug: TIMER module_need() : 0.392 ms - Total 0.392 ms / 1 intvls (Avg 0.392 ms)
[0x85cad04] main interface debug: using interface module "qt4"
[0x85cad04] main interface debug: TIMER module_need() : 118.282 ms - Total 118.282 ms / 1 intvls (Avg 118.282 ms)
[0x85d0d74] main playlist debug: processing request item null node Playlist skip 0
[0x85d0d74] main playlist debug: starting new item
[0x85d0d74] main playlist debug: creating new input thread
[0x85d2d4c] main input debug: Creating an input for 'Formula.1.Gran.pri.Malazii.Kvalifik.2011.avi'
[0x85d2d4c] main input debug: thread (input) created at priority 10 (input/input.c:214)
[0x85d2d4c] main input debug: thread started
[0x85d2d4c] main input debug: using timeshift granularity of 50 MiB
[0x85d2d4c] main input debug: using timeshift path '/tmp'
[0x85d2d4c] main input debug: `file:///home/rte/Formula.1.Gran.pri.Malazii.Kvalifik.2011.avi' gives access `file' demux `' path `/home/rte/Formula.1.Gran.pri.Malazii.Kvalifik.2011.avi'
[0x85d2d4c] main input debug: creating demux: access='file' demux='' path='/home/rte/Formula.1.Gran.pri.Malazii.Kvalifik.2011.avi'
[0x873420c] main demux debug: looking for access_demux module: 2 candidates
[0x873420c] main demux debug: no access_demux module matching "file" could be loaded
[0x873420c] main demux debug: TIMER module_need() : 0.121 ms - Total 0.121 ms / 1 intvls (Avg 0.121 ms)
[0x85d2d4c] main input debug: creating access 'file' path='/home/rte/Formula.1.Gran.pri.Malazii.Kvalifik.2011.avi'
[0x8734404] main access debug: looking for access module: 2 candidates
[0x8734404] filesystem access debug: opening file `/home/rte/Formula.1.Gran.pri.Malazii.Kvalifik.2011.avi'
[0x8734404] main access debug: using access module "filesystem"
[0x8734404] main access debug: TIMER module_need() : 0.083 ms - Total 0.083 ms / 1 intvls (Avg 0.083 ms)
[0x87345d4] main stream debug: Using AStream*Stream
[0x87345d4] main stream debug: pre buffering
[0x87345d4] main stream debug: received first data after 0 ms
[0x87345d4] main stream debug: pre-buffering done 1024 bytes in 0s - 83333 KiB/s
[0x87347e4] main stream debug: looking for stream_filter module: 5 candidates
[0x87347e4] main stream debug: no stream_filter module matching "any" could be loaded
[0x87347e4] main stream debug: TIMER module_need() : 0.060 ms - Total 0.060 ms / 1 intvls (Avg 0.060 ms)
[0x87347e4] main stream debug: looking for stream_filter module: 1 candidate
[0x87347e4] main stream debug: using stream_filter module "stream_filter_record"
[0x87347e4] main stream debug: TIMER module_need() : 0.659 ms - Total 0.659 ms / 1 intvls (Avg 0.659 ms)
[0x85d2d4c] main input debug: creating demux: access='file' demux='' path='/home/rte/Formula.1.Gran.pri.Malazii.Kvalifik.2011.avi'
[0x87349ac] main demux debug: looking for demux module: 52 candidates
[0x87347e4] avi stream debug: found Chunk fourcc:46464952 (RIFF) size:889118828 pos:0
[0x87347e4] avi stream debug: found LIST chunk: 'AVI '
[0x87347e4] avi stream debug: <list 'AVI '>
[0x87347e4] avi stream debug: found Chunk fourcc:5453494c (LIST) size:8830 pos:12
[0x87347e4] avi stream debug: found LIST chunk: 'hdrl'
[0x87347e4] avi stream debug: <list 'hdrl'>
[0x87347e4] avi stream debug: found Chunk fourcc:68697661 (avih) size:56 pos:24
[0x87347e4] avi stream debug: avih: streams:2 flags: HAS_INDEX IS_INTERLEAVED 704x448
[0x87347e4] avi stream debug: found Chunk fourcc:5453494c (LIST) size:4244 pos:88
[0x87347e4] avi stream debug: found LIST chunk: 'strl'
[0x87347e4] avi stream debug: <list 'strl'>
[0x87347e4] avi stream debug: found Chunk fourcc:68727473 (strh) size:56 pos:100
[0x87347e4] avi stream debug: strh: type:vids handler:0x64697678 samplesize:0 25.00fps
[0x87347e4] avi stream debug: found Chunk fourcc:66727473 (strf) size:40 pos:164
[0x87347e4] avi stream debug: strf: video:XVID 704x448 planes:1 24bpp
[0x87347e4] avi stream debug: found Chunk fourcc:4b4e554a (JUNK) size:4120 pos:212
[0x87347e4] avi stream debug: </list 'strl'>
[0x87347e4] avi stream debug: found Chunk fourcc:5453494c (LIST) size:4234 pos:4340
[0x87347e4] avi stream debug: found LIST chunk: 'strl'
[0x87347e4] avi stream debug: <list 'strl'>
[0x87347e4] avi stream debug: found Chunk fourcc:68727473 (strh) size:56 pos:4352
[0x87347e4] avi stream debug: strh: type:auds handler:0x00000000 samplesize:384 41.67fps
[0x87347e4] avi stream debug: found Chunk fourcc:66727473 (strf) size:30 pos:4416
[0x87347e4] avi stream debug: strf: audio:0x0055 channels:2 48000Hz 0bits/sample 125kb/s
[0x87347e4] avi stream debug: found Chunk fourcc:4b4e554a (JUNK) size:4120 pos:4454
[0x87347e4] avi stream debug: </list 'strl'>
[0x87347e4] avi stream debug: found Chunk fourcc:5453494c (LIST) size:260 pos:8582
[0x87347e4] avi stream debug: found LIST chunk: 'odml'
[0x87347e4] avi stream debug: <list 'odml'>
[0x87347e4] avi stream debug: found Chunk fourcc:686c6d64 (dmlh) size:248 pos:8594
[0x87347e4] avi stream warning: unknown chunk (not loaded)
[0x87347e4] avi stream debug: </list 'odml'>
[0x87347e4] avi stream debug: </list 'hdrl'>
[0x87347e4] avi stream debug: found Chunk fourcc:4b4e554a (JUNK) size:1382 pos:8850
[0x87347e4] avi stream debug: found Chunk fourcc:5453494c (LIST) size:885830528 pos:10240
[0x87347e4] avi stream debug: skipping movi chunk
[0x87347e4] avi stream debug: found Chunk fourcc:31786469 (idx1) size:3277984 pos:885840776
[0x85cad04] qt4 interface debug: IM: Setting an input
[0x87347e4] avi stream debug: idx1: index entry:204874
[0x87347e4] avi stream debug: found Chunk fourcc:5453494c (LIST) size:60 pos:889118768
[0x87347e4] avi stream debug: found LIST chunk: 'INFO'
[0x87347e4] avi stream debug: <list 'INFO'>
[0x87347e4] avi stream debug: found Chunk fourcc:54465349 (ISFT) size:47 pos:889118780
[0x87347e4] avi stream debug: ISFT: software : VirtualDubModRus 1.5.10.2 (build 2542/release)
[0x87347e4] avi stream debug: </list 'INFO'>
[0x87347e4] avi stream debug: </list 'AVI '>
[0x87347e4] avi stream debug: * LIST-root size:889118836 pos:0
[0x87347e4] avi stream debug: + RIFF-AVI size:889118828 pos:0
[0x87347e4] avi stream debug: | + LIST-hdrl size:8830 pos:12
[0x87347e4] avi stream debug: | | + avih size:56 pos:24
[0x87347e4] avi stream debug: | | + LIST-strl size:4244 pos:88
[0x87347e4] avi stream debug: | | | + strh size:56 pos:100
[0x87347e4] avi stream debug: | | | + strf size:40 pos:164
[0x87347e4] avi stream debug: | | | + JUNK size:4120 pos:212
[0x87347e4] avi stream debug: | | + LIST-strl size:4234 pos:4340
[0x87347e4] avi stream debug: | | | + strh size:56 pos:4352
[0x87347e4] avi stream debug: | | | + strf size:30 pos:4416
[0x87347e4] avi stream debug: | | | + JUNK size:4120 pos:4454
[0x87347e4] avi stream debug: | | + LIST-odml size:260 pos:8582
[0x87347e4] avi stream debug: | | | + dmlh size:248 pos:8594
[0x87347e4] avi stream debug: | + JUNK size:1382 pos:8850
[0x87347e4] avi stream debug: | + LIST-movi size:885830528 pos:10240
[0x87347e4] avi stream debug: | + idx1 size:3277984 pos:885840776
[0x87347e4] avi stream debug: | + LIST-INFO size:60 pos:889118768
[0x87347e4] avi stream debug: | | + ISFT size:47 pos:889118780
[0x87349ac] avi demux debug: AVIH: 2 stream, flags HAS_INDEX IS_INTERLEAVED
[0x87349ac] avi demux debug: stream[0] rate:25 scale:1 samplesize:0
[0x87349ac] avi demux debug: stream[0] video(XVID) 704x448 24bpp 25.000000fps
[0x85d2d4c] main input debug: selecting program id=0
[0x87349ac] avi demux debug: stream[1] rate:16000 scale:384 samplesize:384
[0x87349ac] avi demux debug: stream[1] audio(0x55) 2 channels 48000Hz 0bits
[0x87349ac] avi demux debug: selected standard index for stream[0]
[0x87349ac] avi demux debug: selected standard index for stream[1]
[0x87349ac] avi demux debug: stream[0] created 102443 index entries
[0x87349ac] avi demux debug: stream[1] created 102431 index entries
[0x87349ac] avi demux debug: stream[0] length:4097 (based on index)
[0x87349ac] avi demux debug: stream[1] length:4097 (based on index)
[0x87349ac] main demux debug: using demux module "avi"
[0x87349ac] main demux debug: TIMER module_need() : 30.066 ms - Total 30.066 ms / 1 intvls (Avg 30.066 ms)
[0x85d2d4c] main input debug: looking for a subtitle file in /home/rte/
[0x87352d4] main decoder debug: looking for decoder module: 30 candidates
[0x87352d4] avcodec decoder debug: libavcodec initialized (interface 0x341401)
[0x87352d4] avcodec decoder debug: trying to use direct rendering
[0x87352d4] avcodec decoder debug: ffmpeg codec (MPEG-4 Video) started
[0x87352d4] main decoder debug: using decoder module "avcodec"
[0x87352d4] main decoder debug: TIMER module_need() : 12.847 ms - Total 12.847 ms / 1 intvls (Avg 12.847 ms)
[0x87352d4] main decoder debug: thread (decoder) created at priority 0 (input/decoder.c:301)
[0x87352d4] main decoder debug: thread started
[0x8738e4c] main decoder debug: looking for decoder module: 30 candidates
[0x8738e4c] main decoder debug: using decoder module "mpeg_audio"
[0x8738e4c] main decoder debug: TIMER module_need() : 0.130 ms - Total 0.130 ms / 1 intvls (Avg 0.130 ms)
[0x8738e4c] main decoder debug: thread (decoder) created at priority 5 (input/decoder.c:301)
[0x8738e4c] main decoder debug: thread started
[0x87397a4] main demux meta debug: looking for meta reader module: 2 candidates
[0x87397a4] lua demux meta debug: Trying Lua scripts in /home/rte/.local/share/vlc/lua/meta/reader
[0x87397a4] lua demux meta debug: Trying Lua scripts in /usr/lib/vlc/lua/meta/reader
[0x87397a4] lua demux meta debug: Trying Lua playlist script /usr/lib/vlc/lua/meta/reader/filename.luac
[0x87397a4] lua demux meta debug: Trying Lua scripts in /usr/share/vlc/lua/meta/reader
[0x87397a4] main demux meta debug: no meta reader module matching "any" could be loaded
[0x87397a4] main demux meta debug: TIMER module_need() : 0.444 ms - Total 0.444 ms / 1 intvls (Avg 0.444 ms)
[0x85d2d4c] main input debug: `file:///home/rte/Formula.1.Gran.pri.Malazii.Kvalifik.2011.avi' successfully opened
[0x85d2d4c] main input debug: Buffering 0%
[0x85d2d4c] main input debug: Buffering 8%
[0x85d2d4c] main input debug: Buffering 16%
[0x85d2d4c] main input debug: Buffering 25%
[0x85d2d4c] main input debug: Buffering 33%
[0x85d2d4c] main input debug: Buffering 41%
[0x85d2d4c] main input debug: Buffering 50%
[0x85d2d4c] main input debug: Buffering 58%
[0x85d2d4c] main input debug: Buffering 66%
[0x85d2d4c] main input debug: Buffering 75%
[0x85d2d4c] main input debug: Buffering 83%
[0x85d2d4c] main input debug: Buffering 91%
[0x85d2d4c] main input debug: Buffering 100%
[0x85d2d4c] main input debug: Stream buffering done (325 ms in 0 ms)
[mpeg4 @ 0x87527c0] Invalid and inefficient vfw-avi packed B frames detected
[0x85d2d4c] main input debug: no usable vout present, spawning one
[0x880504c] main spu text debug: looking for text renderer module: 2 candidates
[0x880504c] freetype spu text debug: Building font databases.
[0x880504c] freetype spu text debug: Using DejaVu Sans as font from file /usr/share/fonts/truetype/ttf-dejavu/DejaVuSans.ttf
[0x880504c] freetype spu text debug: using fontsize: 2
[0x880504c] main spu text debug: using text renderer module "freetype"
[0x880504c] main spu text debug: TIMER module_need() : 0.879 ms - Total 0.879 ms / 1 intvls (Avg 0.879 ms)
[0x88066a4] main scale debug: looking for video filter2 module: 15 candidates
[swscaler @ 0x88195a0] pal8 is not supported as output pixel format
[0x88066a4] swscale scale error: could not init SwScaler and/or allocate memory
[0x88066a4] scale scale debug: 32x32 -> 16x16
[0x88066a4] main scale debug: using video filter2 module "scale"
[0x88066a4] main scale debug: TIMER module_need() : 1.678 ms - Total 1.678 ms / 1 intvls (Avg 1.678 ms)
[0x881259c] main scale debug: looking for video filter2 module: 15 candidates
[0x881259c] yuvp scale debug: YUVP to YUVA converter
[0x881259c] main scale debug: using video filter2 module "yuvp"
[0x881259c] main scale debug: TIMER module_need() : 0.057 ms - Total 0.057 ms / 1 intvls (Avg 0.057 ms)
[0x8800c44] main video output debug: window size: 704x448
[0x8800c44] main video output debug: Deinterlacing available
[0x8800c44] main video output debug: deinterlace 0, mode blend, is_needed 0
[0x8738e4c] mpeg_audio decoder debug: MPGA channels:2 samplerate:48000 bitrate:128
[0x8800c44] main video output debug: looking for video output module: 1 candidate
[0x8800c44] vout_wrapper video output debug: Opening vout display wrapper
[0x881823c] main generic debug: looking for vout display module: 7 candidates
[0x8818a8c] main window debug: looking for vout window xid module: 4 candidates
[0x8818a8c] qt4 window debug: requesting video...
Warning: call to rand()
Warning: call to rand()
Warning: call to rand()
[0x85cad04] qt4 interface debug: Video was requested 0, 0
[0x8818a8c] main window debug: using vout window xid module "qt4"
[0x8818a8c] main window debug: TIMER module_need() : 46.977 ms - Total 46.977 ms / 1 intvls (Avg 46.977 ms)
[0x881bbac] main inhibit debug: looking for inhibit module: 1 candidate
[0x881bbac] main inhibit debug: using inhibit module "xdg_screensaver"
[0x881bbac] main inhibit debug: TIMER module_need() : 0.360 ms - Total 0.360 ms / 1 intvls (Avg 0.360 ms)
[0x881823c] xcb_xv generic debug: connected to X11.0 server
[0x881823c] xcb_xv generic debug: vendor : The X.Org Foundation
[0x881823c] xcb_xv generic debug: version: 10707000
[0x881823c] xcb_xv generic debug: using screen 0x121
[0x881823c] xcb_xv generic debug: using XVideo extension v2.2
[0x881823c] xcb_xv generic error: no available XVideo adaptor
[0x881bbac] xdg_screensaver inhibit debug: started xdg-screensaver (PID = 5576)
[0x881bbac] main inhibit debug: removing module "xdg_screensaver"
[0x8818a8c] qt4 window debug: releasing video...
[0x85cad04] qt4 interface debug: Video is not needed anymore
[0x8818a8c] main window debug: removing module "qt4"
[0x8818a8c] main window debug: looking for vout window xid module: 4 candidates
[0x8818a8c] qt4 window debug: requesting video...
[0x85cad04] qt4 interface debug: Video was requested 0, 0
[0x8818a8c] main window debug: using vout window xid module "qt4"
[0x8818a8c] main window debug: TIMER module_need() : 18.004 ms - Total 18.004 ms / 1 intvls (Avg 18.004 ms)
[0x8823974] main inhibit debug: looking for inhibit module: 1 candidate
[0x8823974] main inhibit debug: using inhibit module "xdg_screensaver"
[0x8823974] main inhibit debug: TIMER module_need() : 0.120 ms - Total 0.120 ms / 1 intvls (Avg 0.120 ms)
[0x8823974] xdg_screensaver inhibit debug: started xdg-screensaver (PID = 5609)
[0x881823c] xcb_x11 generic debug: connected to X11.0 server
[0x881823c] xcb_x11 generic debug: vendor : The X.Org Foundation
[0x881823c] xcb_x11 generic debug: version: 10707000
[0x881823c] xcb_x11 generic debug: using screen 0x121
[0x881823c] xcb_x11 generic debug: X11 visual with alpha-channel not supported
[0x881823c] xcb_x11 generic debug: using X11 visual ID 0x21
[0x881823c] xcb_x11 generic debug: 24 bits depth
[0x881823c] xcb_x11 generic debug: 32 bits per pixel
[0x881823c] xcb_x11 generic debug: 32 bits line pad
[0x881823c] xcb_x11 generic debug: using X11 window 04600000
[0x881823c] xcb_x11 generic debug: using X11 graphic context 04600001
[0x881823c] main generic debug: VoutDisplayEvent 'fullscreen' 0
[0x881823c] main generic debug: VoutDisplayEvent 'resize' 704x448 window
[0x881823c] main generic debug: using vout display module "xcb_x11"
[0x881823c] main generic debug: TIMER module_need() : 124.436 ms - Total 124.436 ms / 1 intvls (Avg 124.436 ms)
[0x881823c] main generic debug: A filter to adapt decoder to display is needed
[0x8819abc] main filter debug: looking for video filter2 module: 15 candidates
[0x8819abc] swscale filter debug: 704x448 chroma: I420 -> 704x448 chroma: RV32 with scaling using Bicubic (good quality)
[0x8819abc] main filter debug: using video filter2 module "swscale"
[0x8819abc] main filter debug: TIMER module_need() : 0.633 ms - Total 0.633 ms / 1 intvls (Avg 0.633 ms)
[0x881823c] main generic debug: Filter 'Swscale' (0x8819abc) appended to chain
[0x8800c44] main video output debug: using video output module "vout_wrapper"
[0x8800c44] main video output debug: TIMER module_need() : 125.279 ms - Total 125.279 ms / 1 intvls (Avg 125.279 ms)
[0x8800c44] main video output debug: got 1 direct buffer(s)
[0x8800c44] main video output debug: pic render sz 704x448, of (0,0), vsz 704x448, 4cc I420, sar 1:1, msk r0x0 g0x0 b0x0
[0x8800c44] main video output debug: pic in sz 704x448, of (0,0), vsz 704x448, 4cc I420, sar 1:1, msk r0x0 g0x0 b0x0
[0x8800c44] main video output debug: pic out sz 704x448, of (0,0), vsz 704x448, 4cc I420, sar 4751999:4752000, msk r0x0 g0x0 b0x0
[0x8800c44] main video output debug: direct render, mapping render pictures 0-23 to system pictures 1-24
[0x85d2d4c] main input debug: creating aout
[0x87352d4] avcodec decoder debug: using direct rendering
[0xb42c0c8c] main audio output debug: looking for audio output module: 4 candidates
[0xb42c0c8c] pulse audio output debug: 2 audio channels
[0xb42c0c8c] pulse audio output debug: Pulse mainloop started
[0x87352d4] main decoder debug: End of video preroll
[0x87352d4] main decoder debug: Received first picture
[0x881823c] xcb_x11 generic debug: display is visible
[0x880504c] freetype spu text debug: using fontsize: 28
[0x875d2a4] main blend debug: looking for video blending module: 1 candidate
[0x875d2a4] blend blend debug: chroma: YUVA -> I420
[0x875d2a4] main blend debug: using video blending module "blend"
[0x875d2a4] main blend debug: TIMER module_need() : 0.183 ms - Total 0.183 ms / 1 intvls (Avg 0.183 ms)
[swscaler @ 0x8829900] bad dst image pointers
[0xb42c0c8c] pulse audio output debug: Failed to connect to server: Connection refused
[0xb42c0c8c] pulse audio output debug: Pulse initialization unlock and fail
[0xb42c0c8c] pulse audio output debug: Pulse initialization failed
Blocked: call to setlocale(1, "C")
Blocked: call to setlocale(1, "en_US.utf8")
Blocked: call to setlocale(1, "C")
[0xb42c0c8c] alsa audio output debug: opening ALSA device `default'
[0xb42c0c8c] main audio output debug: using audio output module "alsa"
[0xb42c0c8c] main audio output debug: TIMER module_need() : 99.475 ms - Total 99.475 ms / 1 intvls (Avg 99.475 ms)
[0xb42c0c8c] main audio output debug: output 'f32l' 48000 Hz Stereo frame=1 samples/8 bytes
[0xb42c0c8c] main audio output debug: mixer 'f32l' 48000 Hz Stereo frame=1 samples/8 bytes
[0xb42c0c8c] main audio output debug: no need for any filter
[0x886de74] main generic debug: looking for audio mixer module: 3 candidates
[0x886de74] main generic debug: using audio mixer module "float32_mixer"
[0x886de74] main generic debug: TIMER module_need() : 0.822 ms - Total 0.822 ms / 1 intvls (Avg 0.822 ms)
[0xb42c0c8c] main audio output debug: input 'mpga' 48000 Hz Stereo frame=1152 samples/969 bytes
[0x886e224] main audio filter debug: looking for audio filter module: 1 candidate
[0x886e224] scaletempo audio filter debug: format: 48000 rate, 2 nch, 4 bps, fl32
[0x886e224] scaletempo audio filter debug: params: 30 stride, 0.200 overlap, 14 search
[0x886e224] scaletempo audio filter debug: 1.000 scale, 1440.000 stride_in, 1440 stride_out, 1152 standing, 288 overlap, 672 search, 2400 queue, fl32 mode
[0x886e224] main audio filter debug: using audio filter module "scaletempo"
[0x886e224] main audio filter debug: TIMER module_need() : 0.757 ms - Total 0.757 ms / 1 intvls (Avg 0.757 ms)
[0xb42c0c8c] main audio output debug: filter(s) 'mpga'->'f32l' 48000 Hz->48000 Hz Stereo->Stereo
[0x8819504] main audio filter debug: looking for audio filter module: 14 candidates
[0x8819504] mpgatofixed32 audio filter debug: mpga->f32l, bits per sample: 0
[0x8819504] main audio filter debug: using audio filter module "mpgatofixed32"
[0x8819504] main audio filter debug: TIMER module_need() : 1.188 ms - Total 1.188 ms / 1 intvls (Avg 1.188 ms)
[0xb42c0c8c] main audio output debug: found a filter for the whole conversion
[0xb42c0c8c] main audio output debug: filter(s) 'f32l'->'f32l' 52800 Hz->48000 Hz Stereo->Stereo
[0x8880a74] main audio filter debug: looking for audio filter module: 14 candidates
[0x8880a74] bandlimited_resampler audio filter debug: f32l/52800KHz/2->f32l/48000KHz/2
[0x8880a74] main audio filter debug: using audio filter module "bandlimited_resampler"
[0x8880a74] main audio filter debug: TIMER module_need() : 1.541 ms - Total 1.541 ms / 1 intvls (Avg 1.541 ms)
[0xb42c0c8c] main audio output debug: found a filter for the whole conversion
[0x8738e4c] main decoder debug: End of audio preroll
[0x85d2d4c] main input debug: Decoder buffering done in 233 ms
[0xb42c0c8c] main audio output warning: PTS is out of range (-9589), dropping buffer
[0xb42c0c8c] main audio output warning: PTS is out of range (-33445), dropping buffer
[0x8819504] mpgatofixed32 audio filter debug: libmad error: bad main_data_begin pointer
[0x8800c44] main video output debug: Post-processing available
[0x8800c44] main video output warning: vlc_object_find_name(postproc) is not safe!
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[0x881823c] main generic debug: auto hidding mouse
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[0x881823c] main generic debug: VoutDisplayEvent 'mouse button' 0 t=8
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[0x881823c] main generic debug: VoutDisplayEvent 'mouse button' 0 t=9
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[0x881823c] main generic debug: auto hidding mouse
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[0x85d2d4c] main input debug: control type=1
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[0xb42c0c8c] alsa audio output debug: recovered from buffer underrun
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[swscaler @ 0x8829900] bad dst image pointers
[0x85288fc] main libvlc debug: deactivating the playlist
[0x85d0d74] main playlist debug: Deactivate
[0x85d0d74] main playlist debug: incoming request - stopping current input
[0x85d0d74] main playlist debug: dying input
[0x85d2d4c] main input debug: control type=0
[0x85d2d4c] main input debug: control: stopping input
[0x85d0d74] main playlist debug: dying input
[0x87352d4] avcodec decoder debug: ffmpeg codec (MPEG-4 Video) stopped
[0x87352d4] main decoder debug: removing module "avcodec"
[0x87352d4] main decoder debug: killing decoder fourcc `mp4v', 0 PES in FIFO
[0x8800c44] main video output debug:
[0x8800c44] main video output debug: [1] 0 0
[0x8800c44] main video output debug: [2] 0 0
[0x8800c44] main video output debug: [3] 0 0
[0x8800c44] main video output debug: [4] 0 0
[0x8800c44] main video output debug: [5] 0 0
[0x8800c44] main video output debug: [6] 0 0
[0x8800c44] main video output debug: [7] 0 0
[0x8800c44] main video output debug: [8] 0 0
[0x8800c44] main video output debug: [9] 0 0
[0x8800c44] main video output debug: [10] 0 0
[0x8800c44] main video output debug: [11] 2 0
[0x8800c44] main video output debug: [12] 2 0
[0x8800c44] main video output debug: [13] 2 0
[0x8800c44] main video output debug: [14] 2 0
[0x8800c44] main video output debug: [15] 2 0
[0x85d2d4c] main input debug: saving a free vout
[0x8738e4c] main decoder debug: removing module "mpeg_audio"
[0x8738e4c] main decoder debug: killing decoder fourcc `mpga', 0 PES in FIFO
[0x8819504] main audio filter debug: removing module "mpgatofixed32"
[0x886e224] main audio filter debug: removing module "scaletempo"
[0x8880a74] main audio filter debug: removing module "bandlimited_resampler"
[0xb42c0c8c] main audio output debug: removing module "alsa"
[0x886de74] main generic debug: removing module "float32_mixer"
[0x85d2d4c] main input debug: releasing aout
[0x87347e4] avi stream debug: free chunk avih
[0x87347e4] avi stream debug: free chunk strh
[0x87347e4] avi stream debug: free chunk strf
[0x87347e4] avi stream debug: free chunk JUNK
[0x87347e4] avi stream debug: free chunk LIST
[0x87347e4] avi stream debug: free chunk strh
[0x87347e4] avi stream debug: free chunk strf
[0x87347e4] avi stream debug: free chunk JUNK
[0x87347e4] avi stream debug: free chunk LIST
[0x87347e4] avi stream warning: unknown chunk (not unloaded)
[0x87347e4] avi stream debug: free chunk LIST
[0x87347e4] avi stream debug: free chunk LIST
[0x87347e4] avi stream debug: free chunk JUNK
[0x87347e4] avi stream debug: free chunk LIST
[0x87347e4] avi stream debug: free chunk idx1
[0x87347e4] avi stream debug: free chunk ISFT
[0x87347e4] avi stream debug: free chunk LIST
[0x87347e4] avi stream debug: free chunk RIFF
[0x87347e4] avi stream debug: free chunk LIST
[0x87349ac] main demux debug: removing module "avi"
[0x87347e4] main stream debug: removing module "stream_filter_record"
[0x8734404] main access debug: removing module "filesystem"
[0x85d2d4c] main input debug: Program doesn't contain anymore ES
[0x85d0d74] main playlist debug: dead input
[0x85d2d4c] main input debug: thread ended
[0x8800c44] main video output debug: destroying useless vout
[0x85cad04] qt4 interface debug: IM: Deleting the input
[0x881823c] main generic debug: Filter 0x8819abc removed from chain
[0x8819abc] main filter debug: removing module "swscale"
[0x8823974] main inhibit debug: removing module "xdg_screensaver"
[0x8818a8c] qt4 window debug: releasing video...
[0x85cad04] qt4 interface debug: Video is not needed anymore
[0x8818a8c] main window debug: removing module "qt4"
[0x881823c] main generic debug: removing module "xcb_x11"
[0x8800c44] main video output debug: removing module "vout_wrapper"
[0x875d2a4] main blend debug: removing module "blend"
[0x880504c] main spu text debug: removing module "freetype"
[0x881259c] main scale debug: removing module "yuvp"
[0x88066a4] main scale debug: removing module "scale"
[0x888ddec] main playlist export debug: saving Media Library to file /home/rte/.local/share/vlc/ml.xspf
[0x888ddec] main playlist export debug: looking for playlist export module: 1 candidate
[0x888ddec] main playlist export debug: using playlist export module "export"
[0x888ddec] main playlist export debug: TIMER module_need() : 0.295 ms - Total 0.295 ms / 1 intvls (Avg 0.295 ms)
[0x888ddec] main playlist export debug: removing module "export"
[0x85d0d74] main playlist debug: Deactivated
[0x85288fc] main libvlc debug: removing all services discovery tasks
[0x85288fc] main libvlc debug: removing all interfaces
[0x85cad04] qt4 interface debug: Killing extension dialog provider
[0x85cad04] qt4 interface debug: ExtensionsDialogProvider is quitting...
[0x8712e24] lua generic debug: Deactivating all loaded extensions
[0x8712e24] lua generic debug: All extensions are now deactivated
[0x8712e24] main generic debug: removing module "lua"
[0x85cad04] main interface debug: removing module "qt4"
[0x85c439c] main interface debug: removing module "globalhotkeys"
[0x85bc124] main interface debug: removing module "signals"
[0x85d2d4c] main input debug: TIMER input launching for 'Formula.1.Gran.pri.Malazii.Kvalifik.2011.avi' : 45.968 ms - Total 45.968 ms / 1 intvls (Avg 45.968 ms)
[0x85c987c] main interface debug: removing module "inhibit"
[0x85cef0c] main interface debug: removing module "hotkeys"
[0x85d0d74] main playlist debug: destroying
[0x85288fc] main libvlc debug: TIMER ML Load : Total 4.040 ms / 1 intvls (Avg 4.040 ms)
[0x85288fc] main libvlc debug: TIMER Preparse run : Total 31.022 ms / 1 intvls (Avg 31.022 ms)
[0x85288fc] main libvlc debug: TIMER Items array build : Total 0.023 ms / 1 intvls (Avg 0.023 ms)
[0x85288fc] main libvlc debug: TIMER ML Dump : Total 0.401 ms / 1 intvls (Avg 0.401 ms)
[0x85288fc] main libvlc debug: removing stats
[0x85288fc] main libvlc debug: removing module "memcpymmxext"