-- Logs begin at Thu 2019-02-14 11:11:58 CET, end at Sun 2025-11-02 16:24:18 CET. -- Nov 02 16:23:19 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Nov 02 16:23:19 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Nov 02 16:23:19 volumio volumio[878]: info: Discovery: Getting this device information Nov 02 16:23:19 volumio volumio[878]: info: CoreCommandRouter::volumioGetState Nov 02 16:23:19 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Nov 02 16:23:19 volumio volumio[878]: verbose: New Socket.io Connection to 192.168.0.142:3000 from 192.168.0.243 UA: Dart/3.5 (dart:io) Engine version: 3 Transport: websocket Total Clients: 10 Nov 02 16:23:19 volumio volumio[878]: info: CoreCommandRouter::volumioGetState Nov 02 16:23:19 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Nov 02 16:23:19 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Nov 02 16:23:23 volumio volumio[878]: info: CoreCommandRouter::volumioGetState Nov 02 16:23:23 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Nov 02 16:23:23 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Nov 02 16:23:23 volumio volumio[878]: info: Discovery: Getting this device information Nov 02 16:23:23 volumio volumio[878]: info: CoreCommandRouter::volumioGetState Nov 02 16:23:24 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Nov 02 16:23:26 volumio volumio[878]: verbose: New Socket.io Connection to 192.168.0.142:3000 from 192.168.0.243 UA: Dart/3.5 (dart:io) Engine version: 3 Transport: websocket Total Clients: 11 Nov 02 16:23:27 volumio go-librespot[1299]: time="2025-11-02T16:23:27+01:00" level=trace msg="received accesspoint ping" Nov 02 16:23:27 volumio go-librespot[1299]: time="2025-11-02T16:23:27+01:00" level=trace msg="received accesspoint pong ack" Nov 02 16:23:27 volumio go-librespot[1299]: time="2025-11-02T16:23:27+01:00" level=trace msg="sent dealer ping" Nov 02 16:23:27 volumio volumio[878]: info: CoreCommandRouter::volumioGetState Nov 02 16:23:27 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Nov 02 16:23:27 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Nov 02 16:23:27 volumio go-librespot[1299]: time="2025-11-02T16:23:27+01:00" level=trace msg="received dealer pong" Nov 02 16:23:28 volumio volumio[878]: info: CoreCommandRouter::volumioGetState Nov 02 16:23:28 volumio sudo[8975]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Nov 02 16:23:28 volumio sudo[8975]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 02 16:23:28 volumio sudo[8975]: pam_unix(sudo:session): session closed for user root Nov 02 16:23:28 volumio sudo[8978]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Nov 02 16:23:28 volumio sudo[8978]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 02 16:23:28 volumio sudo[8978]: pam_unix(sudo:session): session closed for user root Nov 02 16:23:28 volumio volumio[878]: verbose: New Socket.io Connection to 192.168.0.142 from 192.168.0.243 UA: Mozilla/5.0 (Linux; Android 16; SM-S906B Build/BP2A.250605.031.A3; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/141.0.7390.122 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 12 Nov 02 16:23:28 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Nov 02 16:23:28 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Nov 02 16:23:29 volumio sudo[8981]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Nov 02 16:23:29 volumio sudo[8981]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 02 16:23:29 volumio sudo[8981]: pam_unix(sudo:session): session closed for user root Nov 02 16:23:29 volumio sudo[8984]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Nov 02 16:23:29 volumio sudo[8984]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 02 16:23:29 volumio sudo[8984]: pam_unix(sudo:session): session closed for user root Nov 02 16:23:29 volumio volumio[878]: verbose: New Socket.io Connection to 192.168.0.142 from 192.168.0.243 UA: Mozilla/5.0 (Linux; Android 16; SM-S906B Build/BP2A.250605.031.A3; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/141.0.7390.122 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 13 Nov 02 16:23:29 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Nov 02 16:23:29 volumio volumio[878]: info: CoreCommandRouter::volumioGetVisibleSources Nov 02 16:23:29 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Nov 02 16:23:29 volumio volumio[878]: info: CoreCommandRouter::volumioGetState Nov 02 16:23:29 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Nov 02 16:23:29 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Nov 02 16:23:29 volumio volumio[878]: info: Received Get System Info Nov 02 16:23:29 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Nov 02 16:23:29 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Nov 02 16:23:29 volumio volumio[878]: info: Discovery: Getting this device information Nov 02 16:23:29 volumio volumio[878]: info: CoreCommandRouter::volumioGetState Nov 02 16:23:29 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Nov 02 16:23:29 volumio volumio[878]: info: CoreCommandRouter::volumioGetState Nov 02 16:23:29 volumio volumio[878]: info: Listing playlists Nov 02 16:23:29 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Nov 02 16:23:29 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Nov 02 16:23:29 volumio volumio[878]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 02 16:23:29 volumio volumio[878]: info: FusionDsp - Choose a preset Nov 02 16:23:29 volumio volumio[878]: info: FusionDsp - Nov 02 16:23:29 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Nov 02 16:23:30 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Nov 02 16:23:31 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Nov 02 16:23:31 volumio volumio[878]: info: Received Get System Info Nov 02 16:23:31 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Nov 02 16:23:31 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Nov 02 16:23:31 volumio volumio[878]: info: Discovery: Getting this device information Nov 02 16:23:31 volumio volumio[878]: info: CoreCommandRouter::volumioGetState Nov 02 16:23:31 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Nov 02 16:23:31 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Nov 02 16:23:31 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken Nov 02 16:23:31 volumio volumio[878]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 02 16:23:31 volumio volumio[878]: info: FusionDsp - Choose a preset Nov 02 16:23:32 volumio volumio[878]: info: FusionDsp - Nov 02 16:23:32 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Nov 02 16:23:32 volumio volumio[878]: info: Received Get System Info Nov 02 16:23:32 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Nov 02 16:23:32 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Nov 02 16:23:32 volumio volumio[878]: info: Discovery: Getting this device information Nov 02 16:23:32 volumio volumio[878]: info: CoreCommandRouter::volumioGetState Nov 02 16:23:32 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Nov 02 16:23:37 volumio volumio[878]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 02 16:23:37 volumio volumio[878]: info: [ASDebug] Setting UI defaults Nov 02 16:23:37 volumio volumio[878]: info: [ASDebug] Port: 24 Nov 02 16:23:37 volumio volumio[878]: info: [ASDebug] Inverted: false Nov 02 16:23:37 volumio volumio[878]: info: [ASDebug] Latched: false Nov 02 16:23:37 volumio volumio[878]: info: [ASDebug] On pulse width: 500 Nov 02 16:23:37 volumio volumio[878]: info: [ASDebug] Off pulse width: 500 Nov 02 16:23:39 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Nov 02 16:23:48 volumio volumio[878]: info: CALLMETHOD: system_controller ampswitch saveOptions [object Object] Nov 02 16:23:48 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: ampswitch , saveOptions Nov 02 16:23:48 volumio volumio[878]: info: [ASDebug] Saving Settings: Port: 24 Nov 02 16:23:48 volumio volumio[878]: info: [ASDebug] Saving Settings: Inverted: true Nov 02 16:23:48 volumio volumio[878]: info: [ASDebug] Saving Settings: Delay: 720 Nov 02 16:23:48 volumio volumio[878]: info: [ASDebug] Saving Settings: Latched: false Nov 02 16:23:48 volumio volumio[878]: info: [ASDebug] Saving Settings: On Pulse width: 500 Nov 02 16:23:48 volumio volumio[878]: info: [ASDebug] Saving Settings: Off Pulse width: 500 Nov 02 16:23:48 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Nov 02 16:23:48 volumio volumio[878]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Nov 02 16:23:48 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Nov 02 16:23:48 volumio volumio[878]: info: Received Get System Version Nov 02 16:23:48 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Nov 02 16:23:48 volumio volumio[878]: info: Received Get System Info Nov 02 16:23:48 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Nov 02 16:23:48 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Nov 02 16:23:48 volumio volumio[878]: info: Discovery: Getting this device information Nov 02 16:23:48 volumio volumio[878]: info: CoreCommandRouter::volumioGetState Nov 02 16:23:48 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Nov 02 16:23:49 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Nov 02 16:23:49 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Nov 02 16:23:49 volumio volumio[878]: info: Discovery: Getting this device information Nov 02 16:23:49 volumio volumio[878]: info: CoreCommandRouter::volumioGetState Nov 02 16:23:49 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Nov 02 16:23:52 volumio volumio[878]: info: CoreCommandRouter::volumioVolatilePlay Nov 02 16:23:52 volumio volumio[878]: info: CoreStateMachine::volatilePlay Nov 02 16:23:52 volumio volumio[878]: info: ControllerMpd::play undefined Nov 02 16:23:52 volumio volumio[878]: verbose: ControllerMpd::sendMpdCommand play Nov 02 16:23:52 volumio volumio[878]: error: MPD error: Cannot read property 'toString' of undefined Nov 02 16:23:52 volumio volumio[878]: error: Cannot read property 'toString' of undefined Nov 02 16:23:57 volumio go-librespot[1299]: time="2025-11-02T16:23:57+01:00" level=trace msg="sent dealer ping" Nov 02 16:23:57 volumio go-librespot[1299]: time="2025-11-02T16:23:57+01:00" level=trace msg="received dealer pong" Nov 02 16:24:00 volumio volumio[878]: info: CoreCommandRouter::volumioVolatilePlay Nov 02 16:24:00 volumio volumio[878]: info: CoreStateMachine::volatilePlay Nov 02 16:24:00 volumio volumio[878]: info: ControllerMpd::play undefined Nov 02 16:24:00 volumio volumio[878]: verbose: ControllerMpd::sendMpdCommand play Nov 02 16:24:00 volumio volumio[878]: error: MPD error: Cannot read property 'toString' of undefined Nov 02 16:24:00 volumio volumio[878]: error: Cannot read property 'toString' of undefined Nov 02 16:24:03 volumio volumio[878]: info: CoreCommandRouter::volumioVolatilePlay Nov 02 16:24:03 volumio volumio[878]: info: CoreStateMachine::volatilePlay Nov 02 16:24:03 volumio volumio[878]: info: ControllerMpd::play undefined Nov 02 16:24:03 volumio volumio[878]: verbose: ControllerMpd::sendMpdCommand play Nov 02 16:24:03 volumio volumio[878]: error: MPD error: Cannot read property 'toString' of undefined Nov 02 16:24:03 volumio volumio[878]: error: Cannot read property 'toString' of undefined Nov 02 16:24:05 volumio volumio[878]: info: CoreCommandRouter::volumioGetQueue Nov 02 16:24:05 volumio volumio[878]: info: CoreStateMachine::getQueue Nov 02 16:24:05 volumio volumio[878]: info: CorePlayQueue::getQueue Nov 02 16:24:07 volumio volumio[878]: info: CoreCommandRouter::volumioVolatilePlay Nov 02 16:24:07 volumio volumio[878]: info: CoreStateMachine::volatilePlay Nov 02 16:24:07 volumio volumio[878]: info: ControllerMpd::play undefined Nov 02 16:24:07 volumio volumio[878]: verbose: ControllerMpd::sendMpdCommand play Nov 02 16:24:07 volumio volumio[878]: error: MPD error: Cannot read property 'toString' of undefined Nov 02 16:24:07 volumio volumio[878]: error: Cannot read property 'toString' of undefined Nov 02 16:24:10 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Nov 02 16:24:10 volumio volumio[878]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken Nov 02 16:24:14 volumio volumio[878]: info: [ASDebug] Port: 24 Nov 02 16:24:14 volumio volumio[878]: info: [ASDebug] Inverted: true Nov 02 16:24:14 volumio volumio[878]: info: [ASDebug] Delay: 720 Nov 02 16:24:18 volumio volumio[878]: info: [ASDebug] Port: 24 Nov 02 16:24:18 volumio volumio[878]: info: [ASDebug] Inverted: true Nov 02 16:24:18 volumio volumio[878]: info: [ASDebug] Delay: 720 Nov 02 16:24:18 volumio volumio[878]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Nov 02 16:24:18 volumio volumio[878]: Error: EBADF: bad file descriptor, close Nov 02 16:24:18 volumio volumio[878]: at Object.closeSync (fs.js:439:3) Nov 02 16:24:18 volumio volumio[878]: at Object.closeSync (/volumio/node_modules/graceful-fs/graceful-fs.js:74:20) Nov 02 16:24:18 volumio volumio[878]: at Object.closeSync (/data/plugins/system_controller/ampswitch/node_modules/graceful-fs/graceful-fs.js:51:27) Nov 02 16:24:18 volumio volumio[878]: at Gpio.unexport (/data/plugins/system_controller/ampswitch/node_modules/onoff/onoff.js:307:8) Nov 02 16:24:18 volumio volumio[878]: at AmpSwitchController.freeGPIO (/data/plugins/system_controller/ampswitch/index.js:242:19) Nov 02 16:24:18 volumio volumio[878]: at AmpSwitchController.onStop (/data/plugins/system_controller/ampswitch/index.js:90:10) Nov 02 16:24:18 volumio volumio[878]: at PluginManager.stopPlugin (/volumio/app/pluginmanager.js:460:30) Nov 02 16:24:18 volumio volumio[878]: at PluginManager.disableAndStopPlugin (/volumio/app/pluginmanager.js:1883:8) Nov 02 16:24:18 volumio volumio[878]: at CoreCommandRouter.disableAndStopPlugin (/volumio/app/index.js:1556:29) Nov 02 16:24:18 volumio volumio[878]: at Socket. (/volumio/app/plugins/user_interface/websocket/index.js:1401:47) Nov 02 16:24:18 volumio volumio[878]: at Socket.emit (events.js:315:20) Nov 02 16:24:18 volumio volumio[878]: at /volumio/node_modules/socket.io/lib/socket.js:528:12 Nov 02 16:24:18 volumio volumio[878]: at processTicksAndRejections (internal/process/task_queues.js:75:11) { Nov 02 16:24:18 volumio volumio[878]: errno: -9, Nov 02 16:24:18 volumio volumio[878]: syscall: 'close', Nov 02 16:24:18 volumio volumio[878]: code: 'EBADF' Nov 02 16:24:18 volumio volumio[878]: } Nov 02 16:24:18 volumio volumio[878]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Nov 02 16:24:18 volumio sudo[9126]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-11-02 16:23 Nov 02 16:24:18 volumio sudo[9126]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Raspbian GNU/Linux 10 (buster)" NAME="Raspbian GNU/Linux" VERSION_ID="10" VERSION="10 (buster)" VERSION_CODENAME=buster ID=raspbian ID_LIKE=debian HOME_URL="http://www.raspbian.org/" SUPPORT_URL="http://www.raspbian.org/RaspbianForums" BUG_REPORT_URL="http://www.raspbian.org/RaspbianBugs" VOLUMIO_BUILD_VERSION="5d50cd80bebce60dddccd7f5e813d656e28ca4cd" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="7840f283c310c38bfe939a4c485727a6ff6a0ce1" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue 21 Oct 2025 03:46:47 PM CEST" VOLUMIO_VERSION="3.866" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="8e2f3a8aca3147ba51b5da8167dd6ff8"