Crashing on 1080 x265 HEVC, and 4K HDR Atmos Content

madmanmoon · 13 December 2021 12:24

Hi

I’ve been long experiencing issues with content ( it appears I made this bad thread a while back ) that just brings my N2+ to a standstill.

The N2+ is stock, as is, from odroid UK, same PSU, and the CoreElec SD image accordingly.

I’ve raised this on the odroid forums just now, and thought it a good idea to raise it here, too.

I’ve no idea if this is related to the issues described in this high bitrate thread (7569), but they persisted even after an upgrade to 19.3.

Essentially, I will start a 4K UHD HDR ( normal, 10, or 10+ ) file with Atmos sound, and despite being set for passthrough, the device starts the audio in PCM. Further more, it stutters like crazy, then the whole device grinds to a standstill.

This occurs if the file is local or networked. The file plays back fine on a 2015 Shield, or (within reason) a PC, using the same network and/or HDMI cables or others, sometimes at very long distance. Other than the obvious audio differences no change if connected via the AVR or directly to the TV.

I’m wondering exactly what could be causing this. Some folks elsewhere have indicated that this might be a power issue. Some of the errors in the log show memory allocation errors, is the RAM dying, or could power delivery cause that to happen? Or perhaps SD corruption? I dunno.

This happened pre and post an update to 19.3, and that even ripped out all my add-ons for further removal of influences.

Here’s excerpts (too long a post) from a log, lemme know if something more relevant is required, full log is in odroid post.

################################################################################
Program terminated with signal SIGABRT, Aborted.
#0  __GI_raise (sig=sig@entry=6) at ../sysdeps/unix/sysv/linux/raise.c:50
[Current thread is 1 (Thread 0xef7fe380 (LWP 4789))]

Thread 3 (Thread 0xe07d8380 (LWP 4829)):
#0  __GI___poll (timeout=-1, nfds=2, fds=0xf002c970) at ../sysdeps/unix/sysv/linux/poll.c:29
#1  __GI___poll (fds=0xf002c970, nfds=2, timeout=-1) at ../sysdeps/unix/sysv/linux/poll.c:26
#2  0xf76d6da4 in ?? () from /usr/lib/libavahi-common.so.3
Backtrace stopped: previous frame identical to this frame (corrupt stack?)

Thread 2 (Thread 0xf2480280 (LWP 4767)):
#0  0xf76778b0 in __GI___pthread_timedjoin_ex (threadid=4018135936, thread_return=0xffe31d54, abstime=<optimized out>, block=<optimized out>) at pthread_join_common.c:84
#1  0xf3e6bb12 in ?? () from /usr/lib/libGLESv2.so.2
Backtrace stopped: previous frame identical to this frame (corrupt stack?)

Thread 1 (Thread 0xef7fe380 (LWP 4789)):
#0  __GI_raise (sig=sig@entry=6) at ../sysdeps/unix/sysv/linux/raise.c:50
#1  0xf3a2c260 in __GI_abort () at abort.c:79
#2  0xf3a78d54 in __libc_message (action=action@entry=do_abort, fmt=<optimized out>) at ../sysdeps/posix/libc_fatal.c:181
#3  0xf3a7f588 in malloc_printerr (str=<optimized out>) at malloc.c:5352
#4  0xf3a7ff54 in malloc_consolidate (av=av@entry=0xf3b4c7d4 <main_arena>) at malloc.c:4501
#5  0xf3a812dc in _int_free (av=0xf3b4c7d4 <main_arena>, p=0x2ab97a8, have_lock=<optimized out>) at malloc.c:4408
#6  0xf3a847dc in tcache_thread_shutdown () at malloc.c:2977
#7  __malloc_arena_thread_freeres () at arena.c:950
#8  0xf3a87ae8 in __libc_thread_freeres () at thread-freeres.c:38
#9  0xf767638c in start_thread (arg=0xef7fe380) at pthread_create.c:500
#10 0xf3ae3348 in ?? () at ../sysdeps/unix/sysv/linux/arm/clone.S:73 from /usr/lib/libc.so.6
Backtrace stopped: previous frame identical to this frame (corrupt stack?)
############# END STACK TRACE ###############

2021-12-08 21:46:18.085 T:4064805504   DEBUG: CSkinSettings: no <skinsettings> tag found

2021-12-08 21:46:18.085 T:4064805504 WARNING: CSettingsManager: missing version attribute

2021-12-08 21:46:18.181 T:4064805504   ERROR: DBus error: org.freedesktop.DBus.Error.ServiceUnknown - The name org.freedesktop.UPower was not provided by any .service files

2021-12-08 21:46:18.544 T:4064805504   ERROR: GetString: error reading /sys/class/amhdmitx/amhdmitx0/custom_mode

2021-12-08 21:46:19.044 T:4064805504 WARNING: JSONRPC: Could not parse type "Setting.Details.SettingList"

2021-12-08 21:48:20.897 T:4064805504  NOTICE: Quitting due to POSIX signal

2021-12-08 21:48:23.643 T:4064805504    INFO: ADDON: cpluff: 'An unreleased information object was encountered at address 0x195d1c0 with reference count 1 when destroying the associated plug-in context. Not releasing the object.'

2021-12-08 21:48:23.946 T:4064805504  NOTICE: XBApplicationEx: application stopped!

2021-12-08 21:46:18.260 T:4064805504   ERROR: GetString: error reading /storage/.kodi/userdata/disp_cap
2021-12-08 21:46:18.267 T:4064805504   ERROR: GetString: error reading /sys/class/amhdmitx/amhdmitx0/custom_mode
2021-12-08 21:46:18.267 T:4064805504   ERROR: GetString: error reading /storage/.kodi/userdata/disp_add
2021-12-08 21:46:18.267 T:4064805504   ERROR: GetString: error reading /run/disp_add

Hope that y’all can help … as I’m not sure really what or where to look for help on this.

If it makes any difference, CEC stopped working on this a billion years ago.

MMM

Here’s the audio section, which seems OK?

2021-12-08 21:46:18.234 T:4044534656 WARNING: Pulseaudio module module-allow-passthrough not loaded - opening PT devices might fail
2021-12-08 21:46:18.236 T:4044534656  NOTICE: Found 2 Lists of Devices
2021-12-08 21:46:18.236 T:4044534656  NOTICE: Enumerated ALSA devices:
2021-12-08 21:46:18.236 T:4044534656  NOTICE:     Device 1
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_deviceName      : @
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_displayName     : Default (AML-AUGESOUND Analog)
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_displayNameExtra: PCM
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_deviceType      : AE_DEVTYPE_PCM
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_channels        : FL, FR, LFE, FC, BL, BR, BLOC, BROC
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_sampleRates     : 32000,44100,48000,88200,96000,176400,192000
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_dataFormats     : AE_FMT_S24NE4,AE_FMT_S32NE,AE_FMT_S16NE,AE_FMT_S16LE
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_streamTypes     : No passthrough capabilities
2021-12-08 21:46:18.236 T:4044534656  NOTICE:     Device 2
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_deviceName      : sysdefault:CARD=AMLAUGESOUND
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_displayName     : AML-AUGESOUND
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_displayNameExtra: PCM
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_deviceType      : AE_DEVTYPE_PCM
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_channels        : FL, FR
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_sampleRates     : 32000,44100,48000,88200,96000,176400,192000
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_dataFormats     : AE_FMT_S24NE4,AE_FMT_S32NE,AE_FMT_S16NE,AE_FMT_S16LE
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_streamTypes     : No passthrough capabilities
2021-12-08 21:46:18.236 T:4044534656  NOTICE:     Device 3
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_deviceName      : surround71:CARD=AMLAUGESOUND,DEV=0
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_displayName     : AML-AUGESOUND
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_displayNameExtra: HDMI Multi Ch PCM
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_deviceType      : AE_DEVTYPE_PCM
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_channels        : FL, FR, LFE, FC, BL, BR, BLOC, BROC
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_sampleRates     : 32000,44100,48000,88200,96000,176400,192000
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_dataFormats     : AE_FMT_S24NE4,AE_FMT_S32NE,AE_FMT_S16NE,AE_FMT_S16LE
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_streamTypes     : No passthrough capabilities
2021-12-08 21:46:18.236 T:4044534656  NOTICE:     Device 4
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_deviceName      : iec958:CARD=AMLAUGESOUND,DEV=0
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_displayName     : AML-AUGESOUND
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_displayNameExtra: S/PDIF
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_deviceType      : AE_DEVTYPE_IEC958
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_channels        : FL, FR
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_sampleRates     : 32000,44100,48000,88200,96000,176400,192000
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_dataFormats     : AE_FMT_RAW,AE_FMT_S16NE,AE_FMT_S16LE
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_streamTypes     : STREAM_TYPE_AC3,STREAM_TYPE_DTSHD_CORE,STREAM_TYPE_DTS_1024,STREAM_TYPE_DTS_2048,STREAM_TYPE_DTS_512
2021-12-08 21:46:18.236 T:4044534656  NOTICE:     Device 5
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_deviceName      : hdmi:CARD=AMLAUGESOUND,DEV=0
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_displayName     : AML-AUGESOUND
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_displayNameExtra: HDMI
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_deviceType      : AE_DEVTYPE_HDMI
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_channels        : FL, FR, BL, BR, FC, LFE, SL, SR
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_sampleRates     : 32000,44100,48000,88200,96000,176400,192000
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_dataFormats     : AE_FMT_S16NE,AE_FMT_S16LE,AE_FMT_RAW
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_streamTypes     : STREAM_TYPE_AC3,STREAM_TYPE_DTSHD,STREAM_TYPE_DTSHD_MA,STREAM_TYPE_DTSHD_CORE,STREAM_TYPE_DTS_1024,STREAM_TYPE_DTS_2048,STREAM_TYPE_DTS_512,STREAM_TYPE_EAC3,STREAM_TYPE_TRUEHD
2021-12-08 21:46:18.236 T:4044534656  NOTICE: Enumerated PULSE devices:
2021-12-08 21:46:18.236 T:4044534656  NOTICE:     Device 1
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_deviceName      : Default
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_displayName     : Default
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_displayNameExtra: Bluetooth Audio (PULSEAUDIO)
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_deviceType      : AE_DEVTYPE_PCM
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_channels        : FL, FR
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_sampleRates     : 5512,8000,11025,16000,22050,32000,44100,48000,64000,88200,96000,176400,192000,384000
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_dataFormats     : AE_FMT_U8,AE_FMT_S16NE,AE_FMT_S24NE3,AE_FMT_S24NE4,AE_FMT_S32NE,AE_FMT_FLOAT
2021-12-08 21:46:18.236 T:4044534656  NOTICE:         m_streamTypes     : No passthrough capabilities

Portisch · 13 December 2021 12:48

Do not try to upgrade and uninstall addons.
Try again with a fresh clean 19.3 install without any addons installed.

Do not post just some lines of the log, a full log is required.
Depends what crash a dmesg log or kodi.log (started in debug mode).

First try without any modification with a new install by the 19.3 Odroid N2 img.gz.

madmanmoon · 13 December 2021 12:55

Hi, @Portisch, thanks for the advice! I’ll try a fresh install of 19.3 today, and I’ll turn logging on from the start.

Three things, though:

It’s a bit late to ‘not try to upgrade’ as it has already happened.
I did not have a choice about uninstalling addons, the system did that automatically.
I will always remove library, file, and network identifying data from logs, they are not required for fault finding. I have detailed the file information, it behooves me not to invent that.

I will try to find appropriate test files from dolby, and then obfuscate network details, though.

OK, more logs edited into the thread on odroid. The key things that appear to resemble the issue were:
A (perhaps uncaught by logs) time where a local test file kept buffering (a coreelec swirling thing).
When I switched the refresh rate to match the screen’s refresh rate, the screen started blinking after playing a blu-ray rip. Lowering that to 23.497 (or whatever it is) stopped that from happening.

That second one was akin to the issue that I saw previously whilst actually playing files, even with the refresh at its lowest (plugged into either TV or AVR).

One question I’ll bring in from the odroid forum:
Is there a way that I can test the power to the device in the OS?

EDIT 1 - Further Troubles and Troubleshooting Enquires

I’ve had more issues, with full uhd Blu-ray rips, remuxes, and still some h.265 1080p content that plays fine on the LG B7 native player won’t run on this more powerful hardware. Which really troubles me. As well were okay before, and they no longer are, and this is a fresh coreelec build on the sdcard.

I’ll continue to try new HDMI routing, I’ve found some thick Amazon, high speed, C3 cables. They’re not certified 48gbps like my favoured ones, but they’re solid 18gbps Amazon, so they should be okay for this.

I’m wondering if there are issues with power of the HDMI timing of circuitry … but I don’t know how or what to test that with.

BTW, I can’t test from a USB3.0 SSD, or emmc, as I don’t have an available option for that. However, I’ve played back high bitrate stuff on this before, even over the gigabit LAN from a mechanical drive on the server pc, and it’s been fine before. I’m not sure what’s holding us back here.

Are there coreelec trouble shooting add-ons, maybe? Maybe for HDMI, or power draw, testing? SdCard degradation?

I am wondering if this is related to the issues that @discODon99 is having here, or that have been discussed in this long thread (which may have seen some progress in 19.3, here.

EDIT 2 - Odroid UK PSU

Is it possible that I’ve got the same barely passable PSU as @flappy81 reported a couple of years back, here?

Could a 1.5A PSU not be able to push enough power to the board to capable do what it needs to do?

Tim_Taylor · 3 January 2022 11:42

I use 2A PSA (N2 & N2+)
HDMI cable from amazon
Movies are stored on QNAP NAS
Wired LAN 1Gb
CE 13 stored on eMMC
N2(+) connected to AVR

Playing all files, 1080px265 HDR, 4kHDR, 1080px264, 720px264 …
I don´t believe it´s any software bug, You have to search at Your side(cable, PSU etc.)

madmanmoon · 3 January 2022 11:50

Hi, @Tim_Taylor, thanks for responding!

Yeah, I don’t think it’s software, but I had to list it, just in case.

As I see it, the only confirmed difference we have is that you’re running on an eMMC, and I’m on SD. So there’s potentially differences there, but it should be fine, as the SD isn’t exactly doing any heavy lifting, right?

However, I’ll check that PSU.

How are you on full Blu-Ray remuxes, either local (usb3) or networked?

Tim_Taylor · 3 January 2022 12:11

My daily driver is running on eMMC
But I used some SD in the past.
There are three primary criteria:

PSU
HDMI cable
LAN infrastructure - cable, router, switch etc.

madmanmoon · 3 January 2022 12:26

Thanks, yeah, I’m 95% sure the HDMI is ok, but I’m going to test the two C3 cables I found on both the new+ and on the AVR ARC connection as well. I’ll ensure that I try this with the same files over gigabit LAN and local HDD.

I’ll try a modern film, with all the trimmings (maybe try a Dolby Vision / HDR10 hybrid) and I’ll also try my freshly remuxed Lawrence Of Arabia 4K, a near 100GB file to push things!

I’m using an Onkyo 646, but have also tried with another capable AVR sitting nearby.

The me+ and the server are connected to the same unmanaged gigabit switch, samba and windows networking are aligned just fine, whether one is connected to a VPN or not.

I’m wondering if I should consider using separate interfaces on the server for:

media shares (n2+, Nvidia shield, PC s, etc)
general networking (internet, etc)

Could drive accessing by more than one source at a time cause issues like these? Should I duplicate shares for differing purposes and or multiple devices?

EDIT - HDMI cables changed, no difference. Logs below are for latest post, breaking up.

	Line 71: 2022-02-06 22:19:47.669 T:3703    ERROR <general>: CAddonInfoBuilder::Generate: Unable to load '/storage/.kodi/addons/script.skinshortcuts/addon.xml', Line 0
	Line 158: 2022-02-06 22:19:47.705 T:3703    DEBUG <general>: DBus method call to org.freedesktop.ConsoleKit.Manager.CanStop at /org/freedesktop/ConsoleKit/Manager of org.freedesktop.ConsoleKit failed: org.freedesktop.DBus.Error.ServiceUnknown - The name org.freedesktop.ConsoleKit was not provided by any .service files
	Line 161: 2022-02-06 22:19:47.705 T:3703    ERROR <general>: DBus error: org.freedesktop.DBus.Error.ServiceUnknown - The name org.freedesktop.UPower was not provided by any .service files
	Line 161: 2022-02-06 22:19:47.705 T:3703    ERROR <general>: DBus error: org.freedesktop.DBus.Error.ServiceUnknown - The name org.freedesktop.UPower was not provided by any .service files
	Line 161: 2022-02-06 22:19:47.705 T:3703    ERROR <general>: DBus error: org.freedesktop.DBus.Error.ServiceUnknown - The name org.freedesktop.UPower was not provided by any .service files
	Line 170: 2022-02-06 22:19:47.727 T:3703    DEBUG <general>: DBus method call to org.freedesktop.UPower.EnumerateDevices at /org/freedesktop/UPower of org.freedesktop.UPower failed: org.freedesktop.DBus.Error.ServiceUnknown - The name org.freedesktop.UPower was not provided by any .service files
	Line 172: 2022-02-06 22:19:47.727 T:3703    DEBUG <general>: DBus method call to org.freedesktop.DBus.Peer.Ping at /org/freedesktop/UDisks2 of org.freedesktop.UDisks2 failed: org.freedesktop.DBus.Error.ServiceUnknown - The name org.freedesktop.UDisks2 was not provided by any .service files
	Line 174: 2022-02-06 22:19:47.727 T:3703    DEBUG <general>: DBus method call to org.freedesktop.UDisks.EnumerateDevices at /org/freedesktop/UDisks of org.freedesktop.UDisks failed: org.freedesktop.DBus.Error.ServiceUnknown - The name org.freedesktop.UDisks was not provided by any .service files
	Line 186: 2022-02-06 22:19:47.763 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_card_driver returned error: No such device
	Line 187: 2022-02-06 22:19:47.763 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/confmisc.c:392:(snd_func_concat) error evaluating strings
	Line 188: 2022-02-06 22:19:47.763 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_concat returned error: No such device
	Line 189: 2022-02-06 22:19:47.763 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/confmisc.c:1246:(snd_func_refer) error evaluating name
	Line 190: 2022-02-06 22:19:47.763 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_refer returned error: No such device
	Line 191: 2022-02-06 22:19:47.763 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5233:(snd_config_expand) Evaluate error: No such device
	Line 193: 2022-02-06 22:19:47.767 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 195: 2022-02-06 22:19:47.767 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 197: 2022-02-06 22:19:47.767 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 199: 2022-02-06 22:19:47.767 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 201: 2022-02-06 22:19:47.767 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 203: 2022-02-06 22:19:47.767 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 205: 2022-02-06 22:19:47.767 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 207: 2022-02-06 22:19:47.767 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 213: 2022-02-06 22:19:47.767 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 215: 2022-02-06 22:19:47.768 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 235: 2022-02-06 22:19:47.770 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_refer returned error: No such file or directory
	Line 236: 2022-02-06 22:19:47.770 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5233:(snd_config_expand) Evaluate error: No such file or directory
	Line 238: 2022-02-06 22:19:47.770 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_refer returned error: No such file or directory
	Line 239: 2022-02-06 22:19:47.770 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5233:(snd_config_expand) Evaluate error: No such file or directory
	Line 241: 2022-02-06 22:19:47.771 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_refer returned error: No such file or directory
	Line 242: 2022-02-06 22:19:47.771 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5233:(snd_config_expand) Evaluate error: No such file or directory
	Line 398: 2022-02-06 22:19:47.886 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_card_driver returned error: No such device
	Line 399: 2022-02-06 22:19:47.887 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/confmisc.c:392:(snd_func_concat) error evaluating strings
	Line 400: 2022-02-06 22:19:47.887 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_concat returned error: No such device
	Line 401: 2022-02-06 22:19:47.887 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/confmisc.c:1246:(snd_func_refer) error evaluating name
	Line 402: 2022-02-06 22:19:47.887 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_refer returned error: No such device
	Line 403: 2022-02-06 22:19:47.887 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5233:(snd_config_expand) Evaluate error: No such device
	Line 405: 2022-02-06 22:19:47.888 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 407: 2022-02-06 22:19:47.888 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 409: 2022-02-06 22:19:47.888 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 411: 2022-02-06 22:19:47.888 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 413: 2022-02-06 22:19:47.888 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 415: 2022-02-06 22:19:47.888 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 417: 2022-02-06 22:19:47.888 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 419: 2022-02-06 22:19:47.888 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 425: 2022-02-06 22:19:47.888 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 427: 2022-02-06 22:19:47.889 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 447: 2022-02-06 22:19:47.889 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_refer returned error: No such file or directory
	Line 448: 2022-02-06 22:19:47.889 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5233:(snd_config_expand) Evaluate error: No such file or directory
	Line 450: 2022-02-06 22:19:47.890 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_refer returned error: No such file or directory
	Line 451: 2022-02-06 22:19:47.890 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5233:(snd_config_expand) Evaluate error: No such file or directory
	Line 453: 2022-02-06 22:19:47.890 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_refer returned error: No such file or directory
	Line 454: 2022-02-06 22:19:47.890 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5233:(snd_config_expand) Evaluate error: No such file or directory
	Line 633: 2022-02-06 22:19:47.923 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_card_driver returned error: No such device
	Line 634: 2022-02-06 22:19:47.923 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/confmisc.c:392:(snd_func_concat) error evaluating strings
	Line 635: 2022-02-06 22:19:47.923 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_concat returned error: No such device
	Line 636: 2022-02-06 22:19:47.923 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/confmisc.c:1246:(snd_func_refer) error evaluating name
	Line 637: 2022-02-06 22:19:47.923 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_refer returned error: No such device
	Line 638: 2022-02-06 22:19:47.923 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5233:(snd_config_expand) Evaluate error: No such device
	Line 640: 2022-02-06 22:19:47.924 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 642: 2022-02-06 22:19:47.924 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 644: 2022-02-06 22:19:47.924 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 646: 2022-02-06 22:19:47.924 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 648: 2022-02-06 22:19:47.924 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 650: 2022-02-06 22:19:47.924 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 652: 2022-02-06 22:19:47.924 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 654: 2022-02-06 22:19:47.924 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 660: 2022-02-06 22:19:47.925 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 662: 2022-02-06 22:19:47.925 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5217:(snd_config_expand) Parse arguments error: No such file or directory
	Line 683: 2022-02-06 22:19:47.926 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_refer returned error: No such file or directory
	Line 684: 2022-02-06 22:19:47.926 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5233:(snd_config_expand) Evaluate error: No such file or directory
	Line 686: 2022-02-06 22:19:47.926 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_refer returned error: No such file or directory
	Line 687: 2022-02-06 22:19:47.926 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5233:(snd_config_expand) Evaluate error: No such file or directory
	Line 689: 2022-02-06 22:19:47.926 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:4745:(_snd_config_evaluate) function snd_func_refer returned error: No such file or directory
	Line 690: 2022-02-06 22:19:47.926 T:3709     INFO <general>: CAESinkALSA - ALSA: /home/portisch/CE/CoreELEC/build.CoreELEC-Amlogic-ng.arm-19/build/alsa-lib-1.2.4/src/conf.c:5233:(snd_config_expand) Evaluate error: No such file or directory
	Line 4458: 2022-02-06 22:20:24.892 T:3993    ERROR <general>: ffmpeg[0xe5948c18X]: [hevc] Could not find ref with POC 0
	Line 4459: 2022-02-06 22:20:24.897 T:3993    ERROR <general>: ffmpeg[0xe5948c18X]: [hevc] Could not find ref with POC 3
	Line 6721: 2022-02-06 22:20:35.379 T:4002    ERROR <general>: CAEStreamInfo::GetDuration - invalid stream type
	Line 6724: 2022-02-06 22:20:35.379 T:4002    ERROR <general>: CAEStreamInfo::GetDuration - invalid stream type
	Line 8297: 2022-02-06 22:20:35.520 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error of 26.494287, start adjusting
	Line 8298: 2022-02-06 22:20:35.520 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:1271 error 6ms
	Line 8299: 2022-02-06 22:20:35.520 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error 6.494287 below threshold of 30.000000
	Line 24405: 2022-02-06 22:20:36.522 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error 244.047580 above threshold of 100.000000
	Line 24407: 2022-02-06 22:20:36.522 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:11714 error 224ms
	Line 24411: 2022-02-06 22:20:36.522 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:10754 error 204ms
	Line 24605: 2022-02-06 22:20:36.543 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:9794 error 184ms
	Line 24606: 2022-02-06 22:20:36.543 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:8834 error 164ms
	Line 24737: 2022-02-06 22:20:36.564 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:7874 error 144ms
	Line 24738: 2022-02-06 22:20:36.564 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:6914 error 124ms
	Line 24828: 2022-02-06 22:20:36.586 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:5954 error 104ms
	Line 24829: 2022-02-06 22:20:36.586 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:4994 error 84ms
	Line 24830: 2022-02-06 22:20:36.586 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:4034 error 64ms
	Line 24831: 2022-02-06 22:20:36.586 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:3074 error 44ms
	Line 24950: 2022-02-06 22:20:36.607 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:2114 error 24ms
	Line 24951: 2022-02-06 22:20:36.607 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error 24.047580, last average error: 244.047580
	Line 24951: 2022-02-06 22:20:36.607 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error 24.047580, last average error: 244.047580
	Line 25681: 2022-02-06 22:20:36.713 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error of 34.445096, start adjusting
	Line 25683: 2022-02-06 22:20:36.714 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:1653 error 14ms
	Line 25684: 2022-02-06 22:20:36.714 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error 14.445096 below threshold of 30.000000
	Line 31983: 2022-02-06 22:20:37.737 T:4002    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:52773.024036, adjusted:52773.024036
	Line 31983: 2022-02-06 22:20:37.737 T:4002    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:52773.024036, adjusted:52773.024036
	Line 31984: 2022-02-06 22:20:37.737 T:4002    DEBUG <general>: CVideoPlayerAudio:: sync error correctiom:0.053
	Line 36124: 2022-02-06 22:20:39.784 T:4002    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:20822.499843, adjusted:20822.499843
	Line 36124: 2022-02-06 22:20:39.784 T:4002    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:20822.499843, adjusted:20822.499843
	Line 36125: 2022-02-06 22:20:39.784 T:4002    DEBUG <general>: CVideoPlayerAudio:: sync error correctiom:0.021
	Line 40733: 2022-02-06 22:20:40.743 T:4002    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:-17694.955333, adjusted:-17694.955333
	Line 40733: 2022-02-06 22:20:40.743 T:4002    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:-17694.955333, adjusted:-17694.955333
	Line 40734: 2022-02-06 22:20:40.743 T:4002    DEBUG <general>: CVideoPlayerAudio:: sync error correctiom:-0.018
	Line 82473: 2022-02-06 22:20:52.742 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error -419.617459 above threshold of 100.000000
	Line 82474: 2022-02-06 22:20:52.742 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:20141 error -400ms
	Line 82475: 2022-02-06 22:20:52.742 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:19181 error -380ms
	Line 82665: 2022-02-06 22:20:52.763 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:18221 error -360ms
	Line 82666: 2022-02-06 22:20:52.763 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:17261 error -340ms
	Line 82703: 2022-02-06 22:20:52.784 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:16301 error -320ms
	Line 82704: 2022-02-06 22:20:52.784 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:15341 error -300ms
	Line 82891: 2022-02-06 22:20:52.806 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:14381 error -280ms
	Line 82894: 2022-02-06 22:20:52.806 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:13421 error -260ms
	Line 83125: 2022-02-06 22:20:52.827 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:12461 error -240ms
	Line 83129: 2022-02-06 22:20:52.827 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:11501 error -220ms
	Line 83132: 2022-02-06 22:20:52.827 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:10541 error -200ms
	Line 83133: 2022-02-06 22:20:52.827 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:9581 error -180ms
	Line 83135: 2022-02-06 22:20:52.828 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:8621 error -160ms
	Line 83137: 2022-02-06 22:20:52.828 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:7661 error -140ms
	Line 83142: 2022-02-06 22:20:52.828 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:6701 error -120ms
	Line 83147: 2022-02-06 22:20:52.828 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:5741 error -100ms
	Line 83150: 2022-02-06 22:20:52.828 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:4781 error -80ms
	Line 83154: 2022-02-06 22:20:52.828 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:3821 error -60ms
	Line 83430: 2022-02-06 22:20:52.848 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:2861 error -40ms
	Line 83431: 2022-02-06 22:20:52.848 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:1901 error -20ms
	Line 83432: 2022-02-06 22:20:52.848 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error -19.617459 below threshold of 30.000000
	Line 86237: 2022-02-06 22:20:53.850 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error -306.412474 above threshold of 100.000000
	Line 86238: 2022-02-06 22:20:53.850 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:14707 error -286ms
	Line 86239: 2022-02-06 22:20:53.850 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:13747 error -266ms
	Line 86241: 2022-02-06 22:20:53.850 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:12787 error -246ms
	Line 86242: 2022-02-06 22:20:53.851 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:11827 error -226ms
	Line 86310: 2022-02-06 22:20:53.871 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:10867 error -206ms
	Line 86312: 2022-02-06 22:20:53.871 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:9907 error -186ms
	Line 86469: 2022-02-06 22:20:53.892 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:8947 error -166ms
	Line 86471: 2022-02-06 22:20:53.893 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:7987 error -146ms
	Line 86649: 2022-02-06 22:20:53.914 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:7027 error -126ms
	Line 86650: 2022-02-06 22:20:53.914 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:6067 error -106ms
	Line 86669: 2022-02-06 22:20:53.920 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:5107 error -86ms
	Line 86670: 2022-02-06 22:20:53.920 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:4147 error -66ms
	Line 86671: 2022-02-06 22:20:53.921 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:3187 error -46ms
	Line 86672: 2022-02-06 22:20:53.921 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:2227 error -26ms
	Line 86673: 2022-02-06 22:20:53.921 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error -26.412474 below threshold of 30.000000
	Line 89879: 2022-02-06 22:20:55.002 T:4002    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:-71227.710663, adjusted:-71227.710663
	Line 89879: 2022-02-06 22:20:55.002 T:4002    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:-71227.710663, adjusted:-71227.710663
	Line 89880: 2022-02-06 22:20:55.002 T:4002    DEBUG <general>: CVideoPlayerAudio:: sync error correctiom:-0.071

madmanmoon · 3 February 2022 00:52

OK, am back for more.

It’s started to pop and crackle now on the menu when moving around.

I could’ve sworn that it had forgotten the screen calibration, too, as I had to set it again. But maybe I hadn’t done that on this new install.

Plus a 1080p normal video was freezing up whilst I was watching it play from a local, USB 3, SSD.

I can’t remember where to go for the logs, so I’ll dig around and see what I can find.

Oh, and the PSU is a 2A one, so it should be fine. As far as I can see I have a solid red light at the back near the power input.

	Line 149280: 2022-02-06 22:21:31.677 T:4102    ERROR <general>: ffmpeg[0xd4434db0X]: [hevc] Could not find ref with POC 0
	Line 149281: 2022-02-06 22:21:31.684 T:4102    ERROR <general>: ffmpeg[0xd4434db0X]: [hevc] Could not find ref with POC 3
	Line 150123: 2022-02-06 22:21:37.770 T:3703    ERROR <general>: Control 1000 in window 13001 has been asked to focus, but it can't
	Line 153488: 2022-02-06 22:22:35.271 T:4667    ERROR <general>: ffmpeg[0xe2241908X]: [hevc] Could not find ref with POC 0
	Line 153489: 2022-02-06 22:22:35.276 T:4667    ERROR <general>: ffmpeg[0xe2241908X]: [hevc] Could not find ref with POC 3
	Line 156400: 2022-02-06 22:22:36.255 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error of 50.458551, start adjusting
	Line 156401: 2022-02-06 22:22:36.255 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:2422 error 30ms
	Line 156402: 2022-02-06 22:22:36.276 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:1462 error 10ms
	Line 156403: 2022-02-06 22:22:36.276 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error 10.458551 below threshold of 30.000000
	Line 173170: 2022-02-06 22:22:37.278 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error 284.041484 above threshold of 100.000000
	Line 173171: 2022-02-06 22:22:37.278 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:13633 error 264ms
	Line 173172: 2022-02-06 22:22:37.278 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:12673 error 244ms
	Line 173294: 2022-02-06 22:22:37.299 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:11713 error 224ms
	Line 173295: 2022-02-06 22:22:37.300 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:10753 error 204ms
	Line 173406: 2022-02-06 22:22:37.321 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:9793 error 184ms
	Line 173407: 2022-02-06 22:22:37.321 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:8833 error 164ms
	Line 173408: 2022-02-06 22:22:37.321 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:7873 error 144ms
	Line 173409: 2022-02-06 22:22:37.321 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:6913 error 124ms
	Line 173509: 2022-02-06 22:22:37.342 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:5953 error 104ms
	Line 173510: 2022-02-06 22:22:37.342 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:4993 error 84ms
	Line 173616: 2022-02-06 22:22:37.363 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:4033 error 64ms
	Line 173760: 2022-02-06 22:22:37.385 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:3073 error 44ms
	Line 173860: 2022-02-06 22:22:37.406 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:2113 error 24ms
	Line 173861: 2022-02-06 22:22:37.406 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error 24.041484, last average error: 284.041484
	Line 173861: 2022-02-06 22:22:37.406 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error 24.041484, last average error: 284.041484
	Line 174521: 2022-02-06 22:22:37.513 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error of 27.601580, start adjusting
	Line 174522: 2022-02-06 22:22:37.513 T:3709    DEBUG <general>: ActiveAE::SyncStream - delay frames:1324 error 8ms
	Line 174523: 2022-02-06 22:22:37.513 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error 7.601580 below threshold of 30.000000
	Line 180985: 2022-02-06 22:22:38.558 T:4674    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:22542.535740, adjusted:22542.535740
	Line 180985: 2022-02-06 22:22:38.558 T:4674    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:22542.535740, adjusted:22542.535740
	Line 180986: 2022-02-06 22:22:38.559 T:4674    DEBUG <general>: CVideoPlayerAudio:: sync error correctiom:0.023
	Line 185579: 2022-02-06 22:22:40.584 T:4674    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:25869.586256, adjusted:25869.586256
	Line 185579: 2022-02-06 22:22:40.584 T:4674    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:25869.586256, adjusted:25869.586256
	Line 185580: 2022-02-06 22:22:40.584 T:4674    DEBUG <general>: CVideoPlayerAudio:: sync error correctiom:0.026
	Line 190006: 2022-02-06 22:22:41.544 T:4674    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:-17097.439241, adjusted:-17097.439241
	Line 190006: 2022-02-06 22:22:41.544 T:4674    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:-17097.439241, adjusted:-17097.439241
	Line 190007: 2022-02-06 22:22:41.544 T:4674    DEBUG <general>: CVideoPlayerAudio:: sync error correctiom:-0.017
	Line 283163: 2022-02-06 22:23:07.538 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1273.873267
	Line 283164: 2022-02-06 22:23:07.538 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1283.872184
	Line 283179: 2022-02-06 22:23:07.539 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1293.873392
	Line 283181: 2022-02-06 22:23:07.541 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1303.871601
	Line 283191: 2022-02-06 22:23:07.543 T:4674    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:-18636.169898, adjusted:-18636.169898
	Line 283191: 2022-02-06 22:23:07.543 T:4674    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:-18636.169898, adjusted:-18636.169898
	Line 283192: 2022-02-06 22:23:07.543 T:4674    DEBUG <general>: CVideoPlayerAudio:: sync error correctiom:-0.019
	Line 283199: 2022-02-06 22:23:07.546 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1295.236764
	Line 283212: 2022-02-06 22:23:07.549 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1305.236348
	Line 283215: 2022-02-06 22:23:07.551 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1315.237556
	Line 283218: 2022-02-06 22:23:07.552 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1325.236097
	Line 283221: 2022-02-06 22:23:07.552 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1335.235722
	Line 283223: 2022-02-06 22:23:07.552 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1345.236097
	Line 283786: 2022-02-06 22:23:07.576 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1282.531972
	Line 283791: 2022-02-06 22:23:07.576 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1292.659639
	Line 283949: 2022-02-06 22:23:07.598 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1284.274014
	Line 283950: 2022-02-06 22:23:07.598 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1294.510847
	Line 283965: 2022-02-06 22:23:07.619 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1285.263514
	Line 283966: 2022-02-06 22:23:07.619 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1295.437139
	Line 283979: 2022-02-06 22:23:07.640 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1286.401931
	Line 283980: 2022-02-06 22:23:07.640 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1296.538764
	Line 284001: 2022-02-06 22:23:07.661 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1287.680222
	Line 284002: 2022-02-06 22:23:07.661 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1297.802806
	Line 284021: 2022-02-06 22:23:07.682 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1289.115597
	Line 284022: 2022-02-06 22:23:07.683 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1299.505306
	Line 284149: 2022-02-06 22:23:07.704 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1251.080806
	Line 284151: 2022-02-06 22:23:07.705 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1261.761222
	Line 284152: 2022-02-06 22:23:07.705 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1271.873389
	Line 284153: 2022-02-06 22:23:07.705 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1282.050097
	Line 284463: 2022-02-06 22:23:07.726 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1272.383806
	Line 284464: 2022-02-06 22:23:07.726 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1282.565097
	Line 284481: 2022-02-06 22:23:07.746 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1273.240181
	Line 284482: 2022-02-06 22:23:07.747 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1283.410889
	Line 284500: 2022-02-06 22:23:07.768 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1274.426514
	Line 284501: 2022-02-06 22:23:07.768 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1284.560889
	Line 284520: 2022-02-06 22:23:07.789 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1275.680639
	Line 284530: 2022-02-06 22:23:07.793 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1289.711764
	Line 284660: 2022-02-06 22:23:07.810 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1277.247431
	Line 284662: 2022-02-06 22:23:07.811 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1287.413056
	Line 284883: 2022-02-06 22:23:07.832 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1278.516347
	Line 284884: 2022-02-06 22:23:07.832 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1288.702347
	Line 284908: 2022-02-06 22:23:07.853 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1279.974389
	Line 284909: 2022-02-06 22:23:07.853 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1290.145639
	Line 284931: 2022-02-06 22:23:07.874 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1281.057014
	Line 284932: 2022-02-06 22:23:07.874 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1291.197389
	Line 284951: 2022-02-06 22:23:07.896 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1282.462306
	Line 284952: 2022-02-06 22:23:07.896 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1292.673847
	Line 285177: 2022-02-06 22:23:07.917 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1283.777848
	Line 285181: 2022-02-06 22:23:07.918 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1294.423973
	Line 285360: 2022-02-06 22:23:07.938 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1285.174681
	Line 285361: 2022-02-06 22:23:07.938 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1295.338264
	Line 285380: 2022-02-06 22:23:07.960 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1286.390514
	Line 285381: 2022-02-06 22:23:07.960 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1296.518889
	Line 285403: 2022-02-06 22:23:07.981 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1288.095348
	Line 285405: 2022-02-06 22:23:07.981 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1298.377098
	Line 285418: 2022-02-06 22:23:08.002 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1289.066764
	Line 285419: 2022-02-06 22:23:08.002 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1299.252598
	Line 285437: 2022-02-06 22:23:08.023 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1355.200598
	Line 285438: 2022-02-06 22:23:08.024 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1260.523431
	Line 285446: 2022-02-06 22:23:08.027 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1273.758056
	Line 285447: 2022-02-06 22:23:08.027 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1283.972473
	Line 285627: 2022-02-06 22:23:08.045 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1271.984139
	Line 285629: 2022-02-06 22:23:08.045 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1282.178931
	Line 285852: 2022-02-06 22:23:08.066 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1273.209139
	Line 285853: 2022-02-06 22:23:08.066 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1283.344806
	Line 285871: 2022-02-06 22:23:08.087 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1274.423598
	Line 285872: 2022-02-06 22:23:08.088 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1284.537556
	Line 285891: 2022-02-06 22:23:08.109 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1275.758056
	Line 285892: 2022-02-06 22:23:08.109 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1285.889181
	Line 285909: 2022-02-06 22:23:08.130 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1277.090723
	Line 285910: 2022-02-06 22:23:08.130 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1287.334556
	Line 286116: 2022-02-06 22:23:08.152 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1258.527389
	Line 286118: 2022-02-06 22:23:08.152 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1268.730806
	Line 286121: 2022-02-06 22:23:08.152 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1278.918556
	Line 286346: 2022-02-06 22:23:08.173 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1365.315681
	Line 286361: 2022-02-06 22:23:08.194 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1281.299931
	Line 286362: 2022-02-06 22:23:08.194 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1291.461306
	Line 286371: 2022-02-06 22:23:08.215 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1282.489681
	Line 286372: 2022-02-06 22:23:08.216 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1292.731431
	Line 286383: 2022-02-06 22:23:08.237 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1283.731848
	Line 286384: 2022-02-06 22:23:08.237 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1293.884431
	Line 286389: 2022-02-06 22:23:08.258 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1285.253764
	Line 286390: 2022-02-06 22:23:08.258 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1295.482014
	Line 286400: 2022-02-06 22:23:08.279 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1286.359431
	Line 286401: 2022-02-06 22:23:08.280 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1296.659014
	Line 286635: 2022-02-06 22:23:08.301 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1288.092056
	Line 286638: 2022-02-06 22:23:08.301 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1298.351473
	Line 286789: 2022-02-06 22:23:08.322 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1289.193181
	Line 286791: 2022-02-06 22:23:08.322 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1299.357223
	Line 286802: 2022-02-06 22:23:08.343 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1250.511806
	Line 286803: 2022-02-06 22:23:08.344 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1260.655139
	Line 286805: 2022-02-06 22:23:08.344 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1270.787723
	Line 286806: 2022-02-06 22:23:08.344 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1280.889139
	Line 286810: 2022-02-06 22:23:08.365 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1271.682348
	Line 286811: 2022-02-06 22:23:08.365 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1281.850973
	Line 286818: 2022-02-06 22:23:08.386 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1273.030639
	Line 286819: 2022-02-06 22:23:08.386 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1283.371139
	Line 286977: 2022-02-06 22:23:08.408 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1274.640139
	Line 286978: 2022-02-06 22:23:08.408 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1284.805306
	Line 287198: 2022-02-06 22:23:08.429 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1275.855598
	Line 287199: 2022-02-06 22:23:08.429 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1285.994223
	Line 287205: 2022-02-06 22:23:08.450 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1277.131098
	Line 287206: 2022-02-06 22:23:08.450 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1287.318264
	Line 287217: 2022-02-06 22:23:08.471 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1278.400431
	Line 287218: 2022-02-06 22:23:08.471 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1288.570639
	Line 287224: 2022-02-06 22:23:08.493 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1279.829639
	Line 287225: 2022-02-06 22:23:08.493 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1290.001181
	Line 287236: 2022-02-06 22:23:08.514 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1281.124056
	Line 287249: 2022-02-06 22:23:08.518 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1295.170306
	Line 287457: 2022-02-06 22:23:08.535 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1262.400764
	Line 287459: 2022-02-06 22:23:08.535 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1272.553806
	Line 287462: 2022-02-06 22:23:08.535 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1282.690764
	Line 287636: 2022-02-06 22:23:08.556 T:3709  WARNING <general>: ActiveAE - large audio sync error: -1273.672056

madmanmoon · 6 February 2022 23:17

Tested leviathan.m2ts (Dolby Trailers on TDT) from the internal video folder. Yes, I am aware that’s a DV trailer, except the playback is fine, and the HDR kicks in, so it must have and HDR10 layer or fallback code or something.

In the Kodi.log this received 442 errors on two plays of the file, of which the second was better but still with problems at familiar points (the whale) which caused the playback to stutter and the audio to completely stop and restart.

I’d enabled component specific debug level on this, and couldn’t use the built in log uploader, because it kept saying paste failed both before and after I’d stopped the logging.

No zipped logs, though, don’t know what I need to do to make them happen again, they seem actually useful.

Below is part 3 of the 442 errors in the logs, the other parts I’ve split into posts above.

EDIT: Using 3 different (1 48G, 2 18G) HDMI cables on a pi4 with a nightly build, the pi4 plays back the file flawlessly in HDR (possibly HDR10) with no hiccups both locally and from SMB. So I’m confident that the AV equimpment is doing its job.

	Line 287637: 2022-02-06 22:23:08.557 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error -1000.000000 above threshold of 100.000000
	Line 287638: 2022-02-06 22:23:08.557 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:48000 error -980ms
	Line 287639: 2022-02-06 22:23:08.557 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:47040 error -960ms
	Line 287645: 2022-02-06 22:23:08.578 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:46080 error -940ms
	Line 287646: 2022-02-06 22:23:08.578 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:45120 error -920ms
	Line 287657: 2022-02-06 22:23:08.599 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:44160 error -900ms
	Line 287658: 2022-02-06 22:23:08.599 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:43200 error -880ms
	Line 287664: 2022-02-06 22:23:08.621 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:42240 error -860ms
	Line 287672: 2022-02-06 22:23:08.624 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:41280 error -840ms
	Line 287846: 2022-02-06 22:23:08.642 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:40320 error -820ms
	Line 287847: 2022-02-06 22:23:08.642 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:39360 error -800ms
	Line 287849: 2022-02-06 22:23:08.642 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:38400 error -780ms
	Line 287850: 2022-02-06 22:23:08.642 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:37440 error -760ms
	Line 287852: 2022-02-06 22:23:08.643 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:36480 error -740ms
	Line 287853: 2022-02-06 22:23:08.643 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:35520 error -720ms
	Line 287854: 2022-02-06 22:23:08.643 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:34560 error -700ms
	Line 287856: 2022-02-06 22:23:08.643 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:33600 error -680ms
	Line 287857: 2022-02-06 22:23:08.643 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:32640 error -660ms
	Line 287859: 2022-02-06 22:23:08.643 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:31680 error -640ms
	Line 287880: 2022-02-06 22:23:08.645 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:30720 error -620ms
	Line 287895: 2022-02-06 22:23:08.646 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:29760 error -600ms
	Line 287904: 2022-02-06 22:23:08.647 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:28800 error -580ms
	Line 287907: 2022-02-06 22:23:08.647 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:27839 error -560ms
	Line 287910: 2022-02-06 22:23:08.647 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:26880 error -540ms
	Line 287928: 2022-02-06 22:23:08.649 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:25920 error -520ms
	Line 287930: 2022-02-06 22:23:08.649 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:24960 error -500ms
	Line 287935: 2022-02-06 22:23:08.649 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:24000 error -480ms
	Line 287938: 2022-02-06 22:23:08.650 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:23040 error -460ms
	Line 287939: 2022-02-06 22:23:08.650 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:22080 error -440ms
	Line 288234: 2022-02-06 22:23:08.663 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:21120 error -420ms
	Line 288241: 2022-02-06 22:23:08.663 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:20160 error -400ms
	Line 288247: 2022-02-06 22:23:08.664 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:19200 error -380ms
	Line 288252: 2022-02-06 22:23:08.664 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:18240 error -360ms
	Line 288258: 2022-02-06 22:23:08.664 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:17280 error -340ms
	Line 288264: 2022-02-06 22:23:08.664 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:16320 error -320ms
	Line 288270: 2022-02-06 22:23:08.664 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:15360 error -300ms
	Line 288274: 2022-02-06 22:23:08.664 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:14400 error -280ms
	Line 288276: 2022-02-06 22:23:08.664 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:13440 error -260ms
	Line 288277: 2022-02-06 22:23:08.665 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:12480 error -240ms
	Line 288279: 2022-02-06 22:23:08.665 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:11520 error -220ms
	Line 288770: 2022-02-06 22:23:08.684 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:10560 error -200ms
	Line 288774: 2022-02-06 22:23:08.685 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:9600 error -180ms
	Line 288776: 2022-02-06 22:23:08.685 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:8640 error -160ms
	Line 288778: 2022-02-06 22:23:08.685 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:7680 error -140ms
	Line 288780: 2022-02-06 22:23:08.685 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:6720 error -120ms
	Line 288781: 2022-02-06 22:23:08.685 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:5760 error -100ms
	Line 288782: 2022-02-06 22:23:08.685 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:4800 error -80ms
	Line 288783: 2022-02-06 22:23:08.685 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:3840 error -60ms
	Line 288784: 2022-02-06 22:23:08.685 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:2880 error -40ms
	Line 288785: 2022-02-06 22:23:08.685 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:1920 error -20ms
	Line 288786: 2022-02-06 22:23:08.685 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error -20.000000 below threshold of 30.000000
	Line 292982: 2022-02-06 22:23:09.687 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error -840.560893 above threshold of 100.000000
	Line 292983: 2022-02-06 22:23:09.687 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:40346 error -821ms
	Line 292984: 2022-02-06 22:23:09.687 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:39386 error -801ms
	Line 293041: 2022-02-06 22:23:09.708 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:38426 error -781ms
	Line 293042: 2022-02-06 22:23:09.708 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:37466 error -761ms
	Line 293054: 2022-02-06 22:23:09.729 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:36506 error -741ms
	Line 293055: 2022-02-06 22:23:09.729 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:35546 error -721ms
	Line 293059: 2022-02-06 22:23:09.751 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:34586 error -701ms
	Line 293060: 2022-02-06 22:23:09.751 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:33626 error -681ms
	Line 293072: 2022-02-06 22:23:09.772 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:32666 error -661ms
	Line 293073: 2022-02-06 22:23:09.772 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:31706 error -641ms
	Line 293074: 2022-02-06 22:23:09.772 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:30746 error -621ms
	Line 293077: 2022-02-06 22:23:09.773 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:29786 error -601ms
	Line 293088: 2022-02-06 22:23:09.774 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:28826 error -581ms
	Line 293097: 2022-02-06 22:23:09.774 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:27866 error -561ms
	Line 293098: 2022-02-06 22:23:09.775 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:26906 error -541ms
	Line 293100: 2022-02-06 22:23:09.775 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:25946 error -521ms
	Line 293102: 2022-02-06 22:23:09.776 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:24986 error -501ms
	Line 293104: 2022-02-06 22:23:09.776 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:24026 error -481ms
	Line 293106: 2022-02-06 22:23:09.776 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:23066 error -461ms
	Line 293108: 2022-02-06 22:23:09.777 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:22106 error -441ms
	Line 293210: 2022-02-06 22:23:09.793 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:21146 error -421ms
	Line 293212: 2022-02-06 22:23:09.794 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:20186 error -401ms
	Line 293216: 2022-02-06 22:23:09.794 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:19226 error -381ms
	Line 293220: 2022-02-06 22:23:09.794 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:18266 error -361ms
	Line 293224: 2022-02-06 22:23:09.795 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:17306 error -341ms
	Line 293229: 2022-02-06 22:23:09.795 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:16346 error -321ms
	Line 293233: 2022-02-06 22:23:09.795 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:15386 error -301ms
	Line 293238: 2022-02-06 22:23:09.795 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:14426 error -281ms
	Line 293243: 2022-02-06 22:23:09.795 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:13466 error -261ms
	Line 293248: 2022-02-06 22:23:09.795 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:12506 error -241ms
	Line 293557: 2022-02-06 22:23:09.815 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:11546 error -221ms
	Line 293560: 2022-02-06 22:23:09.815 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:10586 error -201ms
	Line 293563: 2022-02-06 22:23:09.815 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:9626 error -181ms
	Line 293627: 2022-02-06 22:23:09.817 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:8666 error -161ms
	Line 293630: 2022-02-06 22:23:09.817 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:7706 error -141ms
	Line 293638: 2022-02-06 22:23:09.818 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:6746 error -121ms
	Line 293646: 2022-02-06 22:23:09.818 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:5786 error -101ms
	Line 293653: 2022-02-06 22:23:09.818 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:4826 error -81ms
	Line 293660: 2022-02-06 22:23:09.818 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:3866 error -61ms
	Line 293668: 2022-02-06 22:23:09.818 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:2906 error -41ms
	Line 293987: 2022-02-06 22:23:09.836 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:1946 error -21ms
	Line 293989: 2022-02-06 22:23:09.836 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error -20.560893 below threshold of 30.000000
	Line 298393: 2022-02-06 22:23:10.838 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error -396.248067 above threshold of 100.000000
	Line 298394: 2022-02-06 22:23:10.838 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:19019 error -376ms
	Line 298406: 2022-02-06 22:23:10.859 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:18059 error -356ms
	Line 298407: 2022-02-06 22:23:10.860 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:17099 error -336ms
	Line 298410: 2022-02-06 22:23:10.881 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:16139 error -316ms
	Line 298411: 2022-02-06 22:23:10.881 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:15179 error -296ms
	Line 298423: 2022-02-06 22:23:10.902 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:14219 error -276ms
	Line 298424: 2022-02-06 22:23:10.902 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:13259 error -256ms
	Line 298435: 2022-02-06 22:23:10.906 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:12299 error -236ms
	Line 298438: 2022-02-06 22:23:10.907 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:11339 error -216ms
	Line 298692: 2022-02-06 22:23:10.924 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:10379 error -196ms
	Line 298693: 2022-02-06 22:23:10.924 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:9419 error -176ms
	Line 298694: 2022-02-06 22:23:10.924 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:8459 error -156ms
	Line 298697: 2022-02-06 22:23:10.924 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:7499 error -136ms
	Line 298699: 2022-02-06 22:23:10.925 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:6539 error -116ms
	Line 298702: 2022-02-06 22:23:10.925 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:5579 error -96ms
	Line 298704: 2022-02-06 22:23:10.925 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:4619 error -76ms
	Line 298707: 2022-02-06 22:23:10.925 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:3659 error -56ms
	Line 298709: 2022-02-06 22:23:10.925 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:2699 error -36ms
	Line 298711: 2022-02-06 22:23:10.925 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:1739 error -16ms
	Line 298712: 2022-02-06 22:23:10.925 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error -16.248067 below threshold of 30.000000
	Line 301544: 2022-02-06 22:23:11.926 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error -212.131792 above threshold of 100.000000
	Line 301545: 2022-02-06 22:23:11.926 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:10182 error -192ms
	Line 301546: 2022-02-06 22:23:11.926 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:9222 error -172ms
	Line 301568: 2022-02-06 22:23:11.947 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:8262 error -152ms
	Line 301569: 2022-02-06 22:23:11.947 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:7302 error -132ms
	Line 301576: 2022-02-06 22:23:11.968 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:6342 error -112ms
	Line 301577: 2022-02-06 22:23:11.969 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:5382 error -92ms
	Line 301588: 2022-02-06 22:23:11.990 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:4422 error -72ms
	Line 301589: 2022-02-06 22:23:11.990 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:3462 error -52ms
	Line 301597: 2022-02-06 22:23:12.011 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:2502 error -32ms
	Line 301600: 2022-02-06 22:23:12.011 T:3709    DEBUG <general>: ActiveAE::SyncStream - skip frames:1542 error -12ms
	Line 301601: 2022-02-06 22:23:12.011 T:3709    DEBUG <general>: ActiveAE::SyncStream - average error -12.131792 below threshold of 30.000000
	Line 302078: 2022-02-06 22:23:13.099 T:4674    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:-89232.783507, adjusted:-89232.783507
	Line 302078: 2022-02-06 22:23:13.099 T:4674    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:-89232.783507, adjusted:-89232.783507
	Line 302079: 2022-02-06 22:23:13.099 T:4674    DEBUG <general>: CVideoPlayerAudio:: sync error correctiom:-0.089
	Line 302482: 2022-02-06 22:23:14.059 T:4674    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:-15229.223642, adjusted:-15229.223642
	Line 302482: 2022-02-06 22:23:14.059 T:4674    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:-15229.223642, adjusted:-15229.223642
	Line 302483: 2022-02-06 22:23:14.059 T:4674    DEBUG <general>: CVideoPlayerAudio:: sync error correctiom:-0.015
	Line 302910: 2022-02-06 22:23:15.082 T:4674    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:12468.960877, adjusted:12468.960877
	Line 302910: 2022-02-06 22:23:15.082 T:4674    DEBUG <general>: CDVDClock::ErrorAdjust - CVideoPlayerAudio::OutputPacket - error:12468.960877, adjusted:12468.960877
	Line 302911: 2022-02-06 22:23:15.082 T:4674    DEBUG <general>: CVideoPlayerAudio:: sync error correctiom:0.012
	Line 304626: 2022-02-06 22:23:19.537 T:4674    ERROR <general>: Got MSGQ_ABORT or MSGO_IS_ERROR return true
	Line 304626: 2022-02-06 22:23:19.537 T:4674    ERROR <general>: Got MSGQ_ABORT or MSGO_IS_ERROR return true
	Line 304678: 2022-02-06 22:23:19.841 T:4675    ERROR <general>: Got MSGQ_ABORT or MSGO_IS_ERROR return true
	Line 304678: 2022-02-06 22:23:19.841 T:4675    ERROR <general>: Got MSGQ_ABORT or MSGO_IS_ERROR return true
	Line 307678: 2022-02-06 22:23:20.728 T:4773    ERROR <general>: ffmpeg[0x2cf6c50X]: [hevc] Could not find ref with POC 0
	Line 307679: 2022-02-06 22:23:20.737 T:4773    ERROR <general>: ffmpeg[0x2cf6c50X]: [hevc] Could not find ref with POC 3
	Line 308715: 2022-02-06 22:23:38.942 T:3703    ERROR <general>: Control 1000 in window 13000 has been asked to focus, but it can't
	Line 309500: 2022-02-06 22:24:38.568 T:3703    ERROR <general>: Control 1000 in window 13000 has been asked to focus, but it can't

boot2k3 · 9 February 2022 14:00

I tested on my configuration and something similar is possible if you have in output configuration HDMI and 7.1 settings and True-HD passthrough disabled.
For correct usage it should be Hdmi Multi Ch PCM' and 7.1 settings or HDMI` and 2.0 depends on configuration you have.
You didn’t upload any logs so no ways to check.
But as I said in 19.4RC2 topic don’t use TrueHD sound without enabled passthrough.
On my N2+ system it plays flawless

madmanmoon · 9 February 2022 14:35

Cheers, buddy, I do have True-HD enabled, it’s never been disabled (although I can’t remember if this is a new build since the issues started), this all started happening a month (or a few) back out of nowhere, when previously the stuff was fine.

I can’t see why it might disable itself, either, but I guess that’s possible.

I’ve tried this with 7.1 (my standard setup) and 2.0, but I have a 7.1 setup. Still, I don’t want PCM, I want Atmos passthrough with True-HD/MA/etc. They did used to work … they now stutter and suffer from SD card, local USB SSD (over multiple controllers), or SMB networked content.

This leviathan.m2ts file is just a file that I’ve been able to repeatedly get the issue to show up with. There are many others.

I’ve downloaded a nightly release and I’m just setting it up right now, but I’ve heard a couple of tell-tale crackles already in the interface. Not as much as before, and the ‘scanlines’ has gone … but once it’s all setup, I’ll get the right test files on there and retest properly with logging on.

Here’s a 1-time download for the kodi.log and debug_info, I’m still looking for a good place to upload it. Couldn’t find one associated with the foum, unfortunately.

madmanmoon · 9 February 2022 15:01

OK, so the file played back OK in the nightly, but the pops and clicks were happening constantly on the GUI. So rather than just accept it, I stuck around.

No sooner had I stopped the logging the display started blanking in and out again, and this was something else that was happening previously. Wow … I’d never realised how frustrating that could be. Anyway, I need to find a higher bitrate HDR10 test file as this was only ever supposed to be a file that I could easily point to that caused the issue.

Plus I get ‘Failed to paste log files, try again’ error on ix.io log upload attempts.

All is not well in the state of not Denmark.

I need to find a decent high bitrate (40-50k+) Atmos HDR10+ file to properly test this all with, and I need to fish out the non-nightly N2+ SD card which fell on the floor.

EDIT - In looking through some files that I was zipping up to upload somewhere, I noticed that the pulse symlink is completely empty. I get that a symlink will be a miniscule file, but 0bytes? WinRAR had problems dealing with it, it said that it couldn’t find the file, and Notepad++ also spat it back. I’m sure it’s nothing, but pulse is audio related, no?

7ce0b9401205f55ef16a2c736203c6b5-runtime.symlink

Navigating through on putTy that points to a /tmp/pulse-QdlbXWSkYrmb folder that is similarly empty. Again, I’m assuming this is all by design.

madmanmoon · 28 March 2022 15:49

By the way, I think that there’s a good chance that the HBR audio issues are down to the noted issues with Disney stuff, as with a nightly release it has been behaving much better of late, although I’ve got zero CEC through my B7 > Onkyo 646 chain.

system · 27 June 2022 21:50

This topic was automatically closed 91 days after the last reply. New replies are no longer allowed.