Discussion:
[vlc] vlc stutters on 3.9 linux kernel
Grant
2013-03-13 07:20:51 UTC
Permalink
3.8 works great but vlc stutters a bit on 3.9. If I use jack the
sound is very bad like the CPU can't keep up but top shows 90% of the
CPU idle. If I don't use jack the sound is fine but I notice the
video stutters a bit. mplayer and mpd work fine.

- Grant
dE .
2013-03-18 14:55:59 UTC
Permalink
It can be that there's a mismatch between the userspace video drivers
and the kernel's DRM driver.

Which distro? In the preferences > video, set output to XVideo.

Which processor? Which chipset, which graphics card (if you have one)?
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack the
sound is very bad like the CPU can't keep up but top shows 90% of the
CPU idle. If I don't use jack the sound is fine but I notice the
video stutters a bit. mplayer and mpd work fine.
- Grant
______________________________________________________
vlc mailing list
http://mailman.videolan.org/listinfo/vlc
Grant
2013-03-18 19:42:40 UTC
Permalink
Post by dE .
It can be that there's a mismatch between the userspace video drivers
and the kernel's DRM driver.
I was on xf86-video-intel-2.20.13 and I just tried 2.21.4 and the
latest from git with the same result.
Post by dE .
Which distro? In the preferences > video, set output to XVideo.
It's Gentoo, 100% up-to-date. Changing to XVideo from Default doesn't
seem to make any difference.
Post by dE .
Which processor? Which chipset, which graphics card (if you have one)?
I'm on a Dell XPS 13 ultrabook with Intel Core i5-2467M and Intel HD
Graphics 3000.

- Grant
Post by dE .
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack the
sound is very bad like the CPU can't keep up but top shows 90% of the
CPU idle. If I don't use jack the sound is fine but I notice the
video stutters a bit. mplayer and mpd work fine.
- Grant
dE .
2013-03-19 04:00:01 UTC
Permalink
Post by Grant
Post by dE .
It can be that there's a mismatch between the userspace video drivers
and the kernel's DRM driver.
I was on xf86-video-intel-2.20.13 and I just tried 2.21.4 and the
latest from git with the same result.
Recompile it. How about it's USE?

Check glxgears.
Post by Grant
Post by dE .
Which distro? In the preferences > video, set output to XVideo.
It's Gentoo, 100% up-to-date. Changing to XVideo from Default doesn't
seem to make any difference.
How about bother drivers, specifically SDL?
Post by Grant
Post by dE .
Which processor? Which chipset, which graphics card (if you have one)?
I'm on a Dell XPS 13 ultrabook with Intel Core i5-2467M and Intel HD
Graphics 3000.
That processor is probably fast enough to decode video without
hardware assistance.

What about mplayer? How does it work?

Tried turning off hardware video decoding? (it'll increase the cpu
usage) Although, it's unlikely the problem.
Post by Grant
- Grant
Post by dE .
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack the
sound is very bad like the CPU can't keep up but top shows 90% of the
CPU idle. If I don't use jack the sound is fine but I notice the
video stutters a bit. mplayer and mpd work fine.
- Grant
______________________________________________________
vlc mailing list
http://mailman.videolan.org/listinfo/vlc
Grant
2013-04-22 00:59:24 UTC
Permalink
Post by dE .
Post by Grant
Post by dE .
It can be that there's a mismatch between the userspace video drivers
and the kernel's DRM driver.
I was on xf86-video-intel-2.20.13 and I just tried 2.21.4 and the
latest from git with the same result.
Recompile it. How about it's USE?
I've also tried 2.21.6 and recompiled vlc with the same result. Here
are the USE flags enabled on vlc:

X a52 aac alsa avcodec avformat cdda dbus dts dvbpsi dvd encode ffmpeg
flac fontconfig gcrypt jack libnotify mmx mp3 mpeg ncurses ogg opengl
png postproc qt4 sdl sse svg swscale truetype udev vaapi vorbis x264
xcb xml xv
Post by dE .
Post by Grant
Post by dE .
Which distro? In the preferences > video, set output to XVideo.
It's Gentoo, 100% up-to-date. Changing to XVideo from Default doesn't
seem to make any difference.
How about bother drivers, specifically SDL?
Same result from SDL.
Post by dE .
Post by Grant
Post by dE .
Which processor? Which chipset, which graphics card (if you have one)?
I'm on a Dell XPS 13 ultrabook with Intel Core i5-2467M and Intel HD
Graphics 3000.
That processor is probably fast enough to decode video without
hardware assistance.
What about mplayer? How does it work?
mplayer works perfectly with or without jack and vlc works perfectly
without jack. Video performance is perfect in vlc with or without
jack but audio is stuttery with jack. mpd also plays perfectly with
jack.
Post by dE .
Tried turning off hardware video decoding? (it'll increase the cpu
usage) Although, it's unlikely the problem.
Just tried it with the same result. Any other ideas?

- Grant
Post by dE .
Post by Grant
Post by dE .
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack the
sound is very bad like the CPU can't keep up but top shows 90% of the
CPU idle. If I don't use jack the sound is fine but I notice the
video stutters a bit. mplayer and mpd work fine.
- Grant
dE
2013-04-23 16:40:22 UTC
Permalink
Post by Grant
Post by dE .
Post by Grant
Post by dE .
It can be that there's a mismatch between the userspace video drivers
and the kernel's DRM driver.
I was on xf86-video-intel-2.20.13 and I just tried 2.21.4 and the
latest from git with the same result.
Recompile it. How about it's USE?
I've also tried 2.21.6 and recompiled vlc with the same result. Here
X a52 aac alsa avcodec avformat cdda dbus dts dvbpsi dvd encode ffmpeg
flac fontconfig gcrypt jack libnotify mmx mp3 mpeg ncurses ogg opengl
png postproc qt4 sdl sse svg swscale truetype udev vaapi vorbis x264
xcb xml xv
Post by dE .
Post by Grant
Post by dE .
Which distro? In the preferences > video, set output to XVideo.
It's Gentoo, 100% up-to-date. Changing to XVideo from Default doesn't
seem to make any difference.
How about bother drivers, specifically SDL?
Same result from SDL.
Post by dE .
Post by Grant
Post by dE .
Which processor? Which chipset, which graphics card (if you have one)?
I'm on a Dell XPS 13 ultrabook with Intel Core i5-2467M and Intel HD
Graphics 3000.
That processor is probably fast enough to decode video without
hardware assistance.
What about mplayer? How does it work?
mplayer works perfectly with or without jack and vlc works perfectly
without jack. Video performance is perfect in vlc with or without
jack but audio is stuttery with jack. mpd also plays perfectly with
jack.
Post by dE .
Tried turning off hardware video decoding? (it'll increase the cpu
usage) Although, it's unlikely the problem.
Just tried it with the same result. Any other ideas?
- Grant
Post by dE .
Post by Grant
Post by dE .
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack the
sound is very bad like the CPU can't keep up but top shows 90% of the
CPU idle. If I don't use jack the sound is fine but I notice the
video stutters a bit. mplayer and mpd work fine.
- Grant
You're STILL having that problem?

Since VLC's video rendering is different from mplayer, it might be
triggering a bug in this particular kernel.

How about compiling with --

X a52 aac aalib alsa avcodec avformat dbus dirac dts dvbpsi dvd
elibc_glibc ffmpeg flac libass libsamplerate matroska mmx mp3 mpeg
musepack ogg opengl png qt4 schroedinger sdl sdl-image sid speex sse svg
swscale taglib theora truetype twolame udev vorbis x264 xcb xv

Also run VLC with

vlc --verbose 2147483647

Check it out yourself and attach it here.
Grant
2013-04-23 22:51:03 UTC
Permalink
Post by dE
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack the
sound is very bad like the CPU can't keep up but top shows 90% of the
CPU idle. If I don't use jack the sound is fine but I notice the
video stutters a bit. mplayer and mpd work fine.
- Grant
You're STILL having that problem?
Yes, I just tried 3.9-rc8 but the problem persists.
Post by dE
Since VLC's video rendering is different from mplayer, it might be
triggering a bug in this particular kernel.
How about compiling with --
X a52 aac aalib alsa avcodec avformat dbus dirac dts dvbpsi dvd elibc_glibc
ffmpeg flac libass libsamplerate matroska mmx mp3 mpeg musepack ogg opengl
png qt4 schroedinger sdl sdl-image sid speex sse svg swscale taglib theora
truetype twolame udev vorbis x264 xcb xv
Just tried that but same result.
Post by dE
Also run VLC with
vlc --verbose 2147483647
Check it out yourself and attach it here.
I've attached it. I think the problem is here:

[0x7f2ba4000958] main audio output warning: PTS is out of range
(-9941), dropping buffer
[0x7f2ba4000958] main audio output warning: PTS is out of range
(-33889), dropping buffer
[0x7f2ba40030e8] mpgatofixed32 audio filter debug: libmad error: bad
main_data_begin pointer
[0x7f2ba4000958] main audio output warning: audio output out of sync,
adjusting dates (70832 us)
[0x7f2bac06ca68] main video output debug: picture might be displayed
late (missing 10 ms)
[0x7f2ba4000958] main audio output warning: not synchronized (70834
us), resampling
[0x7f2ba4000958] main audio output warning: buffer too late (70417),
up-sampling
[0x7f2ba4000958] main audio output debug: audio output is starving
(-89164), playing silence
[0x7f2ba4000958] main audio output debug: audio output is starving
(-68444), playing silence

- Grant
-------------- next part --------------
[0x19dd138] main libvlc debug: VLC media player - 2.0.5 Twoflower
[0x19dd138] main libvlc debug: Copyright ? 1996-2012 VLC authors and VideoLAN
[0x19dd138] main libvlc debug: revision 2.0.5-0-g1661b7d
[0x19dd138] main libvlc debug: configured with ./configure '--prefix=/usr' '--build=x86_64-pc-linux-gnu' '--host=x86_64-pc-linux-gnu' '--mandir=/usr/share/man' '--infodir=/usr/share/info' '--datadir=/usr/share' '--sysconfdir=/etc' '--localstatedir=/var/lib' '--libdir=/usr/lib64' '--disable-dependency-tracking' '--docdir=/usr/share/doc/vlc-2.0.5' '--enable-a52' '--enable-aa' '--enable-faad' '--enable-alsa' '--disable-altivec' '--disable-atmo' '--disable-audioqueue' '--disable-bonjour' '--enable-avcodec' '--enable-avformat' '--disable-fribidi' '--disable-bluray' '--enable-vcd' '--disable-libcddb' '--enable-dbus' '--enable-dbus-control' '--enable-dirac' '--disable-direct2d' '--disable-directfb' '--disable-directx' '--disable-dc1394' '--disable-debug' '--disable-dshow' '--enable-dca' '--enable-dvbpsi' '--enable-dvdread' '--enable-dvdnav' '--disable-dxva2' '--disable-egl' '--enable-sout' '--disable-fbosd' '--enable-flac' '--disable-fluidsynth' '--enable-fontconfig' '--enable-libgcrypt' '--disable-gme' '--disable-gnomevfs' '--disable-gnutls' '--disable-growl' '--disable-httpd' '--disable-dv' '--disable-ios-vout' '--enable-jack' '--disable-kate' '--without-kde-solid' '--enable-libass' '--disable-caca' '--enable-notify' '--disable-libproxy' '--enable-samplerate' '--disable-libtar' '--disable-tiger' '--disable-linsys' '--disable-lirc' '--disable-live555' '--disable-lua' '--disable-macosx-audio' '--disable-macosx-dialog-provider' '--disable-macosx-eyetv' '--disable-macosx-qtkit' '--disable-macosx-quartztext' '--disable-macosx-vout' '--enable-mkv' '--disable-media-library' '--enable-mmx' '--disable-mod' '--enable-mad' '--enable-libmpeg2' '--disable-mtp' '--enable-mpc' '--enable-ncurses' '--disable-neon' '--enable-ogg' '--enable-mux_ogg' '--disable-omxil' '--enable-glx' '--disable-opus' '--disable-optimize-memory' '--disable-oss' '--enable-png' '--disable-portaudio' '--enable-postproc' '--disable-projectm' '--disable-pulse' '--disable-pvr' '--enable-qt4' '--disable-realrtsp' '--disable-run-as-root' '--disable-smb' '--enable-schroedinger' '--enable-sdl' '--enable-sdl-image' '--disable-shine' '--enable-sid' '--disable-shout' '--disable-skins2' '--enable-speex' '--disable-sqlite' '--enable-sse' '--enable-svg' '--disable-switcher' '--enable-swscale' '--enable-taglib' '--enable-theora' '--enable-freetype' '--enable-twolame' '--enable-udev' '--disable-upnp' '--disable-v4l2' '--enable-libva' '--disable-vcdx' '--disable-vlm' '--enable-vorbis' '--disable-waveout' '--disable-loader' '--disable-wingdi' '--disable-wma-fixed' '--with-x' '--enable-x264' '--enable-xcb' '--enable-libxml2' '--disable-xosd' '--enable-xvideo' '--disable-zvbi' '--enable-telx' '--disable-optimizations' '--without-tuning' '--enable-fast-install' 'build_alias=x86_64-pc-linux-gnu' 'host_alias=x86_64-pc-linux-gnu' 'CFLAGS=-march=native -O2 -pipe -fomit-frame-pointer' 'LDFLAGS=-Wl,-O1 -Wl,--as-needed -L/usr/lib64/sidplay/builders/' 'CXXFLAGS=-march=native -O2 -pipe -fomit-frame-pointer' 'PKG_CONFIG_PATH=/usr/lib64/pkgconfig'
[0x19dd138] main libvlc debug: searching plug-in modules
[0x19dd138] main libvlc debug: loading plugins cache file /usr/lib64/vlc/plugins/plugins.dat
[0x19dd138] main libvlc debug: recursively browsing `/usr/lib64/vlc/plugins'
[0x19dd138] main libvlc debug: saving plugins cache /usr/lib64/vlc/plugins/plugins.dat
[0x19dd138] main libvlc debug: plug-ins loaded: 370 modules
[0x19dd138] main libvlc debug: opening config file (/home/grant/.config/vlc/vlcrc)
[0x19dd138] main libvlc debug: translation test: code is "C"
[0x19dd138] main libvlc debug: CPU has capabilities MMX MMXEXT SSE SSE2 SSE3 SSSE3 SSE4.1 SSE4.2 FPU
[0x19dd138] main libvlc debug: looking for memcpy module: 4 candidates
[0x19dd138] main libvlc debug: using memcpy module "memcpymmxext"
[0x1aa6408] main input debug: Creating an input for 'Media Library'
[0x1aa6408] main input debug: Input is a meta file: disabling unneeded options
[0x1aa6408] main input debug: using timeshift granularity of 50 MiB, in path '/tmp'
[0x1aa6408] main input debug: `file/xspf-open:///home/grant/.local/share/vlc/ml.xspf' gives access `file' demux `xspf-open' path `/home/grant/.local/share/vlc/ml.xspf'
[0x1aa6408] main input debug: creating demux: access='file' demux='xspf-open' location='/home/grant/.local/share/vlc/ml.xspf' file='/home/grant/.local/share/vlc/ml.xspf'
[0x1a95918] main demux debug: looking for access_demux module: 2 candidates
[0x1a95918] main demux debug: no access_demux module matching "file" could be loaded
[0x1a95918] main demux debug: TIMER module_need() : 0.373 ms - Total 0.373 ms / 1 intvls (Avg 0.373 ms)
[0x1aa6408] main input debug: creating access 'file' location='/home/grant/.local/share/vlc/ml.xspf', path='/home/grant/.local/share/vlc/ml.xspf'
[0x1a966c8] main access debug: looking for access module: 2 candidates
[0x1a966c8] filesystem access debug: opening file `/home/grant/.local/share/vlc/ml.xspf'
[0x1a966c8] main access debug: using access module "filesystem"
[0x1a966c8] main access debug: TIMER module_need() : 0.204 ms - Total 0.204 ms / 1 intvls (Avg 0.204 ms)
[0x1a97698] main stream debug: Using stream method for AStream*
[0x1a97698] main stream debug: starting pre-buffering
[0x1a97698] main stream debug: received first data after 0 ms
[0x1a97698] main stream debug: pre-buffering done 296 bytes in 0s - 18066 KiB/s
[0x1a978f8] main stream debug: looking for stream_filter module: 7 candidates
[0x1a978f8] main stream debug: no stream_filter module matching "any" could be loaded
[0x1a978f8] main stream debug: TIMER module_need() : 1.945 ms - Total 1.945 ms / 1 intvls (Avg 1.945 ms)
[0x1a978f8] main stream debug: looking for stream_filter module: 1 candidate
[0x1a978f8] main stream debug: using stream_filter module "stream_filter_record"
[0x1a978f8] main stream debug: TIMER module_need() : 0.146 ms - Total 0.146 ms / 1 intvls (Avg 0.146 ms)
[0x1aa6408] main input debug: creating demux: access='file' demux='xspf-open' location='/home/grant/.local/share/vlc/ml.xspf' file='/home/grant/.local/share/vlc/ml.xspf'
[0x1a9f2b8] main demux debug: looking for demux module: 1 candidate
[0x1a9f2b8] playlist demux debug: using XSPF playlist reader
[0x1a9f2b8] main demux debug: using demux module "playlist"
[0x1a9f2b8] main demux debug: TIMER module_need() : 0.183 ms - Total 0.183 ms / 1 intvls (Avg 0.183 ms)
[0x1a994e8] main demux meta debug: looking for meta reader module: 1 candidate
[0x1a994e8] main demux meta debug: no meta reader module matching "any" could be loaded
[0x1a994e8] main demux meta debug: TIMER module_need() : 1.379 ms - Total 1.379 ms / 1 intvls (Avg 1.379 ms)
[0x1aa6408] main input debug: `file/xspf-open:///home/grant/.local/share/vlc/ml.xspf' successfully opened
[0x1aa9728] main xml reader debug: looking for xml reader module: 1 candidate
[0x1aa9728] main xml reader debug: using xml reader module "xml"
[0x1aa9728] main xml reader debug: TIMER module_need() : 0.617 ms - Total 0.617 ms / 1 intvls (Avg 0.617 ms)
[0x1a9f2b8] playlist demux debug: parsed 0 tracks successfully
[0x1aa6408] main input debug: EOF reached
[0x1a9f2b8] main demux debug: removing module "playlist"
[0x1a978f8] main stream debug: removing module "stream_filter_record"
[0x1a966c8] main access debug: removing module "filesystem"
[0x1aa6408] main input debug: TIMER input launching for 'Media Library' : 4.741 ms - Total 4.741 ms / 1 intvls (Avg 4.741 ms)
[0x1ab2d08] main interface debug: looking for interface module: 1 candidate
[0x1ab2d08] main interface debug: using interface module "hotkeys"
[0x1ab2d08] main interface debug: TIMER module_need() : 0.156 ms - Total 0.156 ms / 1 intvls (Avg 0.156 ms)
[0x1aa6408] main interface debug: looking for interface module: 1 candidate
[0x1aa8028] main playlist debug: playlist threads correctly activated
[0x1aa6408] main interface debug: using interface module "inhibit"
[0x1aa8028] main playlist debug: rebuilding array of current - root Playlist
[0x1aa6408] main interface debug: TIMER module_need() : 0.750 ms - Total 0.750 ms / 1 intvls (Avg 0.750 ms)
[0x1aa8028] main playlist debug: rebuild done - 0 items, index -1
[0x1aa8028] main playlist debug: adding item `S09E01-They Came at Us with Spears!.avi' ( file:///home/grant/Downloads/SURVIVOR/S09-%20Vanuatu/S09E01-They%20Came%20at%20Us%20with%20Spears%21.avi )
[0x7f2bbc000a28] main input debug: Creating an input for 'S09E01-They Came at Us with Spears!.avi'
[0x1a94758] main interface debug: looking for interface module: 1 candidate
[0x1a94758] main interface debug: using interface module "globalhotkeys"
[0x1a94758] main interface debug: TIMER module_need() : 0.868 ms - Total 0.868 ms / 1 intvls (Avg 0.868 ms)
[0x19dd138] main libvlc: Running vlc with the default interface. Use 'cvlc' to use vlc without interface.
[0x1a94098] main interface debug: looking for interface module: 3 candidates
[0x1aa8028] main playlist debug: no fetch required for (null) (art currently (null))
[0x7f2bb80d62e8] main generic debug: looking for extension module: 0 candidates
[0x7f2bb80d62e8] main generic debug: no extension module matched "any"
[0x7f2bb80d62e8] main generic debug: TIMER module_need() : 0.129 ms - Total 0.129 ms / 1 intvls (Avg 0.129 ms)
[0x1a94098] qt4 interface error: Unable to load extensions module
[0x1a94098] main interface debug: using interface module "qt4"
[0x1a94098] main interface debug: TIMER module_need() : 81.805 ms - Total 81.805 ms / 1 intvls (Avg 81.805 ms)
[0x1aa8028] main playlist debug: rebuilding array of current - root Playlist
[0x1aa8028] main playlist debug: rebuild done - 1 items, index -1
[0x1aa8028] main playlist debug: processing request item: null, node: Playlist, skip: 0
[0x1aa8028] main playlist debug: starting playback of the new playlist item
[0x1aa8028] main playlist debug: resyncing on S09E01-They Came at Us with Spears!.avi
[0x1aa8028] main playlist debug: S09E01-They Came at Us with Spears!.avi is at 0
[0x1aa8028] main playlist debug: creating new input thread
[0x7f2bc4000b78] main input debug: Creating an input for 'S09E01-They Came at Us with Spears!.avi'
[0x7f2bc4000b78] main input debug: using timeshift granularity of 50 MiB, in path '/tmp'
[0x7f2bc4000b78] main input debug: `file:///home/grant/Downloads/SURVIVOR/S09-%20Vanuatu/S09E01-They%20Came%20at%20Us%20with%20Spears%21.avi' gives access `file' demux `' path `/home/grant/Downloads/SURVIVOR/S09-%20Vanuatu/S09E01-They%20Came%20at%20Us%20with%20Spears%21.avi'
[0x7f2bc4000b78] main input debug: creating demux: access='file' demux='' location='/home/grant/Downloads/SURVIVOR/S09-%20Vanuatu/S09E01-They%20Came%20at%20Us%20with%20Spears%21.avi' file='/home/grant/Downloads/SURVIVOR/S09- Vanuatu/S09E01-They Came at Us with Spears!.avi'
[0x7f2bbc001588] main demux debug: looking for access_demux module: 2 candidates
[0x7f2bbc001588] main demux debug: no access_demux module matching "file" could be loaded
[0x7f2bbc001588] main demux debug: TIMER module_need() : 0.179 ms - Total 0.179 ms / 1 intvls (Avg 0.179 ms)
[0x7f2bc4000b78] main input debug: creating access 'file' location='/home/grant/Downloads/SURVIVOR/S09-%20Vanuatu/S09E01-They%20Came%20at%20Us%20with%20Spears%21.avi', path='/home/grant/Downloads/SURVIVOR/S09- Vanuatu/S09E01-They Came at Us with Spears!.avi'
[0x7f2bbc004138] main access debug: looking for access module: 2 candidates
[0x7f2bbc004138] filesystem access debug: opening file `/home/grant/Downloads/SURVIVOR/S09- Vanuatu/S09E01-They Came at Us with Spears!.avi'
[0x7f2bbc004138] main access debug: using access module "filesystem"
[0x7f2bbc004138] main access debug: TIMER module_need() : 0.141 ms - Total 0.141 ms / 1 intvls (Avg 0.141 ms)
[0x7f2bbc001858] main stream debug: Using stream method for AStream*
[0x7f2bbc001858] main stream debug: starting pre-buffering
[0x7f2bbc001858] main stream debug: received first data after 0 ms
[0x7f2bbc001858] main stream debug: pre-buffering done 1024 bytes in 0s - 38461 KiB/s
[0x7f2bbc001588] main stream debug: looking for stream_filter module: 7 candidates
[0x7f2bbc001588] main stream debug: no stream_filter module matching "any" could be loaded
[0x7f2bbc001588] main stream debug: TIMER module_need() : 0.121 ms - Total 0.121 ms / 1 intvls (Avg 0.121 ms)
[0x7f2bbc001588] main stream debug: looking for stream_filter module: 1 candidate
[0x7f2bbc001588] main stream debug: using stream_filter module "stream_filter_record"
[0x7f2bbc001588] main stream debug: TIMER module_need() : 0.088 ms - Total 0.088 ms / 1 intvls (Avg 0.088 ms)
[0x7f2bc4000b78] main input debug: creating demux: access='file' demux='' location='/home/grant/Downloads/SURVIVOR/S09-%20Vanuatu/S09E01-They%20Came%20at%20Us%20with%20Spears%21.avi' file='/home/grant/Downloads/SURVIVOR/S09- Vanuatu/S09E01-They Came at Us with Spears!.avi'
[0x7f2bbc003eb8] main demux debug: looking for demux module: 51 candidates
[0x7f2bbc001588] avi stream debug: <list 'AVI '>
[0x7f2bbc001588] avi stream debug: <list 'hdrl'>
[0x7f2bbc001588] avi stream debug: <list 'strl'>
[0x7f2bbc001588] avi stream debug: </list 'strl'>
[0x7f2bbc001588] avi stream debug: <list 'strl'>
[0x7f2bbc001588] avi stream debug: </list 'strl'>
[0x7f2bbc001588] avi stream debug: <list 'odml'>
[0x7f2bbc001588] avi stream warning: unknown chunk (not loaded)
[0x7f2bbc001588] avi stream debug: </list 'odml'>
[0x7f2bbc001588] avi stream debug: </list 'hdrl'>
[0x7f2bbc001588] avi stream debug: <list 'INFO'>
[0x7f2bbc001588] avi stream debug: </list 'INFO'>
[0x7f2bbc001588] avi stream debug: skipping movi chunk
[0x7f2bbc001588] avi stream debug: </list 'AVI '>
[0x7f2bbc001588] avi stream debug: * LIST-root size:366702592 pos:0
[0x7f2bbc001588] avi stream debug: + RIFF-AVI size:366701028 pos:0
[0x7f2bbc001588] avi stream debug: | + LIST-hdrl size:8830 pos:12
[0x7f2bbc001588] avi stream debug: | | + avih size:56 pos:24
[0x7f2bbc001588] avi stream debug: | | + LIST-strl size:4244 pos:88
[0x7f2bbc001588] avi stream debug: | | | + strh size:56 pos:100
[0x7f2bbc001588] avi stream debug: | | | + strf size:40 pos:164
[0x7f2bbc001588] avi stream debug: | | | + JUNK size:4120 pos:212
[0x7f2bbc001588] avi stream debug: | | + LIST-strl size:4234 pos:4340
[0x7f2bbc001588] avi stream debug: | | | + strh size:56 pos:4352
[0x7f2bbc001588] avi stream debug: | | | + strf size:30 pos:4416
[0x7f2bbc001588] avi stream debug: | | | + JUNK size:4120 pos:4454
[0x7f2bbc001588] avi stream debug: | | + LIST-odml size:260 pos:8582
[0x7f2bbc001588] avi stream debug: | | | + dmlh size:248 pos:8594
[0x7f2bbc001588] avi stream debug: | + LIST-INFO size:28 pos:8850
[0x7f2bbc001588] avi stream debug: | | + ISFT size:15 pos:8862
[0x7f2bbc001588] avi stream debug: | + JUNK size:1346 pos:8886
[0x7f2bbc001588] avi stream debug: | + LIST-movi size:363688204 pos:10240
[0x7f2bbc001588] avi stream debug: | + idx1 size:3002576 pos:363698452
[0x7f2bbc001588] avi stream debug: + JUNK size:1548 pos:366701036
[0x7f2bbc003eb8] avi demux debug: AVIH: 2 stream, flags HAS_INDEX IS_INTERLEAVED
[0x7f2bbc003eb8] avi demux debug: stream[0] rate:2997 scale:100 samplesize:0
[0x7f2bbc003eb8] avi demux debug: stream[0] video(XVID) 512x384 12bpp 29.969999fps
[0x7f2bc4000b78] main input debug: selecting program id=0
[0x7f2bbc003eb8] avi demux debug: stream[1] rate:48000 scale:1152 samplesize:0
[0x7f2bbc003eb8] avi demux debug: stream[1] audio(0x55 - MPEG Audio layer 1/2/3) 2 channels 48000Hz 0bits
[0x7f2bbc003eb8] avi demux debug: selected standard index for stream[0]
[0x7f2bbc003eb8] avi demux debug: selected standard index for stream[1]
[0x7f2bbc003eb8] avi demux debug: stream[0] created 78510 index entries
[0x7f2bbc003eb8] avi demux debug: stream[1] created 109151 index entries
[0x7f2bbc003eb8] avi demux debug: stream[0] length:2619 (based on index)
[0x7f2bbc003eb8] avi demux debug: stream[1] length:2619 (based on index)
[0x7f2bbc003eb8] main demux debug: using demux module "avi"
[0x7f2bbc003eb8] main demux debug: TIMER module_need() : 16.027 ms - Total 16.027 ms / 1 intvls (Avg 16.027 ms)
[0x7f2bc4000b78] main input debug: looking for a subtitle file in /home/grant/Downloads/SURVIVOR/S09- Vanuatu/
[0x7f2bbcc048f8] main decoder debug: looking for decoder module: 29 candidates
[0x7f2bbcc048f8] avcodec decoder debug: libavcodec initialized (interface 0x353d64)
[0x7f2bbcc048f8] avcodec decoder debug: trying to use direct rendering
[0x7f2bbcc048f8] avcodec decoder debug: allowing 1 thread(s) for decoding
[0x7f2bbcc048f8] avcodec decoder debug: ffmpeg codec (MPEG-4 Video) started
[0x7f2bbcc048f8] main decoder debug: using decoder module "avcodec"
[0x7f2bbcc048f8] main decoder debug: TIMER module_need() : 6.398 ms - Total 6.398 ms / 1 intvls (Avg 6.398 ms)
[0x7f2bbcc06008] main decoder debug: looking for decoder module: 29 candidates
[0x7f2bbcc06008] main decoder debug: using decoder module "mpeg_audio"
[0x7f2bbcc06008] main decoder debug: TIMER module_need() : 0.143 ms - Total 0.143 ms / 1 intvls (Avg 0.143 ms)
[0x7f2bbcc06df8] main demux meta debug: looking for meta reader module: 1 candidate
[0x7f2bbcc06df8] main demux meta debug: no meta reader module matching "any" could be loaded
[0x7f2bbcc06df8] main demux meta debug: TIMER module_need() : 0.085 ms - Total 0.085 ms / 1 intvls (Avg 0.085 ms)
[0x7f2bc4000b78] main input debug: `file:///home/grant/Downloads/SURVIVOR/S09-%20Vanuatu/S09E01-They%20Came%20at%20Us%20with%20Spears%21.avi' successfully opened
[0x7f2bc4000b78] main input debug: Buffering 0%
[0x7f2bc4000b78] main input debug: Buffering 8%
[0x7f2bbcc06008] mpeg_audio decoder debug: MPGA channels:2 samplerate:48000 bitrate:128
[0x1aa8028] main playlist debug: creating audio output
[0x7f2bc4000b78] main input debug: Buffering 16%
[0x7f2bc4000b78] main input debug: Buffering 25%
[0x7f2bc4000b78] main input debug: Buffering 33%
[0x7f2bc4000b78] main input debug: Buffering 41%
[0x7f2bc4000b78] main input debug: Buffering 50%
[0x7f2ba4000958] main audio output debug: looking for audio output module: 2 candidates
[0x7f2bc4000b78] main input debug: Buffering 58%
[0x7f2bc4000b78] main input debug: Buffering 66%
[0x7f2bc4000b78] main input debug: Buffering 75%
[0x7f2bac06de28] main spu text debug: looking for text renderer module: 3 candidates
[0x7f2bc4000b78] main input debug: Buffering 83%
[0x7f2bc4000b78] main input debug: Buffering 91%
[0x7f2bc4000b78] main input debug: Buffering 100%
[0x7f2bc4000b78] main input debug: Stream buffering done (325 ms in 0 ms)
[0x7f2bac06de28] freetype spu text debug: Building font databases.
[0x7f2bac06de28] freetype spu text debug: Took 0 microseconds
[0x7f2bac06de28] freetype spu text debug: Using DejaVu Sans as font from file /usr/share/fonts/dejavu/DejaVuSans.ttf
[0x7f2bac06de28] freetype spu text debug: using fontsize: 2
[0x7f2bac06de28] main spu text debug: using text renderer module "freetype"
[0x7f2bac06de28] main spu text debug: TIMER module_need() : 1.967 ms - Total 1.967 ms / 1 intvls (Avg 1.967 ms)
[0x7f2bac06f128] main scale debug: looking for video filter2 module: 18 candidates
[0x7f2bac06f128] swscale scale debug: 32x32 chroma: YUVA -> 16x16 chroma: RGBA with scaling using Bicubic (good quality)
[0x7f2bac06f128] main scale debug: using video filter2 module "swscale"
[0x7f2bac06f128] main scale debug: TIMER module_need() : 0.796 ms - Total 0.796 ms / 1 intvls (Avg 0.796 ms)
[0x7f2bac077518] main scale debug: looking for video filter2 module: 18 candidates
[0x7f2bac077518] yuvp scale debug: YUVP to YUVA converter
[0x7f2bac077518] main scale debug: using video filter2 module "yuvp"
[0x7f2bac077518] main scale debug: TIMER module_need() : 0.713 ms - Total 0.713 ms / 1 intvls (Avg 0.713 ms)
[0x7f2bac06ca68] main video output debug: Deinterlacing available
[0x7f2bac06ca68] main video output debug: deinterlace 0, mode blend, is_needed 0
[0x7f2bac06ca68] main video output debug: Opening vout display wrapper
[0x7f2ba0001268] main vout display debug: looking for vout display module: 5 candidates
[0x7f2ba0006bf8] main window debug: looking for vout window xid module: 3 candidates
[0x7f2ba0006bf8] qt4 window debug: requesting video...
[0x7f2ba4000958] jack audio output debug: JACK graph reordered. Our maximum latency=0.
[0x7f2ba4000958] jack audio output debug: JACK graph reordered. Our maximum latency=0.
[0x7f2ba4000958] jack audio output debug: connecting port vlc_15103:out_1 to port system:playback_1
[0x7f2ba4000958] jack audio output debug: JACK graph reordered. Our maximum latency=0.
[0x7f2ba4000958] jack audio output debug: connecting port vlc_15103:out_2 to port system:playback_2
[0x7f2ba4000958] jack audio output debug: JACK audio output initialized (2 channels, rate=48000)
[0x7f2ba4000958] main audio output debug: using audio output module "jack"
[0x7f2ba4000958] main audio output debug: TIMER module_need() : 5.378 ms - Total 5.378 ms / 1 intvls (Avg 5.378 ms)
[0x7f2ba4000958] main audio output debug: output 'f32l' 48000 Hz Stereo frame=1 samples/8 bytes
[0x7f2ba4000958] main audio output debug: mixer 'f32l' 48000 Hz Stereo frame=1 samples/8 bytes
[0x7f2ba4000958] main audio output debug: filter(s) 'f32l'->'f32l' 48000 Hz->48000 Hz Stereo->Stereo
[0x7f2ba4000958] main audio output debug: conversion pipeline completed
[0x7f2ba4005948] main mixer debug: looking for audio mixer module: 2 candidates
[0x7f2ba4005948] main mixer debug: using audio mixer module "float32_mixer"
[0x7f2ba4005948] main mixer debug: TIMER module_need() : 0.149 ms - Total 0.149 ms / 1 intvls (Avg 0.149 ms)
[0x7f2ba4000958] main audio output debug: input 'mpga' 48000 Hz Stereo frame=1152 samples/969 bytes
[0x7f2ba4000958] main audio output debug: filter(s) 'mpga'->'f32l' 48000 Hz->48000 Hz Stereo->Stereo
[0x7f2ba40030e8] main audio filter debug: looking for audio filter module: 13 candidates
[0x7f2ba40030e8] mpgatofixed32 audio filter debug: mpga->f32l, bits per sample: 32
[0x7f2ba40030e8] main audio filter debug: using audio filter module "mpgatofixed32"
[0x7f2ba40030e8] main audio filter debug: TIMER module_need() : 0.248 ms - Total 0.248 ms / 1 intvls (Avg 0.248 ms)
[0x7f2ba4000958] main audio output debug: conversion pipeline completed
[0x7f2ba4000958] main audio output debug: filter(s) 'f32l'->'f32l' 52800 Hz->48000 Hz Stereo->Stereo
[0x7f2ba4003ef8] main audio filter debug: looking for audio filter module: 13 candidates
[0x7f2ba4003ef8] main audio filter debug: using audio filter module "samplerate"
[0x7f2ba4003ef8] main audio filter debug: TIMER module_need() : 0.519 ms - Total 0.519 ms / 1 intvls (Avg 0.519 ms)
[0x7f2ba4000958] main audio output debug: conversion pipeline completed
[0x7f2bbcc06008] main decoder debug: End of audio preroll
[0x1a94098] qt4 interface debug: IM: Setting an input
[0x1a94098] qt4 interface debug: Video was requested 0, 0
[0x7f2ba0006bf8] main window debug: using vout window xid module "qt4"
[0x7f2ba0006bf8] main window debug: TIMER module_need() : 24.620 ms - Total 24.620 ms / 1 intvls (Avg 24.620 ms)
[0x7f2ba0006ee8] main inhibit debug: looking for inhibit module: 2 candidates
[0x7f2ba0006ee8] main inhibit debug: using inhibit module "xdg_screensaver"
[0x7f2ba0006ee8] main inhibit debug: TIMER module_need() : 0.321 ms - Total 0.321 ms / 1 intvls (Avg 0.321 ms)
[0x7f2ba0006ee8] xdg_screensaver inhibit debug: started xdg-screensaver (PID = 15115)
[0x7f2ba0001268] xcb_xv vout display debug: connected to X11.0 server
[0x7f2ba0001268] xcb_xv vout display debug: vendor : The X.Org Foundation
[0x7f2ba0001268] xcb_xv vout display debug: version: 11304000
[0x7f2ba0001268] xcb_xv vout display debug: using screen 0xd6
[0x7f2ba0001268] xcb_xv vout display debug: using XVideo extension v2.2
[0x7f2ba0001268] xcb_xv vout display debug: using adaptor Intel(R) Textured Video
[0x7f2ba0001268] xcb_xv vout display debug: using port 95
[0x7f2ba0001268] xcb_xv vout display debug: using image format 0x30323449
[0x7f2ba0001268] xcb_xv vout display debug: using X11 visual ID 0x20 (depth: 24)
[0x7f2ba0001268] xcb_xv vout display debug: using X11 window 0x03c00000
[0x7f2ba0001268] xcb_xv vout display debug: using X11 graphic context 0x03c00002
[0x7f2ba0001268] main vout display debug: VoutDisplayEvent 'fullscreen' 0
[0x7f2ba0001268] main vout display debug: VoutDisplayEvent 'resize' 512x384 window
[0x7f2ba0001268] main vout display debug: using vout display module "xcb_xv"
[0x7f2ba0001268] main vout display debug: TIMER module_need() : 42.598 ms - Total 42.598 ms / 1 intvls (Avg 42.598 ms)
[0x7f2bac06ca68] main video output debug: original format sz 512x384, of (0,0), vsz 512x384, 4cc I420, sar 1:1, msk r0x0 g0x0 b0x0
[0x7f2bac06de28] main spu text debug: removing module "freetype"
[0x7f2bac06de28] main spu text debug: looking for text renderer module: 3 candidates
[0x7f2bac06de28] freetype spu text debug: Building font databases.
[0x7f2bac06de28] freetype spu text debug: Took 0 microseconds
[0x7f2bac06de28] freetype spu text debug: Using DejaVu Sans as font from file /usr/share/fonts/dejavu/DejaVuSans.ttf
[0x7f2bac06de28] freetype spu text debug: using fontsize: 2
[0x7f2bac06de28] main spu text debug: using text renderer module "freetype"
[0x7f2bac06de28] main spu text debug: TIMER module_need() : 0.905 ms - Total 0.905 ms / 1 intvls (Avg 0.905 ms)
[0x7f2bbcc048f8] avcodec decoder debug: using direct rendering
[0x7f2bbcc048f8] main decoder debug: End of video preroll
[0x7f2bbcc048f8] main decoder debug: Received first picture
[0x7f2ba000df58] main blend debug: looking for video blending module: 1 candidate
[0x7f2ba000df58] main blend debug: using video blending module "blend"
[0x7f2ba000df58] main blend debug: TIMER module_need() : 0.265 ms - Total 0.265 ms / 1 intvls (Avg 0.265 ms)
[0x7f2bac06ca68] main video output debug: Post-processing available
[0x7f2ba0001268] xcb_xv vout display debug: display is visible
[0x7f2bc4000b78] main input debug: Decoder buffering done in 69 ms
[0x7f2ba4000958] main audio output warning: PTS is out of range (-9941), dropping buffer
[0x7f2ba4000958] main audio output warning: PTS is out of range (-33889), dropping buffer
[0x7f2ba40030e8] mpgatofixed32 audio filter debug: libmad error: bad main_data_begin pointer
[0x7f2ba4000958] main audio output warning: audio output out of sync, adjusting dates (70832 us)
[0x7f2bac06ca68] main video output debug: picture might be displayed late (missing 10 ms)
[0x7f2ba4000958] main audio output warning: not synchronized (70834 us), resampling
[0x7f2ba4000958] main audio output warning: buffer too late (70417), up-sampling
[0x7f2ba4000958] main audio output debug: audio output is starving (-89164), playing silence
[0x7f2ba4000958] main audio output debug: audio output is starving (-68444), playing silence
[0x7f2ba4000958] main audio output warning: audio output out of sync, adjusting dates (84967 us)
[0x7f2ba4000958] main audio output warning: not synchronized (84967 us), resampling
[0x7f2ba4000958] main audio output warning: timing screwed, stopping resampling
[0x7f2ba4000958] main audio output debug: audio output is starving (-88749), playing silence
[0x7f2ba4000958] main audio output warning: buffer too late (155280), up-sampling
[0x7f2ba4000958] main audio output warning: audio output out of sync, adjusting dates (85681 us)
[0x7f2ba4000958] main audio output warning: not synchronized (85681 us), resampling
[0x7f2ba4000958] main audio output warning: buffer way too late (240961), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-89064), playing silence
[0x7f2ba4000958] main audio output warning: buffer way too late (216961), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-68426), playing silence
[0x7f2ba4000958] main audio output warning: buffer way too late (192961), dropping buffer
[0x7f2ba40030e8] mpgatofixed32 audio filter debug: libmad error: bad main_data_begin pointer
[0x7f2ba4000958] main audio output warning: audio output out of sync, adjusting dates (64067 us)
[0x7f2ba4000958] main audio output warning: not synchronized (64067 us), resampling
[0x7f2ba4000958] main audio output warning: buffer way too late (233007), dropping buffer
[0x7f2ba4000958] main audio output warning: buffer way too late (209007), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-89786), playing silence
[0x7f2ba4000958] main audio output warning: buffer way too late (185007), dropping buffer
[0x7f2ba40030e8] mpgatofixed32 audio filter debug: libmad error: bad main_data_begin pointer
[0x7f2ba4000958] main audio output debug: audio output is starving (-68517), playing silence
[0x7f2ba4000958] main audio output warning: audio output out of sync, adjusting dates (63952 us)
[0x7f2ba4000958] main audio output warning: not synchronized (63952 us), resampling
[0x7f2ba4000958] main audio output warning: buffer way too late (224917), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-89790), playing silence
[0x7f2ba4000958] main audio output warning: buffer way too late (200917), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-68133), playing silence
[0x7f2ba40030e8] mpgatofixed32 audio filter debug: libmad error: bad main_data_begin pointer
[0x7f2ba4000958] main audio output debug: audio output is starving (-46852), playing silence
[0x7f2ba4000958] main audio output warning: audio output out of sync, adjusting dates (85010 us)
[0x7f2ba4000958] main audio output warning: not synchronized (85010 us), resampling
[0x7f2ba4000958] main audio output warning: buffer way too late (261781), dropping buffer
[0x7f2ba4000958] main audio output warning: buffer way too late (237781), dropping buffer
[0x7f2ba4000958] main audio output warning: buffer way too late (213781), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-88816), playing silence
[0x7f2ba4000958] main audio output warning: buffer way too late (189781), dropping buffer
[0x7f2ba4000958] main audio output warning: audio output out of sync, adjusting dates (64654 us)
[0x7f2ba4000958] main audio output warning: not synchronized (64655 us), resampling
[0x7f2ba4000958] main audio output debug: audio output is starving (-89792), playing silence
[0x7f2ba4000958] main audio output warning: buffer way too late (230374), dropping buffer
[0x7f2ba4000958] main audio output warning: buffer way too late (206374), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-68122), playing silence
[0x7f2ba4000958] main audio output warning: buffer way too late (182374), dropping buffer
[0x7f2ba4000958] main audio output warning: audio output out of sync, adjusting dates (85002 us)
[0x7f2ba4000958] main audio output warning: not synchronized (85002 us), resampling
[0x7f2ba4000958] main audio output warning: buffer way too late (243126), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-89129), playing silence
[0x7f2ba4000958] main audio output warning: buffer way too late (219126), dropping buffer
[0x7f2ba4000958] main audio output warning: buffer way too late (195126), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-68464), playing silence
[0x7f2ba4000958] main audio output warning: audio output out of sync, adjusting dates (85672 us)
[0x7f2ba4000958] main audio output warning: not synchronized (85673 us), resampling
[0x7f2ba4000958] main audio output warning: buffer way too late (256695), dropping buffer
[0x7f2ba4000958] main audio output warning: buffer way too late (232695), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-90131), playing silence
[0x7f2ba4000958] main audio output warning: buffer way too late (208695), dropping buffer
[0x7f2ba0001268] main vout display debug: auto hiding mouse cursor
[0x7f2ba4000958] main audio output warning: buffer way too late (184695), dropping buffer
[0x7f2ba40030e8] mpgatofixed32 audio filter debug: libmad error: bad main_data_begin pointer
[0x7f2ba4000958] main audio output warning: audio output out of sync, adjusting dates (85291 us)
[0x7f2ba4000958] main audio output warning: not synchronized (85291 us), resampling
[0x7f2ba4000958] main audio output debug: audio output is starving (-89754), playing silence
[0x7f2ba4000958] main audio output warning: buffer way too late (245923), dropping buffer
[0x7f2ba4000958] main audio output warning: buffer way too late (221923), dropping buffer
[0x7f2ba4000958] main audio output warning: buffer way too late (197923), dropping buffer
[0x7f2ba4000958] main audio output warning: audio output out of sync, adjusting dates (63741 us)
[0x7f2ba40030e8] mpgatofixed32 audio filter debug: libmad error: bad main_data_begin pointer
[0x7f2ba4000958] main audio output warning: not synchronized (63741 us), resampling
[0x7f2ba4000958] main audio output debug: audio output is starving (-89819), playing silence
[0x7f2ba4000958] main audio output warning: buffer way too late (237623), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-68154), playing silence
[0x7f2ba4000958] main audio output warning: buffer way too late (213623), dropping buffer
[0x7f2ba4000958] main audio output warning: buffer way too late (189623), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-47306), playing silence
[0x7f2ba4000958] main audio output warning: audio output out of sync, adjusting dates (64186 us)
[0x7f2ba4000958] main audio output warning: not synchronized (64187 us), resampling
[0x7f2ba4000958] main audio output warning: buffer way too late (229643), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-90003), playing silence
[0x7f2ba4000958] main audio output warning: buffer way too late (205643), dropping buffer
[0x7f2ba4000958] main audio output warning: buffer way too late (181643), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-47009), playing silence
[0x7f2ba4000958] main audio output warning: audio output out of sync, adjusting dates (85091 us)
[0x7f2ba4000958] main audio output warning: not synchronized (85092 us), resampling
[0x7f2ba4000958] main audio output warning: buffer way too late (242506), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-89710), playing silence
[0x7f2ba4000958] main audio output warning: buffer way too late (218506), dropping buffer
[0x7f2ba4000958] main audio output warning: buffer way too late (194506), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-68097), playing silence
[0x7f2ba40030e8] mpgatofixed32 audio filter debug: libmad error: bad main_data_begin pointer
[0x7f2ba4000958] main audio output debug: audio output is starving (-46936), playing silence
[0x7f2ba4000958] main audio output warning: audio output out of sync, adjusting dates (85385 us)
[0x7f2ba4000958] main audio output warning: not synchronized (85385 us), resampling
[0x7f2ba4000958] main audio output warning: buffer way too late (255307), dropping buffer
[0x7f2ba4000958] main audio output warning: buffer way too late (231307), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-89278), playing silence
[0x7f2ba4000958] main audio output warning: buffer way too late (207307), dropping buffer
[0x7f2ba4000958] main audio output warning: buffer way too late (183307), dropping buffer
[0x7f2ba40030e8] mpgatofixed32 audio filter debug: libmad error: bad main_data_begin pointer
[0x7f2ba4000958] main audio output warning: audio output out of sync, adjusting dates (85650 us)
[0x7f2ba4000958] main audio output warning: not synchronized (85650 us), resampling
[0x7f2ba4000958] main audio output warning: buffer way too late (244791), dropping buffer
[0x7f2ba4000958] main audio output debug: audio output is starving (-89907), playing silence
[0x7f2ba4000958] main audio output warning: buffer way too late (220791), dropping buffer
[0x7f2ba4000958] main audio output warning: buffer way too late (196791), dropping buffer
[0x7f2ba4000958] main audio output warning: audio output out of sync, adjusting dates (63557 us)
[0x19dd138] main libvlc debug: exiting
[0x19dd138] main libvlc debug: deactivating the playlist
[0x1aa8028] main playlist debug: deactivating the playlist
[0x1aa8028] main playlist debug: incoming request - stopping current input
[0x1aa8028] main playlist debug: dying input
[0x7f2bc4000b78] main input debug: control: stopping input
[0x7f2ba4000958] main audio output debug: audio output is starving (-89824), playing silence
[0x1aa8028] main playlist debug: dying input
[0x7f2bbcc048f8] main decoder debug: removing module "avcodec"
[0x7f2bbcc048f8] avcodec decoder debug: ffmpeg codec (MPEG-4 Video) stopped
[0x7f2bbcc048f8] main decoder debug: killing decoder fourcc `mp4v', 0 PES in FIFO
[0x1aa8028] main playlist debug: saving a free vout
[0x1aa8028] main playlist debug: reusing provided vout
[0x7f2bbcc06008] main decoder debug: removing module "mpeg_audio"
[0x7f2bbcc06008] main decoder debug: killing decoder fourcc `mpga', 0 PES in FIFO
[0x7f2ba40030e8] main audio filter debug: removing module "mpgatofixed32"
[0x7f2ba4003ef8] main audio filter debug: removing module "samplerate"
[0x7f2ba4000958] main audio output debug: removing module "jack"
[0x7f2ba4000958] jack audio output debug: JACK graph reordered. Our maximum latency=0.
[0x7f2ba4000958] jack audio output debug: JACK graph reordered. Our maximum latency=0.
[0x7f2ba4005948] main mixer debug: removing module "float32_mixer"
[0x1aa8028] main playlist debug: releasing audio output
[0x7f2bbc003eb8] main demux debug: removing module "avi"
[0x7f2bbc001588] avi stream warning: unknown chunk (not unloaded)
[0x7f2bbc001588] main stream debug: removing module "stream_filter_record"
[0x7f2bbc004138] main access debug: removing module "filesystem"
[0x7f2bc4000b78] main input debug: Program doesn't contain anymore ES
[0x1aa8028] main playlist debug: dead input
[0x7f2bac06ca68] main video output debug: destroying useless vout
[0x1a94098] qt4 interface debug: IM: Deleting the input
[0x7f2ba000df58] main blend debug: removing module "blend"
[0x7f2ba0001268] main vout display debug: removing module "xcb_xv"
[0x7f2ba0006ee8] main inhibit debug: removing module "xdg_screensaver"
[0x7f2ba0006ee8] xdg_screensaver inhibit debug: started xdg-screensaver (PID = 15145)
[0x7f2ba0006bf8] qt4 window debug: releasing video...
[0x1a94098] qt4 interface debug: Video is not needed anymore
[0x7f2bac06de28] main spu text debug: removing module "freetype"
[0x7f2bac077518] main scale debug: removing module "yuvp"
[0x7f2bac06f128] main scale debug: removing module "swscale"
[0x1accf68] main playlist export debug: saving Media Library to file /home/grant/.local/share/vlc/ml.xspf
[0x1accf68] main playlist export debug: looking for playlist export module: 1 candidate
[0x1accf68] main playlist export debug: using playlist export module "export"
[0x1accf68] main playlist export debug: TIMER module_need() : 0.243 ms - Total 0.243 ms / 1 intvls (Avg 0.243 ms)
[0x1accf68] main playlist export debug: removing module "export"
[0x1aa8028] main playlist debug: playlist correctly deactivated
[0x19dd138] main libvlc debug: removing all services discovery tasks
[0x19dd138] main libvlc debug: removing all interfaces
[0x1a94098] main interface debug: removing module "qt4"
[0x1a94098] qt4 interface debug: requesting exit...
[0x1a94098] qt4 interface debug: waiting for UI thread...
[0x1a94098] qt4 interface debug: QApp exec() finished
[0x1a94098] qt4 interface debug: Video is not needed anymore
[0x1a94098] qt4 interface debug: Killing extension dialog provider
[0x1a94758] main interface debug: removing module "globalhotkeys"
[0x1aa6408] main interface debug: removing module "inhibit"
[0x7f2bc4000b78] main input debug: TIMER input launching for 'S09E01-They Came at Us with Spears!.avi' : 24.345 ms - Total 24.345 ms / 1 intvls (Avg 24.345 ms)
[0x1ab2d08] main interface debug: removing module "hotkeys"
[0x1aa8028] main playlist debug: destroying
[0x19dd138] main libvlc debug: TIMER ML Load : Total 5.711 ms / 1 intvls (Avg 5.711 ms)
[0x19dd138] main libvlc debug: TIMER Items array build : Total 0.154 ms / 2 intvls (Avg 0.077 ms)
[0x19dd138] main libvlc debug: TIMER Preparse run : Total 17.968 ms / 1 intvls (Avg 17.968 ms)
[0x19dd138] main libvlc debug: TIMER ML Dump : Total 0.416 ms / 1 intvls (Avg 0.416 ms)
[0x19dd138] main libvlc debug: removing stats
[0x19dd138] main libvlc debug: removing module "memcpymmxext"
[0x19dd138] main libvlc debug: opening config file (/home/grant/.config/vlc/vlcrc)
dE
2013-04-26 17:53:03 UTC
Permalink
Post by Grant
Post by dE
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack the
sound is very bad like the CPU can't keep up but top shows 90% of the
CPU idle. If I don't use jack the sound is fine but I notice the
video stutters a bit. mplayer and mpd work fine.
- Grant
You're STILL having that problem?
Yes, I just tried 3.9-rc8 but the problem persists.
Post by dE
Since VLC's video rendering is different from mplayer, it might be
triggering a bug in this particular kernel.
How about compiling with --
X a52 aac aalib alsa avcodec avformat dbus dirac dts dvbpsi dvd elibc_glibc
ffmpeg flac libass libsamplerate matroska mmx mp3 mpeg musepack ogg opengl
png qt4 schroedinger sdl sdl-image sid speex sse svg swscale taglib theora
truetype twolame udev vorbis x264 xcb xv
Just tried that but same result.
Post by dE
Also run VLC with
vlc --verbose 2147483647
Check it out yourself and attach it here.
[0x7f2ba4000958] main audio output warning: PTS is out of range (-9941), dropping buffer
[0x7f2ba4000958] main audio output warning: PTS is out of range (-33889), dropping buffer
[0x7f2ba40030e8] mpgatofixed32 audio filter debug: libmad error: bad
main_data_begin pointer
[0x7f2ba4000958] main audio output warning: audio output out of sync,
adjusting dates (70832 us)
[0x7f2bac06ca68] main video output debug: picture might be displayed late (missing 10 ms)
[0x7f2ba4000958] main audio output warning: not synchronized (70834 us), resampling
[0x7f2ba4000958] main audio output warning: buffer too late (70417), up-sampling
[0x7f2ba4000958] main audio output debug: audio output is starving
(-89164), playing silence
[0x7f2ba4000958] main audio output debug: audio output is starving
(-68444), playing silence
How about playing a file with no audio?
Grant
2013-04-26 20:05:57 UTC
Permalink
Post by dE
Post by Grant
Post by dE
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack the
sound is very bad like the CPU can't keep up but top shows 90% of the
CPU idle. If I don't use jack the sound is fine but I notice the
video stutters a bit. mplayer and mpd work fine.
- Grant
You're STILL having that problem?
Yes, I just tried 3.9-rc8 but the problem persists.
Post by dE
Since VLC's video rendering is different from mplayer, it might be
triggering a bug in this particular kernel.
How about compiling with --
X a52 aac aalib alsa avcodec avformat dbus dirac dts dvbpsi dvd elibc_glibc
ffmpeg flac libass libsamplerate matroska mmx mp3 mpeg musepack ogg opengl
png qt4 schroedinger sdl sdl-image sid speex sse svg swscale taglib theora
truetype twolame udev vorbis x264 xcb xv
Just tried that but same result.
Post by dE
Also run VLC with
vlc --verbose 2147483647
Check it out yourself and attach it here.
[0x7f2ba4000958] main audio output warning: PTS is out of range (-9941), dropping buffer
[0x7f2ba4000958] main audio output warning: PTS is out of range (-33889), dropping buffer
[0x7f2ba40030e8] mpgatofixed32 audio filter debug: libmad error: bad
main_data_begin pointer
[0x7f2ba4000958] main audio output warning: audio output out of sync,
adjusting dates (70832 us)
[0x7f2bac06ca68] main video output debug: picture might be displayed late (missing 10 ms)
[0x7f2ba4000958] main audio output warning: not synchronized (70834 us), resampling
[0x7f2ba4000958] main audio output warning: buffer too late (70417), up-sampling
[0x7f2ba4000958] main audio output debug: audio output is starving
(-89164), playing silence
[0x7f2ba4000958] main audio output debug: audio output is starving
(-68444), playing silence
How about playing a file with no audio?
What should I check for? The problem only manifests itself by way of
stuttery audio.

- Grant
dE
2013-04-29 16:48:44 UTC
Permalink
Post by Grant
Post by dE
Post by Grant
Post by dE
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack the
sound is very bad like the CPU can't keep up but top shows 90% of the
CPU idle. If I don't use jack the sound is fine but I notice the
video stutters a bit. mplayer and mpd work fine.
- Grant
You're STILL having that problem?
Yes, I just tried 3.9-rc8 but the problem persists.
Post by dE
Since VLC's video rendering is different from mplayer, it might be
triggering a bug in this particular kernel.
How about compiling with --
X a52 aac aalib alsa avcodec avformat dbus dirac dts dvbpsi dvd elibc_glibc
ffmpeg flac libass libsamplerate matroska mmx mp3 mpeg musepack ogg opengl
png qt4 schroedinger sdl sdl-image sid speex sse svg swscale taglib theora
truetype twolame udev vorbis x264 xcb xv
Just tried that but same result.
Post by dE
Also run VLC with
vlc --verbose 2147483647
Check it out yourself and attach it here.
[0x7f2ba4000958] main audio output warning: PTS is out of range
(-9941), dropping buffer
[0x7f2ba4000958] main audio output warning: PTS is out of range
(-33889), dropping buffer
[0x7f2ba40030e8] mpgatofixed32 audio filter debug: libmad error: bad
main_data_begin pointer
[0x7f2ba4000958] main audio output warning: audio output out of sync,
adjusting dates (70832 us)
[0x7f2bac06ca68] main video output debug: picture might be displayed
late (missing 10 ms)
[0x7f2ba4000958] main audio output warning: not synchronized (70834 us), resampling
[0x7f2ba4000958] main audio output warning: buffer too late (70417), up-sampling
[0x7f2ba4000958] main audio output debug: audio output is starving
(-89164), playing silence
[0x7f2ba4000958] main audio output debug: audio output is starving
(-68444), playing silence
How about playing a file with no audio?
What should I check for? The problem only manifests itself by way of
stuttery audio.
Ha! I didn't know that (or I forgot)!

You should check inside CONFIG_SND. See if the kernel configuration is
identical with the old kernel and this one.

Also with mplayer what audio output you're using?

Then this maybe a libmad problem, how about playing some audio/video
with wav/PCM audio?

Also has the video strutting stopped when you use alsa output?
Grant
2013-04-29 21:00:33 UTC
Permalink
Post by dE
Post by Grant
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack the
sound is very bad like the CPU can't keep up but top shows 90% of the
CPU idle. If I don't use jack the sound is fine but I notice the
video stutters a bit. mplayer and mpd work fine.
- Grant
[0x7f2ba4000958] main audio output warning: PTS is out of range
(-9941), dropping buffer
[0x7f2ba4000958] main audio output warning: PTS is out of range
(-33889), dropping buffer
[0x7f2ba40030e8] mpgatofixed32 audio filter debug: libmad error: bad
main_data_begin pointer
[0x7f2ba4000958] main audio output warning: audio output out of sync,
adjusting dates (70832 us)
[0x7f2bac06ca68] main video output debug: picture might be displayed
late (missing 10 ms)
[0x7f2ba4000958] main audio output warning: not synchronized (70834 us), resampling
[0x7f2ba4000958] main audio output warning: buffer too late (70417), up-sampling
[0x7f2ba4000958] main audio output debug: audio output is starving
(-89164), playing silence
[0x7f2ba4000958] main audio output debug: audio output is starving
(-68444), playing silence
You should check inside CONFIG_SND. See if the kernel configuration is
identical with the old kernel and this one.
The kernel configs are the same as far as CONFIG_SND_*.
Post by dE
Also with mplayer what audio output you're using?
I'm using jack on both mplayer and vlc. mplayer sounds perfect but
vlc is stuttery.
Post by dE
Then this maybe a libmad problem, how about playing some audio/video with
wav/PCM audio?
vlc+jack is just as stuttery with a wav audio file.
Post by dE
Also has the video strutting stopped when you use alsa output?
vlc plays audio perfectly when using the alsa output instead of jack.

- Grant
dE
2013-05-11 13:42:04 UTC
Permalink
Post by Grant
Post by dE
Post by Grant
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack the
sound is very bad like the CPU can't keep up but top shows 90% of the
CPU idle. If I don't use jack the sound is fine but I notice the
video stutters a bit. mplayer and mpd work fine.
- Grant
[0x7f2ba4000958] main audio output warning: PTS is out of range
(-9941), dropping buffer
[0x7f2ba4000958] main audio output warning: PTS is out of range
(-33889), dropping buffer
[0x7f2ba40030e8] mpgatofixed32 audio filter debug: libmad error: bad
main_data_begin pointer
[0x7f2ba4000958] main audio output warning: audio output out of sync,
adjusting dates (70832 us)
[0x7f2bac06ca68] main video output debug: picture might be displayed
late (missing 10 ms)
[0x7f2ba4000958] main audio output warning: not synchronized (70834 us), resampling
[0x7f2ba4000958] main audio output warning: buffer too late (70417), up-sampling
[0x7f2ba4000958] main audio output debug: audio output is starving
(-89164), playing silence
[0x7f2ba4000958] main audio output debug: audio output is starving
(-68444), playing silence
You should check inside CONFIG_SND. See if the kernel configuration is
identical with the old kernel and this one.
The kernel configs are the same as far as CONFIG_SND_*.
Post by dE
Also with mplayer what audio output you're using?
I'm using jack on both mplayer and vlc. mplayer sounds perfect but
vlc is stuttery.
Post by dE
Then this maybe a libmad problem, how about playing some audio/video with
wav/PCM audio?
vlc+jack is just as stuttery with a wav audio file.
Post by dE
Also has the video strutting stopped when you use alsa output?
vlc plays audio perfectly when using the alsa output instead of jack.
- Grant
______________________________________________________
vlc mailing list
http://mailman.videolan.org/listinfo/vlc
I'm stumped.

Report a bug.
Grant
2013-05-11 21:42:33 UTC
Permalink
Post by dE
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack the
sound is very bad like the CPU can't keep up but top shows 90%
of
the
CPU idle. If I don't use jack the sound is fine but I notice the
video stutters a bit. mplayer and mpd work fine.
I'm stumped.
Report a bug.
https://trac.videolan.org/vlc/ticket/8617

Thanks!

- Grant
Grant
2013-05-12 22:05:36 UTC
Permalink
Post by Grant
Post by dE
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack the
sound is very bad like the CPU can't keep up but top shows 90%
of
the
CPU idle. If I don't use jack the sound is fine but I notice the
video stutters a bit. mplayer and mpd work fine.
I'm stumped.
Report a bug.
https://trac.videolan.org/vlc/ticket/8617
And it's closed. They say it's a kernel regression. Could this from
dmesg have anything to do with it?

[drm] Wrong MCH_SSKPD value: 0x16040307
[drm] This can cause pipe underruns and display issues.
[drm] Please upgrade your BIOS to fix this.
[drm] GMBUS [i915 gmbus vga] timed out, falling back to bit banging on pin 2

- Grant
dE
2013-06-14 13:21:40 UTC
Permalink
Post by Grant
Post by Grant
Post by dE
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack the
sound is very bad like the CPU can't keep up but top shows 90%
of
the
CPU idle. If I don't use jack the sound is fine but I notice the
video stutters a bit. mplayer and mpd work fine.
I'm stumped.
Report a bug.
https://trac.videolan.org/vlc/ticket/8617
And it's closed. They say it's a kernel regression. Could this from
dmesg have anything to do with it?
[drm] Wrong MCH_SSKPD value: 0x16040307
[drm] This can cause pipe underruns and display issues.
[drm] Please upgrade your BIOS to fix this.
[drm] GMBUS [i915 gmbus vga] timed out, falling back to bit banging on pin 2
- Grant
______________________________________________________
vlc mailing list
http://mailman.videolan.org/listinfo/vlc
Then report a kernel bug. And make the 2 teams talk.
Grant
2013-07-18 18:45:22 UTC
Permalink
Post by dE
Post by Grant
Post by Grant
Post by dE
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack
the
sound is very bad like the CPU can't keep up but top shows 90%
of
the
CPU idle. If I don't use jack the sound is fine but I notice
the
video stutters a bit. mplayer and mpd work fine.
I'm stumped.
Report a bug.
https://trac.videolan.org/vlc/ticket/8617
And it's closed. They say it's a kernel regression. Could this from
dmesg have anything to do with it?
[drm] Wrong MCH_SSKPD value: 0x16040307
[drm] This can cause pipe underruns and display issues.
[drm] Please upgrade your BIOS to fix this.
[drm] GMBUS [i915 gmbus vga] timed out, falling back to bit banging on pin 2
Then report a kernel bug. And make the 2 teams talk.
Filed a bug:

https://bugzilla.kernel.org/show_bug.cgi?id=60580

- Grant
dE
2013-06-14 13:22:11 UTC
Permalink
Post by Grant
Post by Grant
Post by dE
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack the
sound is very bad like the CPU can't keep up but top shows 90%
of
the
CPU idle. If I don't use jack the sound is fine but I notice the
video stutters a bit. mplayer and mpd work fine.
I'm stumped.
Report a bug.
https://trac.videolan.org/vlc/ticket/8617
And it's closed. They say it's a kernel regression. Could this from
dmesg have anything to do with it?
[drm] Wrong MCH_SSKPD value: 0x16040307
[drm] This can cause pipe underruns and display issues.
[drm] Please upgrade your BIOS to fix this.
[drm] GMBUS [i915 gmbus vga] timed out, falling back to bit banging on pin 2
- Grant
______________________________________________________
vlc mailing list
http://mailman.videolan.org/listinfo/vlc
Did you try upgrading your BIOS?
Grant
2013-07-18 18:45:51 UTC
Permalink
Post by dE
Post by Grant
Post by Grant
Post by dE
Post by Grant
3.8 works great but vlc stutters a bit on 3.9. If I use jack
the
sound is very bad like the CPU can't keep up but top shows 90%
of
the
CPU idle. If I don't use jack the sound is fine but I notice
the
video stutters a bit. mplayer and mpd work fine.
I'm stumped.
Report a bug.
https://trac.videolan.org/vlc/ticket/8617
And it's closed. They say it's a kernel regression. Could this from
dmesg have anything to do with it?
[drm] Wrong MCH_SSKPD value: 0x16040307
[drm] This can cause pipe underruns and display issues.
[drm] Please upgrade your BIOS to fix this.
[drm] GMBUS [i915 gmbus vga] timed out, falling back to bit banging on pin 2
Did you try upgrading your BIOS?
Yes, I'm on the latest.

- Grant

Loading...