vircadia / vircadia-native-core

Vircadia open source agent-based metaverse ecosystem.
https://vircadia.com/
Other
533 stars 175 forks source link

Crash in audio code #1364

Closed daleglass closed 2 years ago

daleglass commented 2 years ago
interface: /home/dale/git/vircadia/vircadia-master/libraries/audio-client/src/AudioClient.cpp:1698: 
void AudioClient::processReceivedSamples(const QByteArray&, QByteArray&): Assertion `decodedBuffer.size() == AudioConstants::NETWORK_FRAME_BYTES_STEREO' failed.
daleglass commented 2 years ago

Debugging:

(gdb) print decodedBuffer.size()
$1 = 0
(gdb) print AudioConstants::NETWORK_FRAME_BYTES_STEREO
$2 = 960
daleglass commented 2 years ago

Backtrace:

0x00007fffe5c722a2 in raise () from /lib64/libc.so.6
(gdb) bt
#0  0x00007fffe5c722a2 in raise () at /lib64/libc.so.6
#1  0x00007fffe5c5b8a4 in abort () at /lib64/libc.so.6
#2  0x00007fffe5c5b789 in _nl_load_domain.cold () at /lib64/libc.so.6
#3  0x00007fffe5c6aa16 in  () at /lib64/libc.so.6
#4  0x00007fffeeefc795 in AudioClient::processReceivedSamples(QByteArray const&, QByteArray&) (this=0x3d59520, decodedBuffer=..., outputBuffer=...)
    at /home/dale/git/vircadia/vircadia-master/libraries/audio-client/src/AudioClient.cpp:1698
#5  0x00007fffeef123fa in QtPrivate::FunctorCall<QtPrivate::IndexesList<0, 1>, QtPrivate::List<QByteArray const&, QByteArray&>, void, void (AudioClient::*)(QByteArray const&, QByteArray&)>::call(void (AudioClient::*)(QByteArray const&, QByteArray&), AudioClient*, void**) (f=
    (void (AudioClient::*)(AudioClient * const, const QByteArray &, QByteArray &)) 0x7fffeeefc736 <AudioClient::processReceivedSamples(QByteArray const&, QByteArray&)>, o=0x3d59520, arg=0x7fff0b7fca40) at /usr/include/qt5/QtCore/qobjectdefs_impl.h:152
#6  0x00007fffeef112d9 in QtPrivate::FunctionPointer<void (AudioClient::*)(QByteArray const&, QByteArray&)>::call<QtPrivate::List<QByteArray const&, QByteArray&>, void>(void (AudioClient::*)(QByteArray const&, QByteArray&), AudioClient*, void**) (f=
    (void (AudioClient::*)(AudioClient * const, const QByteArray &, QByteArray &)) 0x7fffeeefc736 <AudioClient::processReceivedSamples(QByteArray const&, QByteArray&)>, o=0x3d59520, arg=0x7fff0b7fca40) at /usr/include/qt5/QtCore/qobjectdefs_impl.h:185
#7  0x00007fffeef0f5bb in QtPrivate::QSlotObject<void (AudioClient::*)(QByteArray const&, QByteArray&), QtPrivate::List<QByteArray const&, QByteArray&>, void>::impl(int, QtPrivate::QSlotObjectBase*, QObject*, void**, bool*) (which=1, this_=0x3d55740, r=0x3d59520, a=0x7fff0b7fca40, ret=0x0)
    at /usr/include/qt5/QtCore/qobjectdefs_impl.h:418
#8  0x00007ffff268f3a9 in void doActivate<false>(QObject*, int, void**) () at /lib64/libQt5Core.so.5
#9  0x00007fffeec827cd in MixedProcessedAudioStream::processSamples(QByteArray const&, QByteArray&) (this=0x3d596e0, _t1=..., _t2=...)
    at /home/dale/git/vircadia/build-glvnd/libraries/audio/audio_autogen/UVLADIE3JM/moc_MixedProcessedAudioStream.cpp:196
#10 0x00007fffeecd4a1e in MixedProcessedAudioStream::lostAudioData(int) (this=0x3d596e0, numPackets=0)
    at /home/dale/git/vircadia/vircadia-master/libraries/audio/src/MixedProcessedAudioStream.cpp:56
#11 0x00007fffeeccdb74 in InboundAudioStream::popSamples(int, bool) (this=0x3d596e0, maxSamples=1920, allOrNothing=false)
    at /home/dale/git/vircadia/vircadia-master/libraries/audio/src/InboundAudioStream.cpp:374
#12 0x00007fffeef00d06 in AudioClient::AudioOutputIODevice::readData(char*, long long)
    (this=0x3d5d3d8, data=0x7ffefc0d7ca0 "\346\375\321\376\371\375v\376N\376(\376\322\376\a\376f\377\036\376\373\377j\376\203", maxSize=3840)
    at /home/dale/git/vircadia/vircadia-master/libraries/audio-client/src/AudioClient.cpp:2363
#13 0x00007ffff25ad053 in QIODevicePrivate::read(char*, long long, bool) () at /lib64/libQt5Core.so.5
#14 0x00007fffcc027259 in QPulseAudioOutput::userFeed() (this=0x7ffefc50c920)
    at /usr/src/debug/qt5-qtmultimedia-5.15.2-3.fc34.x86_64/src/plugins/pulseaudio/qaudiooutput_pulse.cpp:475
#15 0x00007ffff2685f09 in QObject::event(QEvent*) () at /lib64/libQt5Core.so.5
#16 0x00007ffff3e1c443 in QApplicationPrivate::notify_helper(QObject*, QEvent*) () at /lib64/libQt5Widgets.so.5
#17 0x0000000000a06af5 in Application::notify(QObject*, QEvent*) (this=0x7fffffffa5b0, object=0x7ffefc50c920, event=0x7ffd2c004b70)
    at /home/dale/git/vircadia/vircadia-master/interface/src/Application.cpp:4283
#18 0x00007ffff265b798 in QCoreApplication::notifyInternal2(QObject*, QEvent*) () at /lib64/libQt5Core.so.5
#19 0x00007ffff265ed06 in QCoreApplicationPrivate::sendPostedEvents(QObject*, int, QThreadData*) () at /lib64/libQt5Core.so.5
#20 0x00007ffff26ad0d7 in postEventSourceDispatch(_GSource*, int (*)(void*), void*) () at /lib64/libQt5Core.so.5
#21 0x00007fffe51a74cf in g_main_context_dispatch () at /lib64/libglib-2.0.so.0
#22 0x00007fffe51fb4f8 in g_main_context_iterate.constprop () at /lib64/libglib-2.0.so.0
#23 0x00007fffe51a4c03 in g_main_context_iteration () at /lib64/libglib-2.0.so.0
#24 0x00007ffff26acb78 in QEventDispatcherGlib::processEvents(QFlags<QEventLoop::ProcessEventsFlag>) () at /lib64/libQt5Core.so.5
#25 0x00007ffff265a1a2 in QEventLoop::exec(QFlags<QEventLoop::ProcessEventsFlag>) () at /lib64/libQt5Core.so.5
#26 0x00007ffff249d2aa in QThread::exec() () at /lib64/libQt5Core.so.5
#27 0x00007ffff249e4a6 in QThreadPrivate::start(void*) () at /lib64/libQt5Core.so.5
#28 0x00007ffff6a0a299 in start_thread () at /lib64/libpthread.so.0
#29 0x00007fffe5d35353 in clone () at /lib64/libc.so.6
Penguin-Guru commented 2 years ago

https://dpaste.com/HA6BCV4H4

========================

[09/25 12:22:46] [DEBUG] [hifi.networking.ice] 6 seconds since last domain list request, squelching traffic [09/25 12:22:46] [DEBUG] [hifi.networking] Limit of silent domain checkins reached [09/25 12:22:46] [DEBUG] [hifi.networking] LimitedNodeList::eraseAllNodes() removing all nodes from NodeList: "Domain checkin limit" [09/25 12:22:46] [DEBUG] [hifi.networking] Killed "Entity Script Server" (S) {d3face5e-a71e-4bf1-9409-ea71da64e0a1}(20390) 178.62.77.222:43702 / 178.62.77.222:43702 [09/25 12:22:46] [DEBUG] [hifi.networking] Killed "Entity Server" (o) {e6709d32-6d4e-40c4-a1d6-1ca585eaf409}(1824) 178.62.77.222:38904 / 178.62.77.222:38904 [09/25 12:22:46] [DEBUG] [hifi.networking] Killed "Avatar Mixer" (W) {ebea7eb2-4345-4c11-9867-2167d9d6b722}(39511) 178.62.77.222:50849 / 178.62.77.222:50849 [09/25 12:22:46] [DEBUG] [hifi.interface] Clearing domain octree details... [09/25 12:22:46] [DEBUG] [hifi.networking] Killed "Asset Server" (A) {8931ea12-13f2-46ea-ae92-d7cfa38b24dd}(48794) 178.62.77.222:33430 / 178.62.77.222:33430 [09/25 12:22:46] [DEBUG] [hifi.networking] Killed "Messages Mixer" (m) {85e609c7-7cab-4cfd-a811-961973e82a94}(58077) 178.62.77.222:48982 / 178.62.77.222:48982 [09/25 12:22:46] [DEBUG] [hifi.networking] Killed "Audio Mixer" (M) {a77b1392-601d-48ec-9b10-6ce1f96b2687}(11662) 178.62.77.222:54280 / 178.62.77.222:54280 [09/25 12:22:46] [DEBUG] [hifi.networking] Clearing all remaining connections in Socket. [09/25 12:22:46] [DEBUG] [hifi.networking] Resetting current domain connection information. [09/25 12:22:46] [DEBUG] [hifi.networking] Creating new Connection class for 178.62.77.222:40102 [09/25 12:22:46] [DEBUG] [hifi.networking] Soft reset [09/25 12:22:46] [DEBUG] [hifi.networking.ice] Disconnecting from domain server. [09/25 12:22:46] [DEBUG] [hifi.networking.ice] REASON: "Domain checkin limit" [09/25 12:22:46] [DEBUG] [hifi.networking] Clearing all remaining connections in Socket. [09/25 12:22:46] [DEBUG] [hifi.networking] NodeList UUID changed from "1f76e8cb-0dfe-44da-8132-0c08204f5553" to "00000000-0000-0000-0000-000000000000" [09/25 12:22:47] [DEBUG] [hifi.interface.deadlock] DEADLOCK WATCHDOG WARNING: lastHeartbeatAge: 636533 elapsedMovingAverage: 1758 maxElapsed: 2649757 PREVIOUS maxElapsedAverage: 1757 NEW maxElapsedAverage: 1758 NEW MAX ELAPSED AVERAGE samples: 3759 [09/25 12:22:47] [DEBUG] [hifi.networking] Packet of type 12 (SilentAudioFrame) received from unknown node with Local ID 0 [09/25 12:22:47] [WARNING] [hifi.scriptengine] Script Engine has been running too long, throwing: "about:Entities 4" [09/25 12:22:47] [DEBUG] [hifi.scriptengine] AssetScriptingInterface::AssetScriptingInterface ScriptEngine(0x7f80bc050ee0) [09/25 12:22:47] [DEBUG] [hifi.avatars] Removed avatar with UUID "be564b41-14ab-4b44-a8ce-7c065dbc4b61" from AvatarHashMap 0 [09/25 12:22:47] [DEBUG] [hifi.avatars] Removed avatar with UUID "72b4ac97-7e1a-40ef-8ce2-83f92e969955" from AvatarHashMap 0 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [FloofChat.js] [UncaughtException signalHandlerException] Error: Result of expression 'AvatarManager.getPalData([sessionID]).data[0]' [undefined] is not an object. in file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [Backtrace] [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] avatarLeavesDomain(sessionID = '{be564b41-14ab-4b44-a8ce-7c065dbc4b61}') at file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] <global>() at -1 [09/25 12:22:47] [DEBUG] [hifi.avatars] Removed avatar with UUID "f4f46c18-6dd9-48dc-9fae-5922c29f00af" from AvatarHashMap 0 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [FloofChat.js] [UncaughtException signalHandlerException] Error: Result of expression 'AvatarManager.getPalData([sessionID]).data[0]' [undefined] is not an object. in file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [Backtrace] [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] avatarLeavesDomain(sessionID = '{72b4ac97-7e1a-40ef-8ce2-83f92e969955}') at file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] <global>() at -1 [09/25 12:22:47] [DEBUG] [hifi.avatars] Removed avatar with UUID "536f0ab2-29ab-40d1-9a8e-41d2d039276a" from AvatarHashMap 0 [09/25 12:22:47] [DEBUG] [hifi.avatars] Removed avatar with UUID "858f91bc-51a5-4cef-ad91-ff4f8e11f84e" from AvatarHashMap 0 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [FloofChat.js] [UncaughtException signalHandlerException] Error: Result of expression 'AvatarManager.getPalData([sessionID]).data[0]' [undefined] is not an object. in file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [Backtrace] [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] avatarLeavesDomain(sessionID = '{f4f46c18-6dd9-48dc-9fae-5922c29f00af}') at file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] <global>() at -1 [09/25 12:22:47] [DEBUG] [hifi.avatars] Removed avatar with UUID "96531c05-2afa-4cbf-ab22-64e5d7b933c0" from AvatarHashMap 0 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [FloofChat.js] [UncaughtException signalHandlerException] Error: Result of expression 'AvatarManager.getPalData([sessionID]).data[0]' [undefined] is not an object. in file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [Backtrace] [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] avatarLeavesDomain(sessionID = '{536f0ab2-29ab-40d1-9a8e-41d2d039276a}') at file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] <global>() at -1 [09/25 12:22:47] [DEBUG] [hifi.avatars] Removed avatar with UUID "03371271-251b-474a-aa5f-5b554315529c" from AvatarHashMap 0 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [FloofChat.js] [UncaughtException signalHandlerException] Error: Result of expression 'AvatarManager.getPalData([sessionID]).data[0]' [undefined] is not an object. in file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [Backtrace] [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] avatarLeavesDomain(sessionID = '{858f91bc-51a5-4cef-ad91-ff4f8e11f84e}') at file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] <global>() at -1 [09/25 12:22:47] [DEBUG] [hifi.avatars] Removed avatar with UUID "7142ec2d-97be-4120-b4d0-09da67310884" from AvatarHashMap 0 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [FloofChat.js] [UncaughtException signalHandlerException] Error: Result of expression 'AvatarManager.getPalData([sessionID]).data[0]' [undefined] is not an object. in file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [Backtrace] [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] avatarLeavesDomain(sessionID = '{96531c05-2afa-4cbf-ab22-64e5d7b933c0}') at file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] <global>() at -1 [09/25 12:22:47] [DEBUG] [hifi.avatars] Removed avatar with UUID "c5d954fe-3e50-4cdb-b858-567fa8de5a5a" from AvatarHashMap 0 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [FloofChat.js] [UncaughtException signalHandlerException] Error: Result of expression 'AvatarManager.getPalData([sessionID]).data[0]' [undefined] is not an object. in file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [Backtrace] [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] avatarLeavesDomain(sessionID = '{03371271-251b-474a-aa5f-5b554315529c}') at file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] <global>() at -1 [09/25 12:22:47] [DEBUG] [hifi.avatars] Removed avatar with UUID "346f68cf-871b-497f-b310-907c599871d0" from AvatarHashMap 0 [09/25 12:22:47] [DEBUG] [hifi.avatars] Removed avatar with UUID "1e5b1291-8ff1-4eb5-bf14-b506c7c5c633" from AvatarHashMap 0 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [FloofChat.js] [UncaughtException signalHandlerException] Error: Result of expression 'AvatarManager.getPalData([sessionID]).data[0]' [undefined] is not an object. in file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [Backtrace] [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] avatarLeavesDomain(sessionID = '{7142ec2d-97be-4120-b4d0-09da67310884}') at file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] <global>() at -1 [09/25 12:22:47] [DEBUG] [hifi.avatars] Removed avatar with UUID "d1483178-5120-4d59-9485-a6e5910b609b" from AvatarHashMap 0 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [FloofChat.js] [UncaughtException signalHandlerException] Error: Result of expression 'AvatarManager.getPalData([sessionID]).data[0]' [undefined] is not an object. in file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [Backtrace] [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] avatarLeavesDomain(sessionID = '{c5d954fe-3e50-4cdb-b858-567fa8de5a5a}') at file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] <global>() at -1 [09/25 12:22:47] [DEBUG] [hifi.avatars] Removed avatar with UUID "1cc4572b-23a3-4e11-9270-b316fbce3483" from AvatarHashMap 0 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [FloofChat.js] [UncaughtException signalHandlerException] Error: Result of expression 'AvatarManager.getPalData([sessionID]).data[0]' [undefined] is not an object. in file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [Backtrace] [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] avatarLeavesDomain(sessionID = '{346f68cf-871b-497f-b310-907c599871d0}') at file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] <global>() at -1 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [FloofChat.js] [UncaughtException signalHandlerException] Error: Result of expression 'AvatarManager.getPalData([sessionID]).data[0]' [undefined] is not an object. in file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [Backtrace] [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] avatarLeavesDomain(sessionID = '{1e5b1291-8ff1-4eb5-bf14-b506c7c5c633}') at file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] <global>() at -1 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [FloofChat.js] [UncaughtException signalHandlerException] Error: Result of expression 'AvatarManager.getPalData([sessionID]).data[0]' [undefined] is not an object. in file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [Backtrace] [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] avatarLeavesDomain(sessionID = '{d1483178-5120-4d59-9485-a6e5910b609b}') at file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] <global>() at -1 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [FloofChat.js] [UncaughtException signalHandlerException] Error: Result of expression 'AvatarManager.getPalData([sessionID]).data[0]' [undefined] is not an object. in file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] [Backtrace] [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] avatarLeavesDomain(sessionID = '{1cc4572b-23a3-4e11-9270-b316fbce3483}') at file:///tmp/.mount_VircadhfWabC/vircadia/interface/scripts/communityScripts/chat/FloofChat.js:668 [09/25 12:22:47] [CRITICAL] [hifi.scriptengine] <global>() at -1 [09/25 12:22:47] [DEBUG] [hifi.interface] Application title set to: 178.62.77.222 (NOT CONNECTED) (Metaverse: Not Logged In) - Vircadia - Build v2021.1.1- [09/25 12:22:47] [DEBUG] [hifi.scriptengine] Clearing ATP scripts from ScriptCache [09/25 12:22:47] [DEBUG] [hifi.networking.ice] Sending connect request ( REASON: "SilentDomainDisconnect" ) to domain-server at "178.62.77.222" [09/25 12:22:47] [DEBUG] [hifi.networking] Creating new Connection class for 178.62.77.222:40102 [09/25 12:22:47] [DEBUG] [hifi.networking] NodeList UUID changed from "00000000-0000-0000-0000-000000000000" to "3e425a9f-5b06-4f18-bc5d-96721cd99401" [09/25 12:22:47] [DEBUG] [hifi.networking] Requesting settings from domain server [09/25 12:22:48] [DEBUG] [hifi.interface.deadlock] DEADLOCK WATCHDOG WARNING: lastHeartbeatAge: 51443 elapsedMovingAverage: 1770 maxElapsed: 2649757 PREVIOUS maxElapsedAverage: 1758 NEW maxElapsedAverage: 1770 NEW MAX ELAPSED AVERAGE samples: 3765 [09/25 12:22:48] [DEBUG] [hifi.networking] Received domain settings: [09/25 12:22:48] [DEBUG] [hifi.networking] QJsonObject({"avatars":{"avatar_whitelist":"https://cdn-1.vircadia.com/us-e-1/Bazaar/Avatars/Woody/mannequin.fst","max_avatar_height":5.2,"min_avatar_height":0.4,"replacement_avatar":""},"version":2.5}) [09/25 12:22:48] [DEBUG] [hifi.interface] This domain requires a minimum avatar scale of 0.4 and a maximum avatar scale of 5.2 [09/25 12:22:48] [DEBUG] [hifi.networking] Added "Asset Server" (A) {c180760f-5dd4-42a8-94af-ecdbd3e5c2ec}(1244) 178.62.77.222:48982 / 178.62.77.222:48982 [09/25 12:22:48] [DEBUG] [hifi.networking] Creating new Connection class for 178.62.77.222:48982 [09/25 12:22:48] [DEBUG] [hifi.networking] Added "Messages Mixer" (m) {4845ef0b-0275-400c-8c19-353cc6493944}(45533) 178.62.77.222:33430 / 178.62.77.222:33430 [09/25 12:22:48] [DEBUG] [hifi.networking] Creating new Connection class for 178.62.77.222:33430 [09/25 12:22:48] [DEBUG] [hifi.networking] Added "Entity Server" (o) {dbdc9043-b927-4cbe-9cfd-a596b28fe114}(24286) 178.62.77.222:38904 / 178.62.77.222:38904 [09/25 12:22:48] [DEBUG] [hifi.networking] Creating new Connection class for 178.62.77.222:38904 [09/25 12:22:48] [DEBUG] [hifi.networking] Added "Entity Script Server" (S) {8e6d6efb-8331-4d6d-83cc-f15b8723ba0b}(3039) 178.62.77.222:54280 / 178.62.77.222:54280 [09/25 12:22:48] [DEBUG] [hifi.networking] Creating new Connection class for 178.62.77.222:54280 [09/25 12:22:48] [DEBUG] [hifi.networking] Activating local socket for network peer with ID "4845ef0b-0275-400c-8c19-353cc6493944" [09/25 12:22:48] [DEBUG] [hifi.audioclient] getAvailableDevices Default device not found in list: "" Setting Default to: "default" [09/25 12:22:48] [DEBUG] [hifi.networking.ice] Sending connect request ( REASON: "Connect" ) to domain-server at "178.62.77.222" [09/25 12:22:48] [DEBUG] [hifi.audioclient] getAvailableDevices Default device not found in list: "" Setting Default to: "default" [09/25 12:22:48] [DEBUG] [hifi.networking] NodeList UUID changed from "3e425a9f-5b06-4f18-bc5d-96721cd99401" to "08be3274-dcc4-4d38-a5e1-d502f6b613ce" [09/25 12:22:48] [DEBUG] [hifi.networking] Requesting settings from domain server [09/25 12:22:48] [DEBUG] [hifi.networking] Domain ID changed to "bdd52145-988f-4e68-9717-25e363eef622" [09/25 12:22:48] [DEBUG] [hifi.interface] Application title set to: 178.62.77.222 (Metaverse: Not Logged In) - Vircadia - Build v2021.1.1- [09/25 12:22:48] [DEBUG] [hifi.networking] Added "Avatar Mixer" (W) {50f5347d-487b-4335-84c2-87bc510d6684}(18901) 178.62.77.222:50849 / 178.62.77.222:50849 [09/25 12:22:48] [DEBUG] [hifi.networking] Creating new Connection class for 178.62.77.222:50849 [09/25 12:22:48] [DEBUG] [hifi.networking] Added "Audio Mixer" (M) {9faf3888-c542-455c-9fa6-c47f8a91a546}(40148) 178.62.77.222:39031 / 178.62.77.222:39031 [09/25 12:22:48] [DEBUG] [hifi.networking] Creating new Connection class for 178.62.77.222:39031 [09/25 12:22:48] [DEBUG] [hifi.networking] Got HandshakeRequest from 178.62.77.222:40102 while active, stopping SendQueue [09/25 12:22:48] [DEBUG] [hifi.networking] Activating local socket for network peer with ID "50f5347d-487b-4335-84c2-87bc510d6684" [09/25 12:22:48] [DEBUG] [hifi.networking] Activating local socket for network peer with ID "9faf3888-c542-455c-9fa6-c47f8a91a546" [09/25 12:22:48] [DEBUG] [hifi.avatars] setSkeletonModelURL caller called with empty URL. [Previous message was repeated 1 times] [09/25 12:22:49] [DEBUG] [hifi.avatars] Adding avatar with sessionUUID QUuid("{a0e46aef-58f5-458b-9196-f1ea2bab1ae3}") to AvatarHashMap. [09/25 12:22:49] [DEBUG] [hifi.avatars] Adding avatar with sessionUUID QUuid("{442bc1b8-9d13-4069-8b8e-5aff07682168}") to AvatarHashMap. [09/25 12:22:49] [DEBUG] [hifi.avatars] Adding avatar with sessionUUID QUuid("{ab29d53e-d81c-4dbb-928a-c0a264574213}") to AvatarHashMap. [09/25 12:22:49] [DEBUG] [hifi.interface.deadlock] DEADLOCK WATCHDOG WARNING: lastHeartbeatAge: 51366 elapsedMovingAverage: 1771 maxElapsed: 2649757 PREVIOUS maxElapsedAverage: 1770 NEW maxElapsedAverage: 1771 NEW MAX ELAPSED AVERAGE samples: 3775 [09/25 12:22:49] [DEBUG] [hifi.avatars] Processing first identity packet for QUuid("{a0e46aef-58f5-458b-9196-f1ea2bab1ae3}") - 37 [09/25 12:22:49] [DEBUG] [hifi.avatars] Processing first identity packet for QUuid("{442bc1b8-9d13-4069-8b8e-5aff07682168}") - 15 [09/25 12:22:49] [DEBUG] [hifi.avatars] Processing first identity packet for QUuid("{ab29d53e-d81c-4dbb-928a-c0a264574213}") - 9 [09/25 12:22:49] [DEBUG] [hifi.avatars] Adding avatar with sessionUUID QUuid("{64ac4e3a-578b-4a9f-b88d-6674c0ea3d60}") to AvatarHashMap. [09/25 12:22:49] [DEBUG] [hifi.avatars] Adding avatar with sessionUUID QUuid("{15b1ef1a-5b5a-4606-b7b8-caa0e7ed53cf}") to AvatarHashMap. [09/25 12:22:49] [DEBUG] [hifi.networking] Activating local socket for network peer with ID "c180760f-5dd4-42a8-94af-ecdbd3e5c2ec" [09/25 12:22:49] [DEBUG] [hifi.networking] Activating local socket for network peer with ID "dbdc9043-b927-4cbe-9cfd-a596b28fe114" [09/25 12:22:49] [DEBUG] [hifi.networking] Activating local socket for network peer with ID "8e6d6efb-8331-4d6d-83cc-f15b8723ba0b" [09/25 12:22:49] [DEBUG] [hifi.avatars] Processing first identity packet for QUuid("{15b1ef1a-5b5a-4606-b7b8-caa0e7ed53cf}") - 7 [09/25 12:22:49] [DEBUG] [hifi.avatars] Adding avatar with sessionUUID QUuid("{2140c302-7dc2-4c11-ae95-735f9c5e7009}") to AvatarHashMap. [09/25 12:22:49] [DEBUG] [hifi.avatars] Processing first identity packet for QUuid("{64ac4e3a-578b-4a9f-b88d-6674c0ea3d60}") - 11 [09/25 12:22:49] [DEBUG] [hifi.file_cache] [ktx_cache] Found 3a7541d1ba18131f6de462e246574829 [09/25 12:22:49] [DEBUG] [hifi.file_cache] [ktx_cache] Found 77d336bf9f2aaaccf21507172acb7274 [09/25 12:22:49] [DEBUG] [hifi.avatars] Adding avatar with sessionUUID QUuid("{7c0252d1-9d36-4065-99a7-d22713002dd0}") to AvatarHashMap. [09/25 12:22:49] [DEBUG] [hifi.avatars] Adding avatar with sessionUUID QUuid("{32794a91-5734-4371-adad-04c28a52277a}") to AvatarHashMap. [09/25 12:22:49] [DEBUG] [hifi.avatars] Processing first identity packet for QUuid("{2140c302-7dc2-4c11-ae95-735f9c5e7009}") - 37 [09/25 12:22:50] [DEBUG] [hifi.avatars] Adding avatar with sessionUUID QUuid("{99206f21-dc45-4791-8ea6-e0e9c1110dc3}") to AvatarHashMap. [09/25 12:22:50] [DEBUG] [hifi.interface.deadlock] DEADLOCK WATCHDOG WARNING: lastHeartbeatAge: 47970 elapsedMovingAverage: 1773 maxElapsed: 2649757 PREVIOUS maxElapsedAverage: 1771 NEW maxElapsedAverage: 1773 NEW MAX ELAPSED AVERAGE samples: 3785 [09/25 12:22:50] [DEBUG] [hifi.avatars] Adding avatar with sessionUUID QUuid("{ce716500-33da-4806-9cc2-e0ef9ffb4e2f}") to AvatarHashMap. [09/25 12:22:50] [DEBUG] [hifi.networking] Got mapping for: "/castle10.fbx" => "f3c180e7ba3fc65e635fe90c0e8398d4dc6c5030eaeba2b9890c0e6b3deee847" [09/25 12:22:50] [DEBUG] [hifi.networking] Got mapping for: "/.baked/9737c1de08a9d263e378fb4b083e9af5cdd5a9f29c3f11fea758092b8293dfb6/castle10.baked.fbx" => "03f812ca98ebdf55c47493134bef112ceec43848fc7de46225132f3cc34aedb2" [09/25 12:22:50] [DEBUG] [hifi.modelformat] fbx material Name: "Material.001" [09/25 12:22:50] [DEBUG] [hifi.audioclient] getAvailableDevices Default device not found in list: "" Setting Default to: "default" [09/25 12:22:50] [DEBUG] [hifi.avatars] Adding avatar with sessionUUID QUuid("{6152e26c-06ed-4fa5-b55e-eb78318d258a}") to AvatarHashMap. [09/25 12:22:50] [DEBUG] [hifi.avatars] Processing first identity packet for QUuid("{32794a91-5734-4371-adad-04c28a52277a}") - 17 [09/25 12:22:50] [DEBUG] [hifi.networking] Got mapping for: "/.baked/9737c1de08a9d263e378fb4b083e9af5cdd5a9f29c3f11fea758092b8293dfb6/castle10.baked.json" => "6c17324ad70c554dfac9186ea23bd15e143c344a3fbddcb74d84ff0a89ef0e06" [09/25 12:22:50] [DEBUG] [hifi.physics] CharacterController::_isStuck : false --> true [09/25 12:22:50] [DEBUG] [hifi.audioclient] getAvailableDevices Default device not found in list: "" Setting Default to: "default" [09/25 12:22:50] [DEBUG] [hifi.networking] Got mapping for: "/.baked/9737c1de08a9d263e378fb4b083e9af5cdd5a9f29c3f11fea758092b8293dfb6/materialTextures/0/outside_2.texmeta.json" => "3db477604acc2c2113281cea8e397736bb6754925d01721f6a35a82faa7ae46b" [09/25 12:22:50] [DEBUG] [hifi.avatars] Processing first identity packet for QUuid("{ce716500-33da-4806-9cc2-e0ef9ffb4e2f}") - 7 [09/25 12:22:50] [DEBUG] [hifi.avatars] Processing first identity packet for QUuid("{7c0252d1-9d36-4065-99a7-d22713002dd0}") - 24 [09/25 12:22:50] [DEBUG] [hifi.avatars] Processing first identity packet for QUuid("{99206f21-dc45-4791-8ea6-e0e9c1110dc3}") - 7 [09/25 12:22:51] [DEBUG] [hifi.networking] Got mapping for: "/.baked/9737c1de08a9d263e378fb4b083e9af5cdd5a9f29c3f11fea758092b8293dfb6/materialTextures/0/outside_2_COMPRESSED_SRGB_S3TC_DXT1_EXT.ktx" => "8843d443d1080878e317e5c7e054d8d15b0af0a11db58fd468032df399767ab3" [09/25 12:22:51] [DEBUG] [hifi.networking.asset_client] Requesting data from 0 to 1000 of "8843d443d1080878e317e5c7e054d8d15b0af0a11db58fd468032df399767ab3" from asset-server. [09/25 12:22:51] [DEBUG] [hifi.networking] Got mapping for: "/.baked/9737c1de08a9d263e378fb4b083e9af5cdd5a9f29c3f11fea758092b8293dfb6/materialTextures/0/outside_2_COMPRESSED_SRGB_S3TC_DXT1_EXT.ktx" => "8843d443d1080878e317e5c7e054d8d15b0af0a11db58fd468032df399767ab3" [09/25 12:22:51] [DEBUG] [hifi.networking.asset_client] Requesting data from -5516 to 0 of "8843d443d1080878e317e5c7e054d8d15b0af0a11db58fd468032df399767ab3" from asset-server. [09/25 12:22:51] [DEBUG] [hifi.interface.deadlock] DEADLOCK WATCHDOG WARNING: lastHeartbeatAge: 45744 elapsedMovingAverage: 1777 maxElapsed: 2649757 PREVIOUS maxElapsedAverage: 1773 NEW maxElapsedAverage: 1777 NEW MAX ELAPSED AVERAGE samples: 3795 [09/25 12:22:51] [DEBUG] [hifi.networking.asset_client] Got reply for asset: "8843d443d1080878e317e5c7e054d8d15b0af0a11db58fd468032df399767ab3" [Previous message was repeated 1 times] [09/25 12:22:51] [DEBUG] [hifi.audioclient] handleMismatchAudioFormat sendingNode: "Audio Mixer" (M) {9faf3888-c542-455c-9fa6-c47f8a91a546}(40148) 178.62.77.222:39031 / 178.62.77.222:39031 currentCodec:""recievedCodec:"zlib" [09/25 12:22:51] [DEBUG] [hifi.audioclient] Selected Codec: "zlib" isStereoInput: false [09/25 12:22:51] [DEBUG] [hifi.audioclient] Selected Codec Plugin: zLibCodec(0x55d2474f8de0) [09/25 12:22:51] [DEBUG] [hifi.audio] Codec mismatch threshold exceeded, sent selected codec "zlib" to 178.62.77.222:39031 Vircadia-2021.1.1-Eos.AppImage: /home/motofckr9k/Vircadia/source/libraries/audio-client/src/AudioClient.cpp:1698: void AudioClient::processReceivedSamples(const QByteArray&, QByteArray&): Assertion `decodedBuffer.size() == AudioConstants::NETWORK_FRAME_BYTES_STEREO' failed.

daleglass commented 2 years ago

Ok, found the problem.

This gets called: https://github.com/vircadia/vircadia/blob/master/libraries/audio/src/MixedProcessedAudioStream.cpp#L49

That function does:

    virtual void lostFrame(QByteArray& decodedBuffer) override {
        memset(decodedBuffer.data(), 0, decodedBuffer.size());
    }

Since we just declared decodedBuffer above, it's empty. This trips up the check later.