-- Logs begin at Thu 2019-02-14 10:11:59 UTC, end at Sat 2024-05-11 17:36:44 UTC. -- May 11 17:35:02 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 11 17:35:06 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 11 17:35:10 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 11 17:35:12 mifi volumio[819]: info: CALLMETHOD: miscellanea albumart clearAlbumartCache May 11 17:35:12 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: albumart , clearAlbumartCache May 11 17:35:12 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: mpd , rebuildAlbumCache May 11 17:35:12 mifi volumio[819]: info: Rebuild Album cache May 11 17:35:13 mifi volumio[819]: info: CALLMETHOD: miscellanea albumart saveAlbumartOptions [object Object] May 11 17:35:13 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: albumart , saveAlbumartOptions May 11 17:35:14 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 11 17:35:18 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 11 17:35:22 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 11 17:35:26 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 11 17:35:30 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 11 17:35:34 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 11 17:35:43 mifi volumio[819]: info: Airplay started streaming, receiving metadatas May 11 17:35:43 mifi volumio[819]: info: Airplay started streaming, receiving metadatas May 11 17:35:43 mifi volumio[819]: info: Airplay started streaming, receiving metadatas May 11 17:35:43 mifi volumio[819]: info: Airplay started streaming, receiving metadatas May 11 17:35:43 mifi shairport-sync[1311]: % Total % Received % Xferd Average Speed Time Time Time Current May 11 17:35:43 mifi shairport-sync[1311]: Dload Upload Total Spent Left Speed May 11 17:35:43 mifi volumio[819]: info: May 11 17:35:43 mifi volumio[819]: ---------------------------- Client requests Start Airplay PlaybackRoutine May 11 17:35:43 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: airplay_emulation , startAirplayPlayback May 11 17:35:43 mifi volumio[819]: info: Airplay playback start May 11 17:35:43 mifi shairport-sync[1311]: [158B blob data] May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:44 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:44 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:44 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:44 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:44 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:44 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:44 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:44 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:44 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:44 mifi kernel: bcm2835-i2s 3f203000.i2s: I2S SYNC error! May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:44 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:44 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:44 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:44 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:44 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:44 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:44 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:44 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:47 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:47 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:47 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:47 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:47 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:47 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:47 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:47 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:47 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:47 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:47 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:52 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:52 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:52 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 11 17:35:52 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:52 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:52 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:52 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:52 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:52 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:52 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:52 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:52 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:52 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:52 mifi volumio[819]: info: CoreCommandRouter::servicePushState May 11 17:35:52 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:52 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:52 mifi shairport-sync[1311]: {"time":1715448943352,"response":"startAirplayPlayback Success"} % Total % Received % Xferd Average Speed Time Time Time Current May 11 17:35:52 mifi shairport-sync[1311]: Dload Upload Total Spent Left Speed May 11 17:35:52 mifi volumio[819]: info: May 11 17:35:52 mifi volumio[819]: ---------------------------- Client requests Stop Airplay Playback May 11 17:35:52 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: airplay_emulation , stopAirplayPlayback May 11 17:35:52 mifi volumio[819]: info: Airplay playback stop May 11 17:35:52 mifi volumio[819]: info: Airplay Playback Stopped, clearing state May 11 17:35:52 mifi volumio[819]: info: CoreStateMachine::resetVolumioState May 11 17:35:52 mifi volumio[819]: info: CoreStateMachine::getcurrentVolume May 11 17:35:52 mifi volumio[819]: info: CoreCommandRouter::volumioRetrievevolume May 11 17:35:52 mifi volumio[819]: info: CoreStateMachine::pushState May 11 17:35:52 mifi volumio[819]: info: CoreCommandRouter::volumioPushState May 11 17:35:52 mifi shairport-sync[1311]: [158B blob data] May 11 17:36:29 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 11 17:36:29 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 11 17:36:29 mifi volumio[819]: info: Discovery: Getting this device information May 11 17:36:29 mifi volumio[819]: info: CoreCommandRouter::volumioGetState May 11 17:36:29 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 11 17:36:29 mifi volumio[819]: verbose: New Socket.io Connection to 192.168.0.46 from 192.168.0.228 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 17_4_1 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Total Clients: 4 May 11 17:36:29 mifi volumio[819]: info: CoreCommandRouter::volumioGetState May 11 17:36:29 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom May 11 17:36:29 mifi volumio[819]: info: Listing playlists May 11 17:36:29 mifi volumio[819]: info: CoreCommandRouter::volumioGetQueue May 11 17:36:29 mifi volumio[819]: info: CoreStateMachine::getQueue May 11 17:36:29 mifi volumio[819]: info: CorePlayQueue::getQueue May 11 17:36:32 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 11 17:36:36 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 11 17:36:40 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 11 17:36:41 mifi volumio[819]: info: Disabling MyMusic plugin upnp May 11 17:36:42 mifi sudo[1351]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop upmpdcli.service May 11 17:36:42 mifi sudo[1351]: pam_unix(sudo:session): session opened for user root by (uid=0) May 11 17:36:42 mifi systemd[1]: Stopping UPnP Renderer front-end to MPD... May 11 17:36:42 mifi volumio[819]: error: Upnp client error: Error: This socket has been ended by the other party May 11 17:36:42 mifi volumio[819]: info: Enabling MyMusic plugin upnp May 11 17:36:42 mifi volumio[819]: info: Enabling plugin upnp May 11 17:36:42 mifi volumio[819]: info: Loading plugin "upnp"... May 11 17:36:42 mifi volumio[819]: info: [1715449002899] Starting Upmpd Daemon May 11 17:36:42 mifi volumio[819]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback May 11 17:36:42 mifi volumio[819]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 11 17:36:42 mifi volumio[819]: Error: listen EADDRINUSE: address already in use :::6599 May 11 17:36:42 mifi volumio[819]: at Server.setupListenHandle [as _listen2] (net.js:1318:16) May 11 17:36:42 mifi volumio[819]: at listenInCluster (net.js:1366:12) May 11 17:36:42 mifi volumio[819]: at Server.listen (net.js:1452:7) May 11 17:36:42 mifi volumio[819]: at UpnpInterface.onVolumioStart (/volumio/app/plugins/audio_interface/upnp/index.js:78:17) May 11 17:36:42 mifi volumio[819]: at PluginManager.loadCorePlugin (/volumio/app/pluginmanager.js:255:38) May 11 17:36:42 mifi volumio[819]: at Promise._successFn (/volumio/app/pluginmanager.js:1841:19) May 11 17:36:42 mifi volumio[819]: at nextTickCallback (/volumio/node_modules/kew/kew.js:47:28) May 11 17:36:42 mifi volumio[819]: at processTicksAndRejections (internal/process/task_queues.js:75:11) { May 11 17:36:42 mifi volumio[819]: code: 'EADDRINUSE', May 11 17:36:42 mifi volumio[819]: errno: -98, May 11 17:36:42 mifi volumio[819]: syscall: 'listen', May 11 17:36:42 mifi volumio[819]: address: '::', May 11 17:36:42 mifi volumio[819]: port: 6599 May 11 17:36:42 mifi volumio[819]: } May 11 17:36:42 mifi volumio[819]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 11 17:36:44 mifi sudo[1362]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-05-11 17:35 May 11 17:36:44 mifi sudo[1362]: 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="9eadfb08439e8c37bef9a38c0641d736c1391e0c" VOLUMIO_FE_VERSION="e6f7875b0e497e33187ca2553d7998c4aeb06af9" VOLUMIO_FE3_VERSION="8d9f9503eeacae3e8f349def90b368b32462d83b" VOLUMIO_BE_VERSION="1cdccc4d006cc26abc6312edbeae58f3081200d4" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Thu 24 Feb 2022 07:16:13 PM CET" VOLUMIO_VERSION="3.233" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="88d67d58bfcedcd908dd7b955a1fa5bd"