-- Logs begin at Fri 2024-11-29 13:08:06 UTC, end at Sat 2024-11-30 09:06:58 UTC. -- Nov 30 09:05:01 volumio volumio[965]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Nov 30 09:05:01 volumio volumio[965]: { Error: connect ECONNREFUSED 93.179.102.140:80 Nov 30 09:05:01 volumio volumio[965]: at Object._errnoException (util.js:1022:11) Nov 30 09:05:01 volumio volumio[965]: at _exceptionWithHostPort (util.js:1044:20) Nov 30 09:05:01 volumio volumio[965]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1198:14) Nov 30 09:05:01 volumio volumio[965]: code: 'ECONNREFUSED', Nov 30 09:05:01 volumio volumio[965]: errno: 'ECONNREFUSED', Nov 30 09:05:01 volumio volumio[965]: syscall: 'connect', Nov 30 09:05:01 volumio volumio[965]: address: '93.179.102.140', Nov 30 09:05:01 volumio volumio[965]: port: 80 } Nov 30 09:05:01 volumio volumio[965]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Nov 30 09:05:02 volumio sudo[1596]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-11-30 09:04 Nov 30 09:05:02 volumio sudo[1596]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 09:05:02 volumio sudo[1596]: pam_unix(sudo:session): session closed for user root Nov 30 09:05:03 volumio volumio-remote-updater[609]: [2024-11-30 09:05:03] [error] handle_read_frame error: websocketpp.transport:7 (End of File) Nov 30 09:05:03 volumio volumio-remote-updater[609]: [2024-11-30 09:05:03] [disconnect] Disconnect close local:[1006,End of File] remote:[1006] Nov 30 09:05:03 volumio systemd[1]: volumio.service: main process exited, code=exited, status=1/FAILURE Nov 30 09:05:03 volumio systemd[1]: Unit volumio.service entered failed state. Nov 30 09:05:03 volumio systemd[1]: Starting dynamicswap service... Nov 30 09:05:03 volumio systemd[1]: Started dynamicswap service. Nov 30 09:05:03 volumio systemd[1]: volumio.service holdoff time over, scheduling restart. Nov 30 09:05:03 volumio systemd[1]: Starting dynamicswap service... Nov 30 09:05:03 volumio systemd[1]: Started dynamicswap service. Nov 30 09:05:03 volumio systemd[1]: Stopping Volumio Backend Module... Nov 30 09:05:03 volumio systemd[1]: Starting Volumio Backend Module... Nov 30 09:05:03 volumio systemd[1]: Started Volumio Backend Module. Nov 30 09:05:04 volumio volumio[1620]: info: ------------------------------------------- Nov 30 09:05:04 volumio volumio[1620]: info: ----- Volumio2 ---- Nov 30 09:05:04 volumio volumio[1620]: info: ------------------------------------------- Nov 30 09:05:04 volumio volumio[1620]: info: ----- System startup ---- Nov 30 09:05:04 volumio volumio[1620]: info: ------------------------------------------- Nov 30 09:05:04 volumio volumio[1620]: info: MYVOLUMIO Environment detected Nov 30 09:05:05 volumio volumio[1620]: info: Plugin folders cleanup Nov 30 09:05:05 volumio volumio[1620]: info: Scanning into folder /volumio/app/plugins/ Nov 30 09:05:05 volumio volumio[1620]: info: Scanning category audio_interface Nov 30 09:05:05 volumio volumio[1620]: info: Scanning category miscellanea Nov 30 09:05:05 volumio volumio[1620]: info: Scanning category music_service Nov 30 09:05:05 volumio volumio[1620]: info: Scanning category plugins.json Nov 30 09:05:05 volumio volumio[1620]: info: Scanning category system_controller Nov 30 09:05:05 volumio volumio[1620]: info: Scanning category user_interface Nov 30 09:05:05 volumio volumio[1620]: info: Scanning into folder /data/plugins/ Nov 30 09:05:05 volumio volumio[1620]: info: Plugin folders cleanup completed Nov 30 09:05:05 volumio volumio[1620]: info: ------------------------------------------- Nov 30 09:05:05 volumio volumio[1620]: info: ----- Core plugins startup ---- Nov 30 09:05:05 volumio volumio[1620]: info: ------------------------------------------- Nov 30 09:05:05 volumio volumio[1620]: info: Loading plugins from folder /volumio/app/plugins/ Nov 30 09:05:05 volumio volumio[1620]: info: Adding plugin upnp to MyMusic Plugins Nov 30 09:05:05 volumio volumio[1620]: info: Adding plugin airplay_emulation to MyMusic Plugins Nov 30 09:05:05 volumio volumio[1620]: info: Adding plugin upnp_browser to MyMusic Plugins Nov 30 09:05:05 volumio volumio[1620]: info: Loading plugins from folder /data/plugins/ Nov 30 09:05:05 volumio volumio[1620]: info: Loading plugin "system"... Nov 30 09:05:05 volumio volumio[1620]: info: Loading plugin "appearance"... Nov 30 09:05:05 volumio volumio[1620]: info: Loading plugin "network"... Nov 30 09:05:05 volumio volumio[1620]: info: Refreshing Cached IP Addresses Nov 30 09:05:05 volumio sudo[1663]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Nov 30 09:05:05 volumio volumio[1620]: info: Loading plugin "services"... Nov 30 09:05:05 volumio volumio[1620]: info: Loading plugin "alsa_controller"... Nov 30 09:05:05 volumio sudo[1663]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 09:05:05 volumio sudo[1665]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Nov 30 09:05:05 volumio sudo[1663]: pam_unix(sudo:session): session closed for user root Nov 30 09:05:05 volumio sudo[1665]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 09:05:05 volumio sudo[1665]: pam_unix(sudo:session): session closed for user root Nov 30 09:05:05 volumio volumio[1620]: info: Loading plugin "wizard"... Nov 30 09:05:05 volumio volumio[1620]: info: Loading plugin "volumio_command_line_client"... Nov 30 09:05:05 volumio volumio[1620]: info: Loading plugin "upnp"... Nov 30 09:05:05 volumio volumio[1620]: info: [1732957505796] Starting Upmpd Daemon Nov 30 09:05:05 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Nov 30 09:05:05 volumio volumio[1620]: info: Loading plugin "my_music"... Nov 30 09:05:05 volumio volumio[1620]: info: Loading plugin "mpd"... Nov 30 09:05:06 volumio volumio[1620]: info: Loading plugin "upnp_browser"... Nov 30 09:05:06 volumio volumio[1620]: info: Loading plugin "networkfs"... Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Nov 30 09:05:06 volumio volumio[1620]: info: Loading plugin "alarm-clock"... Nov 30 09:05:06 volumio volumio[1620]: info: Loading plugin "airplay_emulation"... Nov 30 09:05:06 volumio volumio[1620]: info: Starting Shairport Sync Nov 30 09:05:06 volumio volumio[1620]: info: Loading plugin "last_100"... Nov 30 09:05:06 volumio volumio[1620]: info: Loading plugin "webradio"... Nov 30 09:05:06 volumio volumio[1620]: info: Loading plugin "i2s_dacs"... Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Nov 30 09:05:06 volumio volumio[1620]: info: Loading plugin "volumiodiscovery"... Nov 30 09:05:06 volumio volumio[1620]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Nov 30 09:05:06 volumio node[1620]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Nov 30 09:05:06 volumio node[1620]: *** WARNING *** Please fix your application to use the native API of Avahi! Nov 30 09:05:06 volumio node[1620]: *** WARNING *** For more information see Nov 30 09:05:06 volumio node[1620]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Nov 30 09:05:06 volumio node[1620]: *** WARNING *** Please fix your application to use the native API of Avahi! Nov 30 09:05:06 volumio node[1620]: *** WARNING *** For more information see Nov 30 09:05:06 volumio volumio[1620]: *** WARNING *** Please fix your application to use the native API of Avahi! Nov 30 09:05:06 volumio volumio[1620]: *** WARNING *** For more information see Nov 30 09:05:06 volumio volumio[1620]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Nov 30 09:05:06 volumio volumio[1620]: *** WARNING *** Please fix your application to use the native API of Avahi! Nov 30 09:05:06 volumio volumio[1620]: *** WARNING *** For more information see Nov 30 09:05:06 volumio volumio[1620]: info: Applying required configuration parameters for plugin volumiodiscovery Nov 30 09:05:06 volumio volumio[1620]: Discovery: StartAdv! undefined Nov 30 09:05:06 volumio volumio[1620]: Discovery: Started advertising... Volumio - undefined Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Nov 30 09:05:06 volumio volumio[1620]: info: Loading plugin "outputs"... Nov 30 09:05:06 volumio volumio[1620]: info: Loading plugin "albumart"... Nov 30 09:05:06 volumio volumio[1620]: info: Plugin example_plugin is not enabled Nov 30 09:05:06 volumio volumio[1620]: info: Loading plugin "inputs"... Nov 30 09:05:06 volumio volumio[1620]: info: Loading plugin "updater_comm"... Nov 30 09:05:06 volumio volumio[1620]: info: Plugin mpdemulation is not enabled Nov 30 09:05:06 volumio volumio[1620]: info: Loading plugin "rest_api"... Nov 30 09:05:06 volumio volumio[1620]: info: Loading plugin "websocket"... Nov 30 09:05:06 volumio volumio[1620]: info: ___________ START PLUGINS ___________ Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Nov 30 09:05:06 volumio volumio[1620]: info: [1732957506682] CoreMusicLibrary::Adding element Media Servers Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Nov 30 09:05:06 volumio volumio[1620]: Forking 3 albumart workers Nov 30 09:05:06 volumio volumio[1620]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Nov 30 09:05:06 volumio volumio[1620]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Nov 30 09:05:06 volumio volumio[1620]: info: [1732957506774] CoreMusicLibrary::Adding element Last_100 Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Nov 30 09:05:06 volumio volumio[1620]: info: [1732957506776] CoreMusicLibrary::Adding element Webradio Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Nov 30 09:05:06 volumio volumio[1620]: info: ------------------------------------------- Nov 30 09:05:06 volumio volumio[1620]: info: ----- MyVolumio plugins startup ---- Nov 30 09:05:06 volumio volumio[1620]: info: ------------------------------------------- Nov 30 09:05:06 volumio volumio[1620]: info: [MyVolumio PluginManager] Fetching plans data.... Nov 30 09:05:06 volumio volumio[1620]: info: Loading i18n strings for locale zh Nov 30 09:05:06 volumio volumio[1620]: Updating browse sources language Nov 30 09:05:06 volumio volumio[1620]: Cannot find translation for sourceMedia Servers Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::initPlayerControls Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getAlsaCards Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Nov 30 09:05:06 volumio volumio[1620]: info: BOOT COMPLETED Nov 30 09:05:06 volumio volumio[1620]: [Metrics] CommandRouter: 2s 269.70ms Nov 30 09:05:06 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Nov 30 09:05:07 volumio volumio[1620]: Starting albumart workers Nov 30 09:05:07 volumio volumio[1620]: Starting albumart workers Nov 30 09:05:07 volumio volumio[1620]: Starting albumart workers Nov 30 09:05:08 volumio volumio-remote-updater[609]: [2024-11-30 09:05:08] [connect] Successful connection Nov 30 09:05:12 volumio volumio[1620]: Playing WAVE '/volumio/app/startup.wav' : Signed 16 bit Little Endian, Rate 44100 Hz, Stereo Nov 30 09:05:12 volumio volumio[1620]: info: CoreCommandRouter::Close All Modals sent Nov 30 09:05:12 volumio volumio[1620]: info: CoreCommandRouter::Close All Modals sent Nov 30 09:05:12 volumio volumio[1620]: Express server listening on port 3000 Nov 30 09:05:12 volumio volumio[1620]: [Metrics] WebUI: 7s 820.28ms Nov 30 09:05:12 volumio volumio[1620]: Volumio Calling Home Nov 30 09:05:12 volumio volumio[1620]: info: CoreStateMachine::resetVolumioState Nov 30 09:05:12 volumio volumio[1620]: info: CoreStateMachine::getcurrentVolume Nov 30 09:05:12 volumio volumio[1620]: info: CoreCommandRouter::volumioRetrievevolume Nov 30 09:05:12 volumio volumio[1620]: info: CoreStateMachine::pushState Nov 30 09:05:12 volumio volumio[1620]: info: CorePlayQueue::getTrack 0 Nov 30 09:05:12 volumio volumio[1620]: info: CoreCommandRouter::volumioPushState Nov 30 09:05:12 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 30 09:05:12 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Nov 30 09:05:12 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 30 09:05:12 volumio volumio[1620]: info: Setting Device type: Raspberry PI Nov 30 09:05:12 volumio volumio[1620]: info: MPD running with PID676 Nov 30 09:05:12 volumio volumio[1620]: ,establishing connection Nov 30 09:05:12 volumio volumio-remote-updater[609]: [2024-11-30 09:05:12] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.5.1" /socket.io/?EIO=4&transport=websocket&t=1732957508 101 Nov 30 09:05:12 volumio volumio[1620]: info: Reloading queue from file Nov 30 09:05:12 volumio volumio[1620]: error: updateQueue error: null Nov 30 09:05:12 volumio volumio[1620]: error: Failed LSINFO: Error: [50@0] {} No such directory Nov 30 09:05:12 volumio kernel: usb 2-1: new SuperSpeed Gen 1 USB device number 2 using xhci_hcd Nov 30 09:05:12 volumio kernel: usb 2-1: New USB device found, idVendor=152d, idProduct=0567, bcdDevice= 3.24 Nov 30 09:05:12 volumio kernel: usb 2-1: New USB device strings: Mfr=1, Product=2, SerialNumber=3 Nov 30 09:05:12 volumio kernel: usb 2-1: Product: USB to ATA/ATAPI Bridge Nov 30 09:05:12 volumio kernel: usb 2-1: Manufacturer: JMicron Nov 30 09:05:12 volumio kernel: usb 2-1: SerialNumber: 0123456789ABCDEF Nov 30 09:05:12 volumio kernel: usb-storage 2-1:1.0: USB Mass Storage device detected Nov 30 09:05:12 volumio kernel: usb-storage 2-1:1.0: Quirks match for vid 152d pid 0567: 5000000 Nov 30 09:05:12 volumio kernel: scsi host0: usb-storage 2-1:1.0 Nov 30 09:05:12 volumio volumio[1620]: info: CoreStateMachine::setRepeat true single undefined Nov 30 09:05:12 volumio volumio[1620]: info: CoreStateMachine::pushState Nov 30 09:05:12 volumio volumio[1620]: info: CorePlayQueue::getTrack 0 Nov 30 09:05:12 volumio volumio[1620]: info: CoreCommandRouter::volumioPushState Nov 30 09:05:12 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 30 09:05:12 volumio volumio[1620]: info: CoreStateMachine::setRandom false Nov 30 09:05:12 volumio volumio[1620]: info: CoreStateMachine::pushState Nov 30 09:05:12 volumio volumio[1620]: info: CorePlayQueue::getTrack 0 Nov 30 09:05:12 volumio volumio[1620]: info: CoreCommandRouter::volumioPushState Nov 30 09:05:12 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 30 09:05:12 volumio volumio[1620]: Discovery: adding 4e36fd61-553f-4f13-9996-407abb51a2d3 Nov 30 09:05:12 volumio volumio[1620]: info: mDNS: Found device Volumio Nov 30 09:05:12 volumio volumio[1620]: info: CoreCommandRouter::volumioGetState Nov 30 09:05:12 volumio volumio[1620]: info: CorePlayQueue::getTrack 0 Nov 30 09:05:12 volumio volumio[1620]: Discovery: this is already registered, 4e36fd61-553f-4f13-9996-407abb51a2d3 Nov 30 09:05:12 volumio volumio[1620]: info: mDNS: Found device Volumio Nov 30 09:05:12 volumio volumio[1620]: info: CoreCommandRouter::volumioGetState Nov 30 09:05:12 volumio volumio[1620]: info: CorePlayQueue::getTrack 0 Nov 30 09:05:12 volumio volumio[1620]: info: Starting Shairport Sync Nov 30 09:05:12 volumio volumio[1620]: info: Starting Shairport Sync Nov 30 09:05:12 volumio sudo[1760]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Nov 30 09:05:12 volumio sudo[1760]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 09:05:12 volumio sudo[1762]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Nov 30 09:05:12 volumio sudo[1762]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 09:05:12 volumio systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Nov 30 09:05:12 volumio systemd[1]: Starting Shairport Sync - AirPlay Audio Receiver... Nov 30 09:05:12 volumio systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Nov 30 09:05:12 volumio sudo[1760]: pam_unix(sudo:session): session closed for user root Nov 30 09:05:12 volumio systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Nov 30 09:05:12 volumio systemd[1]: Starting Shairport Sync - AirPlay Audio Receiver... Nov 30 09:05:12 volumio systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Nov 30 09:05:12 volumio sudo[1762]: pam_unix(sudo:session): session closed for user root Nov 30 09:05:12 volumio volumio[1620]: info: Shairport-Sync Started Nov 30 09:05:12 volumio volumio[1620]: Error adding Membership: Error: addMembership EINVAL Nov 30 09:05:12 volumio volumio[1620]: info: Shairport-Sync Started Nov 30 09:05:12 volumio volumio[1620]: info: CoreCommandRouter::volumioGetState Nov 30 09:05:12 volumio volumio[1620]: info: CorePlayQueue::getTrack 0 Nov 30 09:05:13 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkAudioDeviceAvailable Nov 30 09:05:13 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Nov 30 09:05:13 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: system , versionChangeDetect Nov 30 09:05:13 volumio kernel: scsi 0:0:0:0: Direct-Access JMicron Generic DISK00 0103 PQ: 0 ANSI: 6 Nov 30 09:05:13 volumio kernel: sd 0:0:0:0: [sda] 976773168 512-byte logical blocks: (500 GB/466 GiB) Nov 30 09:05:13 volumio kernel: sd 0:0:0:0: [sda] Write Protect is off Nov 30 09:05:13 volumio kernel: sd 0:0:0:0: [sda] Mode Sense: 2b 00 00 00 Nov 30 09:05:13 volumio kernel: sd 0:0:0:0: [sda] No Caching mode page found Nov 30 09:05:13 volumio kernel: sd 0:0:0:0: [sda] Assuming drive cache: write through Nov 30 09:05:13 volumio kernel: sda: sda1 Nov 30 09:05:13 volumio kernel: sd 0:0:0:0: [sda] Attached SCSI disk Nov 30 09:05:13 volumio kernel: sd 0:0:0:0: Attached scsi generic sg0 type 0 Nov 30 09:05:13 volumio udisks-glue[606]: Device file /dev/sda inserted Nov 30 09:05:14 volumio udisks-glue[606]: Device file /dev/sda1 inserted Nov 30 09:05:14 volumio udisks-glue[606]: Trying to automount /dev/sda1... Nov 30 09:05:14 volumio ntfs-3g[1802]: Version 2014.2.15AR.2 integrated FUSE 28 Nov 30 09:05:14 volumio ntfs-3g[1802]: Mounted /dev/sda1 (Read-Write, label "新加卷", NTFS 3.1) Nov 30 09:05:14 volumio ntfs-3g[1802]: Cmdline options: rw,nodev,nosuid,noatime,uid=1000,gid=1000,dmask=0077,fmask=0177,dmask=0000,fmask=0000,uhelper=udisks Nov 30 09:05:14 volumio ntfs-3g[1802]: Mount options: rw,nodev,nosuid,uhelper=udisks,allow_other,nonempty,noatime,default_permissions,fsname=/dev/sda1,blkdev,blksize=4096 Nov 30 09:05:14 volumio ntfs-3g[1802]: Global ownership and permissions enforced, configuration type 7 Nov 30 09:05:14 volumio udisks-glue[606]: Successfully automounted /dev/sda1 at /media/??? Nov 30 09:05:14 volumio udisks-glue[606]: Device file /dev/sda1 mounted at /media/??? Nov 30 09:05:14 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand status Nov 30 09:05:14 volumio volumio[1620]: info: Nov 30 09:05:14 volumio volumio[1620]: ---------------------------- MPD announces state update: update Nov 30 09:05:14 volumio volumio[1620]: info: ControllerMpd::getState Nov 30 09:05:14 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand status Nov 30 09:05:14 volumio volumio[1620]: verbose: ControllerMpd::parseState Nov 30 09:05:14 volumio udisks-glue[606]: Updating DB (#2) ... Nov 30 09:05:14 volumio udisks-glue[606]: volume:100% repeat: off random: off single: off consume: off Nov 30 09:05:15 volumio volumio[1620]: info: Command Router : Notfying DB Updatetrue Nov 30 09:05:15 volumio volumio[1620]: verbose: ControllerMpd::parseState Nov 30 09:05:15 volumio volumio[1620]: info: ControllerMpd::pushState Nov 30 09:05:15 volumio volumio[1620]: info: CoreCommandRouter::servicePushState Nov 30 09:05:15 volumio volumio[1620]: info: CoreStateMachine::pushState Nov 30 09:05:15 volumio volumio[1620]: info: CorePlayQueue::getTrack 0 Nov 30 09:05:15 volumio volumio[1620]: info: CoreCommandRouter::volumioPushState Nov 30 09:05:15 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 30 09:05:15 volumio volumio[1620]: info: CorePlayQueue::getTrack 0 Nov 30 09:05:15 volumio volumio[1620]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":true,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Nov 30 09:05:15 volumio volumio[1620]: verbose: CURRENT POSITION 0 Nov 30 09:05:15 volumio volumio[1620]: info: CoreStateMachine::syncState stateService stop Nov 30 09:05:15 volumio volumio[1620]: info: CoreStateMachine::syncState currentStatus stop Nov 30 09:05:15 volumio volumio[1620]: info: CoreStateMachine::pushState Nov 30 09:05:15 volumio volumio[1620]: info: CorePlayQueue::getTrack 0 Nov 30 09:05:15 volumio volumio[1620]: info: CoreCommandRouter::volumioPushState Nov 30 09:05:15 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 30 09:05:15 volumio volumio[1620]: info: No code Nov 30 09:05:15 volumio volumio[1620]: info: CoreStateMachine::pushState Nov 30 09:05:15 volumio volumio[1620]: info: CorePlayQueue::getTrack 0 Nov 30 09:05:15 volumio volumio[1620]: info: CoreCommandRouter::volumioPushState Nov 30 09:05:15 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 30 09:05:15 volumio volumio[1620]: info: ------------------------------ 1039ms Nov 30 09:05:15 volumio sudo[1811]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Nov 30 09:05:15 volumio sudo[1813]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Nov 30 09:05:15 volumio sudo[1811]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 09:05:15 volumio sudo[1813]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 09:05:15 volumio sudo[1811]: pam_unix(sudo:session): session closed for user root Nov 30 09:05:15 volumio sudo[1813]: pam_unix(sudo:session): session closed for user root Nov 30 09:05:15 volumio sudo[1822]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start upmpdcli.service Nov 30 09:05:15 volumio sudo[1822]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 09:05:15 volumio systemd[1]: Started UPnP Renderer front-end to MPD. Nov 30 09:05:15 volumio sudo[1822]: pam_unix(sudo:session): session closed for user root Nov 30 09:05:15 volumio volumio[1620]: info: Upmpdcli Daemon Started Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan premium Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan premium Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan premium Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan premium Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan premium Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan premium Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan premium Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin tidal to plan premium Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan premium Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan premium Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan superstar Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan superstar Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan superstar Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan superstar Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan superstar Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan superstar Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan superstar Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin tidal to plan superstar Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan superstar Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan superstar Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan virtuoso Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan virtuoso Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan virtuoso Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin tidal to plan virtuoso Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan virtuoso Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan virtuoso Nov 30 09:05:16 volumio volumio[1620]: info: Adding plugin bluetooth to MyMusic Plugins Nov 30 09:05:16 volumio volumio[1620]: info: Adding plugin cd_controller to MyMusic Plugins Nov 30 09:05:16 volumio volumio[1620]: info: Adding plugin smart_inputs to MyMusic Plugins Nov 30 09:05:16 volumio volumio[1620]: info: [MyVolumio PluginManager] Loading plugin "my_volumio"... Nov 30 09:05:17 volumio volumio[1620]: info: [MyVolumio PluginManager] Loading plugin "streaming_services"... Nov 30 09:05:18 volumio volumio[1620]: info: [MyVolumio PluginManager] MyVolumio plugin successfully loaded Nov 30 09:05:18 volumio volumio[1620]: info: [MyVolumio PluginManager] Starting plugin system_controller.my_volumio Nov 30 09:05:18 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Nov 30 09:05:18 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Nov 30 09:05:18 volumio volumio[1620]: info: Starting MyVolumio Remote Streaming Endpoints Nov 30 09:05:18 volumio volumio[1620]: info: [MyVolumio PluginManager] Streaming Services plugin successfully loaded Nov 30 09:05:18 volumio volumio[1620]: info: [MyVolumio PluginManager] Starting plugin music_service.streaming_services Nov 30 09:05:18 volumio volumio[1620]: info: Streaming services startup Nov 30 09:05:18 volumio volumio[1620]: info: Starting Streaming Daemon Nov 30 09:05:18 volumio sudo[1840]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Nov 30 09:05:18 volumio sudo[1840]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 09:05:18 volumio systemd[1]: Stopping Volumio Streaming Daemon... Nov 30 09:05:18 volumio volumio[1620]: info: MyVolumio not started Nov 30 09:05:18 volumio volumio[1620]: info: Initializing device activation check Nov 30 09:05:18 volumio systemd[1]: Starting Volumio Streaming Daemon... Nov 30 09:05:18 volumio systemd[1]: Started Volumio Streaming Daemon. Nov 30 09:05:18 volumio sudo[1840]: pam_unix(sudo:session): session closed for user root Nov 30 09:05:18 volumio volumio[1620]: info: [MyVolumio PluginManager] MyVolumio plugin successfully started Nov 30 09:05:18 volumio volumio-streaming-daemon[1850]: ############################ Nov 30 09:05:18 volumio volumio-streaming-daemon[1850]: # Volumio Streaming Daemon # Nov 30 09:05:18 volumio volumio-streaming-daemon[1850]: # Running on port 7777 # Nov 30 09:05:18 volumio volumio-streaming-daemon[1850]: ############################ Nov 30 09:05:18 volumio volumio-streaming-daemon[1850]: Environment: production Nov 30 09:05:18 volumio volumio[1620]: info: CoreCommandRouter::volumioGetState Nov 30 09:05:18 volumio volumio[1620]: info: CorePlayQueue::getTrack 0 Nov 30 09:05:18 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Nov 30 09:05:18 volumio volumio[1620]: info: Listing playlists Nov 30 09:05:18 volumio volumio[1620]: info: CoreCommandRouter::volumioGetQueue Nov 30 09:05:18 volumio volumio[1620]: info: CoreStateMachine::getQueue Nov 30 09:05:18 volumio volumio[1620]: info: CorePlayQueue::getQueue Nov 30 09:05:19 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Bianca%20Ryan/9abe7c57-fbcd-48b1-ae33-3f651c0d1eea.jpg' Nov 30 09:05:19 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Melanie%20C/573f6bf0-88e8-4fde-a435-e9b95fcac709.jpg' Nov 30 09:05:19 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Kelly%20Rowland/e00fa690-b43d-4793-a2f5-d6ad72c05394.jpg' Nov 30 09:05:19 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Leann%20Rimes/b376a5c4-5561-4ae4-8e46-cae5ad0fabc4.jpg' Nov 30 09:05:20 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Bandari/c752b0b0-bd5f-4d24-a8e7-62200c54d4de.jpg' Nov 30 09:05:20 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Joy%20Enriquez/24ad4436-5558-4c3c-be39-5dd9ac89f4b1.jpg' Nov 30 09:05:20 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Club%208/2356d46a-c6aa-46ea-8e2c-5f30f34e6f97.jpg' Nov 30 09:05:20 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Delta%20Goodrem/b6182324-966a-475e-8a45-bcace9596654.jpg' Nov 30 09:05:20 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Sandy%20Lam/3c89412b-13b4-439e-ac28-ee9cdcade89c.jpg' Nov 30 09:05:20 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Roxette/4775e5e6-9c0d-41a4-a73a-4977adb3bd86.jpg' Nov 30 09:05:20 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%3F%3F%3F/2d17e4d2-49be-4d9a-92c8-61449785fe88.jpg' Nov 30 09:05:20 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%3F%3F/5d795a10-8784-4b9d-88b3-5c3d2240bf4c.jpg' Nov 30 09:05:20 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E6%9E%97%E4%BF%8A%E6%9D%B0/8aa11ba4-c945-4315-91c8-c5767e970ab2.jpg' Nov 30 09:05:20 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%3F%3F%3F%3F/2349594e-71b5-4bba-9e23-00f64c8ad2d3.jpg' Nov 30 09:05:20 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Brian%20McKnight/d35dfca4-b0fc-46af-8189-f45b3ad3ee6c.jpg' Nov 30 09:05:21 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Dominica/b123ff9a-99f2-4195-87f1-3a65f4a80129.jpg' Nov 30 09:05:21 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/The%20Eagles/c29f4d75-aa48-4080-93ec-b44c118ce5da.jpg' Nov 30 09:05:21 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Celine%20Dion/a0157495-7973-4abc-b76e-bdd3ff4b949b.jpg' Nov 30 09:05:21 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/James%20Last/4693b46a-f559-4c0e-ac79-58cb827089f3.jpg' Nov 30 09:05:21 volumio volumio-streaming-daemon[1850]: Environment: production Nov 30 09:05:21 volumio volumio[1620]: info: Fetching Streaming Services browse cache Nov 30 09:05:21 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Michael%20Bolton/897a97e3-e3af-4bf3-a377-3eede5993633.jpg' Nov 30 09:05:21 volumio volumio[1620]: info: CoreCommandRouter::Close All Modals sent Nov 30 09:05:22 volumio volumio[1620]: info: Cannot call home: Error: Command failed: /usr/bin/curl -X POST --data-binary "device=pi&variante=volumio&version=2.861&uuid=3ae82554a897d65ced7df8529eb1bd69" http://updates.volumio.org:7070/downloader-v1/track-device Nov 30 09:05:22 volumio volumio[1620]: % Total % Received % Xferd Average Speed Time Time Time Current Nov 30 09:05:22 volumio volumio[1620]: Dload Upload Total Spent Left Speed Nov 30 09:05:22 volumio volumio[1620]: [235B blob data] Nov 30 09:05:22 volumio volumio[1620]: retrying in 5 seconds, trial 0 Nov 30 09:05:22 volumio volumio[1620]: Volumio Calling Home Nov 30 09:05:25 volumio volumio[1620]: info: CoreCommandRouter::volumioPlay Nov 30 09:05:25 volumio volumio[1620]: UNSET VOLATILE Nov 30 09:05:25 volumio volumio[1620]: info: CoreStateMachine::play index 74 Nov 30 09:05:25 volumio volumio[1620]: info: CoreStateMachine::setConsumeUpdateService undefined Nov 30 09:05:25 volumio volumio[1620]: info: CoreStateMachine::stop Nov 30 09:05:25 volumio volumio[1620]: info: CoreStateMachine::setConsumeUpdateService undefined Nov 30 09:05:25 volumio volumio[1620]: UNSET VOLATILE Nov 30 09:05:25 volumio volumio[1620]: info: CoreStateMachine::play index undefined Nov 30 09:05:25 volumio volumio[1620]: info: CoreStateMachine::setConsumeUpdateService undefined Nov 30 09:05:25 volumio volumio[1620]: info: CorePlayQueue::getTrack 74 Nov 30 09:05:25 volumio volumio[1620]: info: CoreStateMachine::startPlaybackTimer Nov 30 09:05:25 volumio volumio[1620]: info: CorePlayQueue::getTrack 74 Nov 30 09:05:25 volumio volumio[1620]: verbose: ControllerMpd::clearAddPlayTracks USB/新加卷/播放器音乐/02. Childhood Memory.wav Nov 30 09:05:25 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand stop Nov 30 09:05:25 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand clear Nov 30 09:05:25 volumio volumio[1620]: info: Nov 30 09:05:25 volumio volumio[1620]: ---------------------------- MPD announces system playlist update Nov 30 09:05:25 volumio volumio[1620]: info: Ignoring MPD Status Update Nov 30 09:05:25 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand add "USB/新加卷/播放器音乐/02. Childhood Memory.wav" Nov 30 09:05:25 volumio volumio[1620]: error: updateQueue error: null Nov 30 09:05:25 volumio volumio[1620]: info: ------------------------------ 3ms Nov 30 09:05:32 volumio volumio[1620]: info: Cannot call home: Error: Command failed: /usr/bin/curl -X POST --data-binary "device=pi&variante=volumio&version=2.861&uuid=3ae82554a897d65ced7df8529eb1bd69" http://updates.volumio.org:7070/downloader-v1/track-device Nov 30 09:05:32 volumio volumio[1620]: % Total % Received % Xferd Average Speed Time Time Time Current Nov 30 09:05:32 volumio volumio[1620]: Dload Upload Total Spent Left Speed Nov 30 09:05:32 volumio volumio[1620]: 0 0 0 0 0 0 0 0 --:--:-- --:--:-- --:--:-- 0curl: (7) Failed to connect to updates.volumio.org port 7070: Connection refused Nov 30 09:05:32 volumio volumio[1620]: retrying in 5 seconds, trial 1 Nov 30 09:05:32 volumio volumio[1620]: Volumio Calling Home Nov 30 09:05:34 volumio dhcpd[979]: Wrote 3 leases to leases file. Nov 30 09:05:34 volumio dhcpd[979]: DHCPREQUEST for 192.168.211.2 from e2:4a:b6:a9:7a:24 via wlan0 Nov 30 09:05:34 volumio dhcpd[979]: DHCPACK on 192.168.211.2 to e2:4a:b6:a9:7a:24 (vivo-iQOO-Pro-5G) via wlan0 Nov 30 09:05:36 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Nov 30 09:05:36 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Nov 30 09:05:43 volumio volumio[1620]: info: Cannot call home: Error: Command failed: /usr/bin/curl -X POST --data-binary "device=pi&variante=volumio&version=2.861&uuid=3ae82554a897d65ced7df8529eb1bd69" http://updates.volumio.org:7070/downloader-v1/track-device Nov 30 09:05:43 volumio volumio[1620]: % Total % Received % Xferd Average Speed Time Time Time Current Nov 30 09:05:43 volumio volumio[1620]: Dload Upload Total Spent Left Speed Nov 30 09:05:43 volumio volumio[1620]: 0 0 0 0 0 0 0 0 --:--:-- --:--:-- --:--:-- 0curl: (7) Failed to connect to updates.volumio.org port 7070: Connection refused Nov 30 09:05:43 volumio volumio[1620]: retrying in 5 seconds, trial 2 Nov 30 09:05:43 volumio volumio[1620]: Volumio Calling Home Nov 30 09:05:44 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E6%9D%8E%E8%8D%A3%E6%B5%A9/bde1c1ba-3f31-4c30-ae3b-bf13095c4fdf.jpg' Nov 30 09:05:44 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/KingStar/84878c1d-89ad-4244-9c4d-f568a522d319.jpg' Nov 30 09:05:45 volumio volumio[1620]: info: CoreCommandRouter::volumioPlay Nov 30 09:05:45 volumio volumio[1620]: UNSET VOLATILE Nov 30 09:05:45 volumio volumio[1620]: info: CoreStateMachine::play index 74 Nov 30 09:05:45 volumio volumio[1620]: info: CoreStateMachine::setConsumeUpdateService undefined Nov 30 09:05:45 volumio volumio[1620]: info: CoreStateMachine::stop Nov 30 09:05:45 volumio volumio[1620]: info: CoreStateMachine::setConsumeUpdateService undefined Nov 30 09:05:45 volumio volumio[1620]: UNSET VOLATILE Nov 30 09:05:45 volumio volumio[1620]: info: CoreStateMachine::play index undefined Nov 30 09:05:45 volumio volumio[1620]: info: CoreStateMachine::setConsumeUpdateService undefined Nov 30 09:05:45 volumio volumio[1620]: info: CorePlayQueue::getTrack 74 Nov 30 09:05:45 volumio volumio[1620]: info: CoreStateMachine::startPlaybackTimer Nov 30 09:05:45 volumio volumio[1620]: info: CorePlayQueue::getTrack 74 Nov 30 09:05:45 volumio volumio[1620]: verbose: ControllerMpd::clearAddPlayTracks USB/新加卷/播放器音乐/02. Childhood Memory.wav Nov 30 09:05:45 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand stop Nov 30 09:05:45 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand clear Nov 30 09:05:45 volumio volumio[1620]: info: Nov 30 09:05:45 volumio volumio[1620]: ---------------------------- MPD announces system playlist update Nov 30 09:05:45 volumio volumio[1620]: info: Ignoring MPD Status Update Nov 30 09:05:45 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand add "USB/新加卷/播放器音乐/02. Childhood Memory.wav" Nov 30 09:05:45 volumio volumio[1620]: error: updateQueue error: null Nov 30 09:05:45 volumio volumio[1620]: info: Nov 30 09:05:45 volumio volumio[1620]: ---------------------------- MPD announces system playlist update Nov 30 09:05:45 volumio volumio[1620]: info: Ignoring MPD Status Update Nov 30 09:05:45 volumio volumio[1620]: info: ------------------------------ 3ms Nov 30 09:05:45 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand play Nov 30 09:05:45 volumio volumio[1620]: info: ------------------------------ 4ms Nov 30 09:05:45 volumio volumio[1620]: info: Nov 30 09:05:45 volumio volumio[1620]: ---------------------------- MPD announces state update: player Nov 30 09:05:45 volumio volumio[1620]: info: ControllerMpd::getState Nov 30 09:05:45 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand status Nov 30 09:05:45 volumio volumio[1620]: info: Nov 30 09:05:45 volumio volumio[1620]: ---------------------------- MPD announces state update: player Nov 30 09:05:45 volumio volumio[1620]: info: ControllerMpd::getState Nov 30 09:05:45 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand status Nov 30 09:05:45 volumio volumio[1620]: verbose: ControllerMpd::parseState Nov 30 09:05:45 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand playlistinfo Nov 30 09:05:45 volumio volumio[1620]: verbose: ControllerMpd::parseState Nov 30 09:05:45 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand playlistinfo Nov 30 09:05:45 volumio volumio[1620]: verbose: ControllerMpd::parseTrackInfo Nov 30 09:05:45 volumio volumio[1620]: info: ControllerMpd::pushState Nov 30 09:05:45 volumio volumio[1620]: info: CoreCommandRouter::servicePushState Nov 30 09:05:45 volumio volumio[1620]: info: CorePlayQueue::getTrack 74 Nov 30 09:05:45 volumio volumio[1620]: verbose: STATE SERVICE {"status":"play","position":0,"seek":464,"duration":196,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":true,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Childhood Memory","artist":"Bandari","album":null,"uri":"USB/新加卷/播放器音乐/02. Childhood Memory.wav","trackType":"wav"} Nov 30 09:05:45 volumio volumio[1620]: verbose: CURRENT POSITION 74 Nov 30 09:05:45 volumio volumio[1620]: info: CoreStateMachine::syncState stateService play Nov 30 09:05:45 volumio volumio[1620]: info: CoreStateMachine::syncState currentStatus stop Nov 30 09:05:45 volumio volumio[1620]: info: CoreStateMachine::pushState Nov 30 09:05:45 volumio volumio[1620]: info: CorePlayQueue::getTrack 74 Nov 30 09:05:45 volumio volumio[1620]: info: CoreCommandRouter::volumioPushState Nov 30 09:05:45 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 30 09:05:45 volumio volumio[1620]: info: ------------------------------ 22ms Nov 30 09:05:45 volumio volumio[1620]: verbose: ControllerMpd::parseTrackInfo Nov 30 09:05:45 volumio volumio[1620]: info: ControllerMpd::pushState Nov 30 09:05:45 volumio volumio[1620]: info: CoreCommandRouter::servicePushState Nov 30 09:05:45 volumio volumio[1620]: info: CorePlayQueue::getTrack 74 Nov 30 09:05:45 volumio volumio[1620]: verbose: STATE SERVICE {"status":"play","position":0,"seek":464,"duration":196,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":true,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Childhood Memory","artist":"Bandari","album":null,"uri":"USB/新加卷/播放器音乐/02. Childhood Memory.wav","trackType":"wav"} Nov 30 09:05:45 volumio volumio[1620]: verbose: CURRENT POSITION 74 Nov 30 09:05:45 volumio volumio[1620]: info: CoreStateMachine::syncState stateService play Nov 30 09:05:45 volumio volumio[1620]: info: CoreStateMachine::syncState currentStatus play Nov 30 09:05:45 volumio volumio[1620]: info: Received an update from plugin. extracting info from payload Nov 30 09:05:45 volumio volumio[1620]: info: CoreStateMachine::pushState Nov 30 09:05:45 volumio volumio[1620]: info: CorePlayQueue::getTrack 74 Nov 30 09:05:45 volumio volumio[1620]: info: CoreCommandRouter::volumioPushState Nov 30 09:05:45 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 30 09:05:45 volumio volumio[1620]: info: CoreStateMachine::pushState Nov 30 09:05:45 volumio volumio[1620]: info: CorePlayQueue::getTrack 74 Nov 30 09:05:45 volumio volumio[1620]: info: CoreCommandRouter::volumioPushState Nov 30 09:05:45 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 30 09:05:45 volumio volumio[1620]: info: ------------------------------ 31ms Nov 30 09:05:59 volumio volumio[1620]: info: MPD Database updated - AlbumList cache refreshed Nov 30 09:05:59 volumio volumio[1620]: info: Nov 30 09:05:59 volumio volumio[1620]: ---------------------------- MPD announces state update: database Nov 30 09:05:59 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand status Nov 30 09:05:59 volumio volumio[1620]: info: Nov 30 09:05:59 volumio volumio[1620]: ---------------------------- MPD announces state update: update Nov 30 09:05:59 volumio volumio[1620]: info: ControllerMpd::getState Nov 30 09:05:59 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand status Nov 30 09:05:59 volumio volumio[1620]: info: ControllerMpd::getState Nov 30 09:05:59 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand status Nov 30 09:05:59 volumio volumio[1620]: verbose: ControllerMpd::parseState Nov 30 09:05:59 volumio volumio[1620]: info: Command Router : Notfying DB Updatefalse Nov 30 09:05:59 volumio volumio[1620]: info: CoreCommandRouter::Close All Modals sent Nov 30 09:05:59 volumio volumio[1620]: verbose: ControllerMpd::parseState Nov 30 09:05:59 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand playlistinfo Nov 30 09:05:59 volumio volumio[1620]: verbose: ControllerMpd::parseState Nov 30 09:05:59 volumio volumio[1620]: verbose: ControllerMpd::sendMpdCommand playlistinfo Nov 30 09:05:59 volumio volumio[1620]: verbose: ControllerMpd::parseTrackInfo Nov 30 09:05:59 volumio volumio[1620]: verbose: ControllerMpd::parseTrackInfo Nov 30 09:05:59 volumio volumio[1620]: info: ControllerMpd::pushState Nov 30 09:05:59 volumio volumio[1620]: info: CoreCommandRouter::servicePushState Nov 30 09:05:59 volumio volumio[1620]: info: CorePlayQueue::getTrack 74 Nov 30 09:05:59 volumio volumio[1620]: verbose: STATE SERVICE {"status":"play","position":0,"seek":14675,"duration":196,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Childhood Memory","artist":"Bandari","album":null,"uri":"USB/新加卷/播放器音乐/02. Childhood Memory.wav","trackType":"wav"} Nov 30 09:05:59 volumio volumio[1620]: verbose: CURRENT POSITION 74 Nov 30 09:05:59 volumio volumio[1620]: info: CoreStateMachine::syncState stateService play Nov 30 09:05:59 volumio volumio[1620]: info: CoreStateMachine::syncState currentStatus play Nov 30 09:05:59 volumio volumio[1620]: info: Received an update from plugin. extracting info from payload Nov 30 09:05:59 volumio volumio[1620]: info: CoreStateMachine::pushState Nov 30 09:05:59 volumio volumio[1620]: info: CorePlayQueue::getTrack 74 Nov 30 09:05:59 volumio volumio[1620]: info: CoreCommandRouter::volumioPushState Nov 30 09:05:59 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 30 09:05:59 volumio volumio[1620]: info: CoreStateMachine::pushState Nov 30 09:05:59 volumio volumio[1620]: info: CorePlayQueue::getTrack 74 Nov 30 09:05:59 volumio volumio[1620]: info: CoreCommandRouter::volumioPushState Nov 30 09:05:59 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 30 09:05:59 volumio volumio[1620]: info: ControllerMpd::pushState Nov 30 09:05:59 volumio volumio[1620]: info: CoreCommandRouter::servicePushState Nov 30 09:05:59 volumio volumio[1620]: info: CorePlayQueue::getTrack 74 Nov 30 09:05:59 volumio volumio[1620]: verbose: STATE SERVICE {"status":"play","position":0,"seek":14675,"duration":196,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Childhood Memory","artist":"Bandari","album":null,"uri":"USB/新加卷/播放器音乐/02. Childhood Memory.wav","trackType":"wav"} Nov 30 09:05:59 volumio volumio[1620]: verbose: CURRENT POSITION 74 Nov 30 09:05:59 volumio volumio[1620]: info: CoreStateMachine::syncState stateService play Nov 30 09:05:59 volumio volumio[1620]: info: CoreStateMachine::syncState currentStatus play Nov 30 09:05:59 volumio volumio[1620]: info: Received an update from plugin. extracting info from payload Nov 30 09:05:59 volumio volumio[1620]: info: CoreStateMachine::pushState Nov 30 09:05:59 volumio volumio[1620]: info: CorePlayQueue::getTrack 74 Nov 30 09:05:59 volumio volumio[1620]: info: CoreCommandRouter::volumioPushState Nov 30 09:05:59 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 30 09:05:59 volumio volumio[1620]: info: CoreStateMachine::pushState Nov 30 09:05:59 volumio volumio[1620]: info: CorePlayQueue::getTrack 74 Nov 30 09:05:59 volumio volumio[1620]: info: CoreCommandRouter::volumioPushState Nov 30 09:05:59 volumio volumio[1620]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 30 09:05:59 volumio volumio[1620]: info: ------------------------------ 307ms Nov 30 09:05:59 volumio volumio[1620]: info: ------------------------------ 308ms Nov 30 09:06:02 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Guido%20Negraszus/12%20Enigma%20(Reloaded)/e04c79a1-e6f4-4d1b-aabe-100731bc5d1d.jpg' Nov 30 09:06:03 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Roxette/A%20Collection%20Of%20Roxette%20Hits/4273375c-bedd-439d-be8d-038fca941a8a.jpg' Nov 30 09:06:03 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Guido%20Negraszus/A%20Reason%20to%20Dream/fc41023e-ebb5-470f-8c35-c7e2ad6bbf68.jpg' Nov 30 09:06:05 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Twisted%20Jukebox/Angels%20Will%20Rise/cd96b147-aea2-458b-baf6-6a3b0a58a4ce.jpg' Nov 30 09:06:05 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/H%C3%A9l%C3%A8ne%20Segara/Au%20Nom%20D%27une%20Femme/df9a770c-345b-41ae-b006-7e614569a438.jpg' Nov 30 09:06:05 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Michael%20Jackson/Bad/fd8d6771-1c8d-42bd-88a6-8942769850e4.jpg' Nov 30 09:06:08 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Chris%20Spheeris/Best%20of%20Chris%20Spheeris%201990-2000/0205c2df-4d98-472c-9da6-768f8de9fa98.jpg' Nov 30 09:06:08 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/William%20Joseph/Beyond/9e1d33d1-8328-4364-ac52-d7db7fd5d5da.jpg' Nov 30 09:06:08 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Approaching%20Nirvana/Blocking%20the%20Sky/3e7335f6-8013-4898-bed6-674941561d75.jpg' Nov 30 09:06:08 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Yohanna/Butterflies%20and%20Elvis/409fecc8-e567-46f5-9edf-cb3f6e9738c7.jpg' Nov 30 09:06:10 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Dan%20ar%20Braz/Celtiques/c9d9c34c-7177-4a8e-9338-cee1c340d2cc.jpg' Nov 30 09:06:10 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Delta%20Goodrem/Child%20of%20the%20Universe/8852fe40-8ef8-4dee-ac74-7becf9db4e87.png' Nov 30 09:06:10 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Audiomachine/Chronicles/62847151-ceae-48a0-a5f8-685898c8c4c9.png' Nov 30 09:06:11 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Sarah%20McLachlan/Closer%3A%20The%20Best%20Of%20Sarah%20McLachlan/3edd2e16-1b91-4767-818b-98e4e1b851be.png' Nov 30 09:06:14 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/MARIAH%20CAREY/Emotions/43a8f395-6579-4257-9651-284192ddd23a.png' Nov 30 09:06:14 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Yanni/Ethnicity/e849e9de-9d62-47df-b3a4-674a4dd0fecf.jpg' Nov 30 09:06:14 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Audiomachine/Existence/26bc9c75-0839-4780-96f9-e4d0077ef463.png' Nov 30 09:06:16 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Pascal%20Letoublon/Friendships/e2c44022-b315-4fb7-8e06-e35f2f91b9a2.jpg' Nov 30 09:06:19 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Mark%20Petrie/Go%20Time/2a43cea7-38ad-4b04-b71d-819484d047aa.jpg' Nov 30 09:06:19 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Isgaard/Golden%20Key%20(Limited%20Edition)/d6a8aaf4-9f05-4802-a4f0-c64d44e55c84.jpg' Nov 30 09:06:20 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Barbra%20Streisand/Guilty/c683ab60-bb73-43ba-9882-f2168dfe21ba.jpg' Nov 30 09:06:20 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Colbie%20Caillat/Gypsy%20Heart%20(Deluxe%20Edition)/b783e43b-c160-4214-80c6-f722c41ec927.jpg' Nov 30 09:06:24 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E8%8E%AB%E6%96%87%E8%94%9A/I%20Do/387010b4-3c78-4498-8726-4db1abb4e7c4.jpg' Nov 30 09:06:25 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Delta%20Goodrem/Innocent%20Eyes/884898eb-ca3c-45e4-9c60-29267a987be1.png' Nov 30 09:06:25 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Yanni/Inspirato/a482a714-4b3b-4b91-89d2-2097651cb894.jpg' Nov 30 09:06:27 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Jessica%20Simpson/Irresistible/bfec3c71-7f90-4f78-8c48-5611acc40491.jpg' Nov 30 09:06:27 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Sarah%20Connor/Key%20To%20my%20Soul/35268b14-24e3-476a-b271-5c13929245ed.jpg' Nov 30 09:06:29 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Sarah%20Brightman/La%20Luna/8a9cfd99-c9c4-4093-9c18-77c61c03fbf7.jpg' Nov 30 09:06:29 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Taylor%20Swift/Lover/797de22b-1fb8-49f7-8127-fe0d93f19a83.jpg' Nov 30 09:06:29 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/C%C3%A9line%20Dion/Loved%20Me%20Back%20to%20Life/7b41464c-6e2b-4123-bcb5-25e9370d6429.png' Nov 30 09:06:30 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/MARIAH%20CAREY/Mariah%20Carey%20(HDTracks)/61255f4f-09bd-4ef7-97bd-72514980de73.jpg' Nov 30 09:06:32 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Mariah%20Carey/Merry%20Christmas/129c4dd8-26eb-4f70-a324-f8527c23b3b9.jpg' Nov 30 09:06:33 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/JJ%20Lin/Message%20In%20A%20Bottle/909f8043-baad-4099-8d88-35789ab9558b.jpg' Nov 30 09:06:33 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Alizee/Mes%20Courants%20Electriques/2096d68d-de22-4d7e-bc33-e9edb5995132.jpg' Nov 30 09:06:33 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Mariah%20Carey/Music%20Box/c7232589-6038-4deb-b8cd-1f5773c6e4ff.jpg' Nov 30 09:06:38 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Sarah%20Connor/Naughty%20But%20Nice/23d21cfc-22b2-45ad-ad52-6099a8f64c32.png' Nov 30 09:06:38 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/X-Ray%20Dog/New%20Music/735a5c53-c08f-4f50-a74b-eee6d0871660.png' Nov 30 09:06:38 volumio volumio[1620]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Gorgon%20City/No%20More/347053d3-2e7d-4322-a879-1f66895740dc.png' Nov 30 09:06:40 volumio hotspot[960]: wlan0: STA e2:4a:b6:a9:7a:24 IEEE 802.11: disassociated Nov 30 09:06:40 volumio hostapd[996]: wlan0: STA e2:4a:b6:a9:7a:24 IEEE 802.11: disassociated Nov 30 09:06:40 volumio hostapd[996]: wlan0: STA e2:4a:b6:a9:7a:24 IEEE 802.11: disassociated Nov 30 09:06:40 volumio hotspot[960]: wlan0: AP-STA-DISCONNECTED e2:4a:b6:a9:7a:24 Nov 30 09:06:40 volumio hotspot[960]: wlan0: STA e2:4a:b6:a9:7a:24 IEEE 802.11: disassociated Nov 30 09:06:57 volumio volumio[1620]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Nov 30 09:06:57 volumio volumio[1620]: { Error: connect ETIMEDOUT 69.63.176.59:443 Nov 30 09:06:57 volumio volumio[1620]: at Object._errnoException (util.js:1022:11) Nov 30 09:06:57 volumio volumio[1620]: at _exceptionWithHostPort (util.js:1044:20) Nov 30 09:06:57 volumio volumio[1620]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1198:14) Nov 30 09:06:57 volumio volumio[1620]: code: 'ETIMEDOUT', Nov 30 09:06:57 volumio volumio[1620]: errno: 'ETIMEDOUT', Nov 30 09:06:57 volumio volumio[1620]: syscall: 'connect', Nov 30 09:06:57 volumio volumio[1620]: address: '69.63.176.59', Nov 30 09:06:57 volumio volumio[1620]: port: 443 } Nov 30 09:06:57 volumio volumio[1620]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Nov 30 09:06:58 volumio sudo[2100]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-11-30 09:05 Nov 30 09:06:58 volumio sudo[2100]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Raspbian GNU/Linux 8 (jessie)" NAME="Raspbian GNU/Linux" VERSION_ID="8" VERSION="8 (jessie)" 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="168ba7444df98cd868db72f24faec0b6346489cc" VOLUMIO_FE_VERSION="847a48ecf32d35cc502a0053d585d1a69236e391" VOLUMIO_BE_VERSION="03f7bbd984817e093cac62b7ff876f3c2cfabc1d" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue Dec 22 14:39:52 CET 2020" VOLUMIO_VERSION="2.861" VOLUMIO_HARDWARE="pi" VOLUMIO_HASH="097e28ee6263e31d0bf6b690a02dcab3"