Bugged OSMC for RPI1 Kodi Stuttering and no audio

Ok, It is very weird, after several months, I decided to try the older distributions, and it is
in this way. The old pre-17 version of Kodi, play everything nice and clean.
But the latest august, (and also others but I cannot test everything) distrubutions seems
completelly unusable on RPI1.
I’m trying to look to a .mkv with The Martian, and I’ve 100% CPU busy, the audio (passthrough) now is completelly out of sync and after a little bit completelly stopped, and the video is stuttering.
At the ssh prompt, I tried everything, the two major CPU threads that sucks are one from kodi, and another from the exfat fs (since the movie is on an exfat external USB disk).
I tried everything, I changed the nice, and or the io priority, but without any effect. I don’t know if is is a bug in user space (kodi) or in kernel space, however, it seems sorry that here in OSMC you basically do not care at all the RPI1 users. I already noted that several people reported similar bugs, and also that the last distribution has been produced in August, now we are in October, so maybe this is a stopping bug for the next distrib. In any case, if you can point me to any way to help, just let me know.
At this moment, I decided to reformat one old sdcard, and use Kodi 16. There is no infrastructure to understand why there are so many problems in playing a movie? The key ‘o’ in the previous versions of kodi was usefull to see the number of frame skipped and other infos about the rendering, but the actual ‘o’ key in kodi 17 just show some basic info about the movie format. (more or less useless info)

The logs say:


1:12:48.663 T:2991313488 WARNING: CDVDMessageQueue(player)::Put MSGQ_NOT_INITIALIZED

01:12:48.667 T:2519724800 NOTICE: Creating InputStream

01:12:49.593 T:2519724800 NOTICE: Creating Demuxer

01:12:50.180 T:2519724800 NOTICE: OMXPlayerUnsuitable OMXPlayer unsuitable due to ac3transcode

01:12:50.180 T:2519724800 NOTICE: Opening stream: 0 source: 256

01:12:50.180 T:2519724800 NOTICE: Creating video codec with codec id: 28

01:12:50.206 T:2519724800 NOTICE: Creating video thread

01:12:50.207 T:2519724800 NOTICE: Opening stream: 1 source: 256

01:12:50.207 T:2519724800 NOTICE: Finding audio codec for: 86019

01:12:50.208 T:2519724800 NOTICE: Creating audio thread

01:12:50.209 T:2519724800 NOTICE: Opening stream: 3 source: 256

01:12:50.219 T:2553279232 NOTICE: running thread: video_thread

01:12:50.220 T:2324689664 NOTICE: running thread: CVideoPlayerAudio::Process()

01:12:50.994 T:2324689664 NOTICE: Creating audio stream (codec id: 86019, channels: 6, sample rate: 48000, pass-through)

01:15:59.159 T:2324689664 NOTICE: CVideoPlayerAudio::Process - stream stalled

01:17:20.633 T:2553279232 WARNING: CRenderManager::WaitForBuffer - timeout waiting for buffer

01:21:30.961 T:2324689664 WARNING: Previous line repeats 3 times.

01:21:30.987 T:2324689664 NOTICE: CVideoPlayerAudio::Process - stream stalled

01:21:46.401 T:2553279232 WARNING: CRenderManager::WaitForBuffer - timeout waiting for buffer

01:21:57.265 T:2291135232 WARNING: Previous line repeats 13 times.

01:21:57.265 T:2291135232 ERROR: SetThreadInfo: error Permission denied

01:22:04.065 T:2952667904 NOTICE: CAESinkPi:AddPackets Underrun (delay:0.00 frames:1536)

01:24:04.697 T:2553279232 NOTICE: Previous line repeats 3 times.

01:24:04.857 T:2553279232 WARNING: CRenderManager::WaitForBuffer - timeout waiting for buffer

01:24:11.152 T:2324689664 NOTICE: CActiveAEStream::AddData - messy timestamps, increasing interval for measuring average error to 6000 ms

01:24:59.661 T:2952667904 NOTICE: CAESinkPi:AddPackets Underrun (delay:0.00 frames:1536)

01:26:01.975 T:2553279232 NOTICE: Previous line repeats 4 times.

01:26:01.976 T:2553279232 WARNING: CRenderManager::WaitForBuffer - timeout waiting for buffer


We need complete logs please.

Mediainfo on the file you are trying to play would help also.

Could you link a few of those?

Of course, it could just be time to retire your 6 year old Pi (or do as I did and re-purpose it). After all, you did probably get $35 of use out of it :smiley: (BTW, my Pi1 is still running as a backup server and PiHole on Raspbian)

ok, for the mediainfo, this is the output of ffmpeg -i

ffmpeg -i /media/BigData/FilmHD/2015\ -\ The\ Martian.mkv
ffmpeg version 3.2.10-1~deb9u1 Copyright © 2000-2018 the FFmpeg developers
built with gcc 6.3.0 (Raspbian 6.3.0-18+rpi1) 20170516
configuration: --prefix=/usr --extra-version=‘1~deb9u1’ --toolchain=hardened --libdir=/usr/lib/arm-linux-gnueabihf --incdir=/usr/include/arm-linux-gnueabihf --enable-gpl --disable-stripping --enable-avresample --enable-avisynth --enable-gnutls --enable-ladspa --enable-libass --enable-libbluray --enable-libbs2b --enable-libcaca --enable-libcdio --enable-libebur128 --enable-libflite --enable-libfontconfig --enable-libfreetype --enable-libfribidi --enable-libgme --enable-libgsm --enable-libmp3lame --enable-libopenjpeg --enable-libopenmpt --enable-libopus --enable-libpulse --enable-librubberband --enable-libshine --enable-libsnappy --enable-libsoxr --enable-libspeex --enable-libssh --enable-libtheora --enable-libtwolame --enable-libvorbis --enable-libvpx --enable-libwavpack --enable-libwebp --enable-libx265 --enable-libxvid --enable-libzmq --enable-libzvbi --enable-omx --enable-openal --enable-opengl --enable-sdl2 --enable-libdc1394 --enable-libiec61883 --enable-chromaprint --enable-frei0r --enable-libopencv --enable-libx264 --enable-shared
libavutil 55. 34.101 / 55. 34.101
libavcodec 57. 64.101 / 57. 64.101
libavformat 57. 56.101 / 57. 56.101
libavdevice 57. 1.100 / 57. 1.100
libavfilter 6. 65.100 / 6. 65.100
libavresample 3. 1. 0 / 3. 1. 0
libswscale 4. 2.100 / 4. 2.100
libswresample 2. 3.100 / 2. 3.100
libpostproc 54. 1.100 / 54. 1.100
Input #0, matroska,webm, from ‘/media/BigData/FilmHD/2015 - The Martian.mkv’:
Metadata:
title : The Martian (2015) - Fratposa
encoder : libebml v1.3.1 + libmatroska v1.4.2
creation_time : 2016-04-06T08:22:15.000000Z
Duration: 02:21:37.60, start: 0.000000, bitrate: 8028 kb/s
Chapter #0:0: start 0.000000, end 202.285000
Metadata:
title : Chapter 1
Chapter #0:1: start 202.285000, end 608.983000
Metadata:
title : Chapter 2
Chapter #0:2: start 608.983000, end 924.590000
Metadata:
title : Chapter 3
Chapter #0:3: start 924.590000, end 1105.187000
Metadata:
title : Chapter 4
Chapter #0:4: start 1105.187000, end 1294.376000
Metadata:
title : Chapter 5
Chapter #0:5: start 1294.376000, end 1468.092000
Metadata:
title : Chapter 6
Chapter #0:6: start 1468.092000, end 1732.689000
Metadata:
title : Chapter 7
Chapter #0:7: start 1732.689000, end 1896.645000
Metadata:
title : Chapter 8
Chapter #0:8: start 1896.645000, end 2061.101000
Metadata:
title : Chapter 9
Chapter #0:9: start 2061.101000, end 2353.434000
Metadata:
title : Chapter 10
Chapter #0:10: start 2353.434000, end 2481.771000
Metadata:
title : Chapter 11
Chapter #0:11: start 2481.771000, end 2783.531000
Metadata:
title : Chapter 12
Chapter #0:12: start 2783.531000, end 2965.087000
Metadata:
title : Chapter 13
Chapter #0:13: start 2965.087000, end 3375.747000
Metadata:
title : Chapter 14
Chapter #0:14: start 3375.747000, end 3580.494000
Metadata:
title : Chapter 15
Chapter #0:15: start 3580.494000, end 3743.823000
Metadata:
title : Chapter 16
Chapter #0:16: start 3743.823000, end 4013.134000
Metadata:
title : Chapter 17
Chapter #0:17: start 4013.134000, end 4192.980000
Metadata:
title : Chapter 18
Chapter #0:18: start 4192.980000, end 4431.302000
Metadata:
title : Chapter 19
Chapter #0:19: start 4431.302000, end 4718.255000
Metadata:
title : Chapter 20
Chapter #0:20: start 4718.255000, end 4972.467000
Metadata:
title : Chapter 21
Chapter #0:21: start 4972.467000, end 5441.269000
Metadata:
title : Chapter 22
Chapter #0:22: start 5441.269000, end 5850.094000
Metadata:
title : Chapter 23
Chapter #0:23: start 5850.094000, end 6211.997000
Metadata:
title : Chapter 24
Chapter #0:24: start 6211.997000, end 6376.287000
Metadata:
title : Chapter 25
Chapter #0:25: start 6376.287000, end 6618.737000
Metadata:
title : Chapter 26
Chapter #0:26: start 6618.737000, end 6847.966000
Metadata:
title : Chapter 27
Chapter #0:27: start 6847.966000, end 7069.312000
Metadata:
title : Chapter 28
Chapter #0:28: start 7069.312000, end 7481.683000
Metadata:
title : Chapter 29
Chapter #0:29: start 7481.683000, end 7865.733000
Metadata:
title : Chapter 30
Chapter #0:30: start 7865.733000, end 8008.792000
Metadata:
title : Chapter 31
Chapter #0:31: start 8008.792000, end 8497.600000
Metadata:
title : Chapter 32
Stream #0:0: Video: h264 (High), yuv420p(progressive), 1920x800 [SAR 1:1 DAR 12:5], 23.98 fps, 23.98 tbr, 1k tbn, 47.95 tbc (default)
Metadata:
BPS : 6746274
BPS-eng : 6746274
DURATION : 02:21:37.572000000
DURATION-eng : 02:21:37.572000000
NUMBER_OF_FRAMES: 203738
NUMBER_OF_FRAMES-eng: 203738
NUMBER_OF_BYTES : 7165868857
NUMBER_OF_BYTES-eng: 7165868857
_STATISTICS_WRITING_APP: mkvmerge v8.2.0 (‘World of Adventure’) 64bit
_STATISTICS_WRITING_APP-eng: mkvmerge v8.2.0 (‘World of Adventure’) 64bit
_STATISTICS_WRITING_DATE_UTC: 2016-04-06 08:22:15
_STATISTICS_WRITING_DATE_UTC-eng: 2016-04-06 08:22:15
_STATISTICS_TAGS: BPS DURATION NUMBER_OF_FRAMES NUMBER_OF_BYTES
_STATISTICS_TAGS-eng: BPS DURATION NUMBER_OF_FRAMES NUMBER_OF_BYTES
Stream #0:1(ita): Audio: ac3, 48000 Hz, 5.1(side), fltp, 640 kb/s (default)
Metadata:
BPS : 640000
BPS-eng : 640000
DURATION : 02:21:37.568000000
DURATION-eng : 02:21:37.568000000
NUMBER_OF_FRAMES: 265549
NUMBER_OF_FRAMES-eng: 265549
NUMBER_OF_BYTES : 679805440
NUMBER_OF_BYTES-eng: 679805440
_STATISTICS_WRITING_APP: mkvmerge v8.2.0 (‘World of Adventure’) 64bit
_STATISTICS_WRITING_APP-eng: mkvmerge v8.2.0 (‘World of Adventure’) 64bit
_STATISTICS_WRITING_DATE_UTC: 2016-04-06 08:22:15
_STATISTICS_WRITING_DATE_UTC-eng: 2016-04-06 08:22:15
_STATISTICS_TAGS: BPS DURATION NUMBER_OF_FRAMES NUMBER_OF_BYTES
_STATISTICS_TAGS-eng: BPS DURATION NUMBER_OF_FRAMES NUMBER_OF_BYTES
Stream #0:2(eng): Audio: ac3, 48000 Hz, 5.1(side), fltp, 640 kb/s
Metadata:
BPS : 640000
BPS-eng : 640000
DURATION : 02:21:37.600000000
DURATION-eng : 02:21:37.600000000
NUMBER_OF_FRAMES: 265550
NUMBER_OF_FRAMES-eng: 265550
NUMBER_OF_BYTES : 679808000
NUMBER_OF_BYTES-eng: 679808000
_STATISTICS_WRITING_APP: mkvmerge v8.2.0 (‘World of Adventure’) 64bit
_STATISTICS_WRITING_APP-eng: mkvmerge v8.2.0 (‘World of Adventure’) 64bit
_STATISTICS_WRITING_DATE_UTC: 2016-04-06 08:22:15
_STATISTICS_WRITING_DATE_UTC-eng: 2016-04-06 08:22:15
_STATISTICS_TAGS: BPS DURATION NUMBER_OF_FRAMES NUMBER_OF_BYTES
_STATISTICS_TAGS-eng: BPS DURATION NUMBER_OF_FRAMES NUMBER_OF_BYTES
Stream #0:3(ita): Subtitle: subrip (default) (forced)
Metadata:
title : Forced
BPS : 1
BPS-eng : 1
DURATION : 02:20:15.622000000
DURATION-eng : 02:20:15.622000000
NUMBER_OF_FRAMES: 41
NUMBER_OF_FRAMES-eng: 41
NUMBER_OF_BYTES : 1578
NUMBER_OF_BYTES-eng: 1578
_STATISTICS_WRITING_APP: mkvmerge v8.2.0 (‘World of Adventure’) 64bit
_STATISTICS_WRITING_APP-eng: mkvmerge v8.2.0 (‘World of Adventure’) 64bit
_STATISTICS_WRITING_DATE_UTC: 2016-04-06 08:22:15
_STATISTICS_WRITING_DATE_UTC-eng: 2016-04-06 08:22:15
_STATISTICS_TAGS: BPS DURATION NUMBER_OF_FRAMES NUMBER_OF_BYTES
_STATISTICS_TAGS-eng: BPS DURATION NUMBER_OF_FRAMES NUMBER_OF_BYTES
Stream #0:4(eng): Subtitle: subrip
Metadata:
title : Forced
BPS : 91
BPS-eng : 91
DURATION : 00:00:47.714000000
DURATION-eng : 00:00:47.714000000
NUMBER_OF_FRAMES: 12
NUMBER_OF_FRAMES-eng: 12
NUMBER_OF_BYTES : 547
NUMBER_OF_BYTES-eng: 547
_STATISTICS_WRITING_APP: mkvmerge v8.2.0 (‘World of Adventure’) 64bit
_STATISTICS_WRITING_APP-eng: mkvmerge v8.2.0 (‘World of Adventure’) 64bit
_STATISTICS_WRITING_DATE_UTC: 2016-04-06 08:22:15
_STATISTICS_WRITING_DATE_UTC-eng: 2016-04-06 08:22:15
_STATISTICS_TAGS: BPS DURATION NUMBER_OF_FRAMES NUMBER_OF_BYTES
_STATISTICS_TAGS-eng: BPS DURATION NUMBER_OF_FRAMES NUMBER_OF_BYTES
Stream #0:5(ita): Subtitle: subrip
Metadata:
BPS : 51
BPS-eng : 51
DURATION : 02:20:15.622000000
DURATION-eng : 02:20:15.622000000
NUMBER_OF_FRAMES: 1700
NUMBER_OF_FRAMES-eng: 1700
NUMBER_OF_BYTES : 54141
NUMBER_OF_BYTES-eng: 54141
_STATISTICS_WRITING_APP: mkvmerge v8.2.0 (‘World of Adventure’) 64bit
_STATISTICS_WRITING_APP-eng: mkvmerge v8.2.0 (‘World of Adventure’) 64bit
_STATISTICS_WRITING_DATE_UTC: 2016-04-06 08:22:15
_STATISTICS_WRITING_DATE_UTC-eng: 2016-04-06 08:22:15
_STATISTICS_TAGS: BPS DURATION NUMBER_OF_FRAMES NUMBER_OF_BYTES
_STATISTICS_TAGS-eng: BPS DURATION NUMBER_OF_FRAMES NUMBER_OF_BYTES
Stream #0:6(eng): Subtitle: subrip
Metadata:
title : SDH
BPS : 67
BPS-eng : 67
DURATION : 02:15:59.276000000
DURATION-eng : 02:15:59.276000000
NUMBER_OF_FRAMES: 2145
NUMBER_OF_FRAMES-eng: 2145
NUMBER_OF_BYTES : 69036
NUMBER_OF_BYTES-eng: 69036
_STATISTICS_WRITING_APP: mkvmerge v8.2.0 (‘World of Adventure’) 64bit
_STATISTICS_WRITING_APP-eng: mkvmerge v8.2.0 (‘World of Adventure’) 64bit
_STATISTICS_WRITING_DATE_UTC: 2016-04-06 08:22:15
_STATISTICS_WRITING_DATE_UTC-eng: 2016-04-06 08:22:15
_STATISTICS_TAGS: BPS DURATION NUMBER_OF_FRAMES NUMBER_OF_BYTES
_STATISTICS_TAGS-eng: BPS DURATION NUMBER_OF_FRAMES NUMBER_OF_BYTES

For the kodi log, it is too long, How can I attach the file or send to you?

How? The log is too long, How can I attach it? or send it to you? email? ok I’ll try with a shared link on my dropbox.

In the log you notice continue underrun. Moreover, I had to do a small seek back to restore the video or audio, In general the problems keeps increasing, i.e. it become impossible to watch the movie, with all the this stuttering and audio skips. I noted also that the ‘loosing audio’ effects, like clicks, in the GUI without playing the movie.

Did you look through the forum here as you were asked when you signed up? All the information you need is easily available. But to answer your question, the proper way to do logs is:

Logs.

And the proper way to include mediainfo is also available on the same page.

no, I’m sorry, now I read the info. Anyway, the kodi.log are now available, and I included the output of ffmpeg .i, that I hope is enough. If you need more, I need more time to collect the data.

Logs need to be shared properly, as does mediainfo. I personally don’t download unknown files from dropbox.

https://paste.osmc.tv/onoregeneb (complete logs)

http://paste.osmc.io/okixumiyov.sm (mediainfo)

Ok, it must be a combination of kernel/software problems and hardware issues, reading around on the web, I found that the signal level of HDMI can be boosted, I put hdmi_boost=7 in config.txt and this improves just a little bit the situation. But I noted from the report of the receiver (Onkyo NR 636) that the audio signal is not stable.

From RPiconfig - eLinux.org

config_hdmi_boost configure the signal strength of the HDMI interface. Default is 2 on Pi 1 model B and 5 on later boards. Try increasing if you have interference issues with hdmi (e.g. to 7) 11 is the maximum.

Try 11. If things improve, back it down again until issues return. You’ll soon find the sweet spot.

ok, thanks, I tried also disabling the passthrough, it is even better, I’ll try as you suggested.