21:55:19.650 T:547620995072 NOTICE: special://profile/ is mapped to: special://masterprofile/
21:55:19.650 T:547620995072 NOTICE: -----------------------------------------------------------------------
21:55:19.651 T:547620995072 NOTICE: Starting Kodi (17.6 Git:a9a7a20). Platform: Linux ARM 64-bit
21:55:19.651 T:547620995072 NOTICE: Using Release Kodi x64 build
21:55:19.651 T:547620995072 NOTICE: Kodi compiled Jan 14 2018 by GCC 6.2.0 for Linux ARM 64-bit version 3.14.29 (200221)
21:55:19.651 T:547620995072 NOTICE: Running on LibreELEC (official): 8.2.3, kernel: Linux ARM 64-bit version 3.14.29
21:55:19.653 T:547620995072 NOTICE: FFmpeg version/source: ffmpeg-3.1-kodi
21:55:19.653 T:547620995072 NOTICE: Host CPU: AArch64 Processor rev 4 (aarch64), 3 cores available
21:55:19.653 T:547620995072 NOTICE: ARM Features: Neon disabled
21:55:19.653 T:547620995072 NOTICE: special://xbmc/ is mapped to: /usr/share/kodi/
21:55:19.653 T:547620995072 NOTICE: special://xbmcbin/ is mapped to: /usr/lib/kodi
21:55:19.653 T:547620995072 NOTICE: special://xbmcbinaddons/ is mapped to: /usr/lib/kodi/addons
21:55:19.653 T:547620995072 NOTICE: special://masterprofile/ is mapped to: /storage/.kodi/userdata
21:55:19.653 T:547620995072 NOTICE: special://envhome/ is mapped to: /storage
21:55:19.653 T:547620995072 NOTICE: special://home/ is mapped to: /storage/.kodi
21:55:19.653 T:547620995072 NOTICE: special://temp/ is mapped to: /storage/.kodi/temp
21:55:19.653 T:547620995072 NOTICE: special://logpath/ is mapped to: /storage/.kodi/temp
21:55:19.653 T:547620995072 NOTICE: The executable running is: /usr/lib/kodi/kodi.bin
21:55:19.653 T:547620995072 NOTICE: Local hostname: LibreELEC
21:55:19.654 T:547620995072 NOTICE: Log File is located: /storage/.kodi/temp//kodi.log
21:55:19.656 T:547620995072 NOTICE: -----------------------------------------------------------------------
21:55:19.739 T:547620995072 ERROR: DBus: Error org.freedesktop.DBus.Error.ServiceUnknown - The name org.freedesktop.UPower was not provided by any .service files
21:55:19.747 T:547620995072 NOTICE: load settings...
21:55:19.747 T:547620995072 NOTICE: AML device detected
21:55:19.846 T:547620995072 NOTICE: Found 2 Lists of Devices
21:55:19.846 T:547620995072 NOTICE: Enumerated ALSA devices:
21:55:19.846 T:547620995072 NOTICE: Device 1
21:55:19.846 T:547620995072 NOTICE: m_deviceName : default
21:55:19.847 T:547620995072 NOTICE: m_displayName : Default (AML-M8AUDIO Analog)
21:55:19.847 T:547620995072 NOTICE: m_displayNameExtra:
21:55:19.847 T:547620995072 NOTICE: m_deviceType : AE_DEVTYPE_PCM
21:55:19.847 T:547620995072 NOTICE: m_channels : FL,FR,UNKNOWN1,LFE,BL,BR,FC,BC,BLOC,BROC
21:55:19.847 T:547620995072 NOTICE: m_sampleRates : 32000,44100,48000,88200,96000,176400,192000
21:55:19.847 T:547620995072 NOTICE: m_dataFormats : AE_FMT_S32NE
21:55:19.847 T:547620995072 NOTICE: m_streamTypes : No passthrough capabilities
21:55:19.847 T:547620995072 NOTICE: Device 2
21:55:19.847 T:547620995072 NOTICE: m_deviceName : hdmi:CARD=AMLM8AUDIO,DEV=0
21:55:19.847 T:547620995072 NOTICE: m_displayName : AML-M8AUDIO
21:55:19.847 T:547620995072 NOTICE: m_displayNameExtra: HDMI
21:55:19.847 T:547620995072 NOTICE: m_deviceType : AE_DEVTYPE_HDMI
21:55:19.847 T:547620995072 NOTICE: m_channels : FL,FR,BL,BR,FC,LFE,SL,SR
21:55:19.847 T:547620995072 NOTICE: m_sampleRates : 32000,44100,48000,88200,96000,176400,192000
21:55:19.847 T:547620995072 NOTICE: m_dataFormats : AE_FMT_S16NE,AE_FMT_S16LE,AE_FMT_RAW
21:55:19.847 T:547620995072 NOTICE: m_streamTypes : STREAM_TYPE_AC3,STREAM_TYPE_DTSHD,STREAM_TYPE_DTSHD_CORE,STREAM_TYPE_DTS_1024,STREAM_TYPE_DTS_2048,STREAM_TYPE_DTS_512,STREAM_TYPE_EAC3,STREAM_TYPE_TRUEHD
21:55:19.847 T:547620995072 NOTICE: Enumerated PULSE devices:
21:55:19.847 T:547620995072 NOTICE: Device 1
21:55:19.847 T:547620995072 NOTICE: m_deviceName : Default
21:55:19.847 T:547620995072 NOTICE: m_displayName : Default
21:55:19.847 T:547620995072 NOTICE: m_displayNameExtra: Bluetooth Audio (PULSEAUDIO)
21:55:19.847 T:547620995072 NOTICE: m_deviceType : AE_DEVTYPE_PCM
21:55:19.847 T:547620995072 NOTICE: m_channels : FL,FR
21:55:19.847 T:547620995072 NOTICE: m_sampleRates : 5512,8000,11025,16000,22050,32000,44100,48000,64000,88200,96000,176400,192000,384000
21:55:19.847 T:547620995072 NOTICE: m_dataFormats : AE_FMT_U8,AE_FMT_S16NE,AE_FMT_S24NE3,AE_FMT_S24NE4,AE_FMT_S32NE,AE_FMT_FLOAT
21:55:19.847 T:547620995072 NOTICE: m_streamTypes : No passthrough capabilities
21:55:19.866 T:547620995072 NOTICE: Loaded settings file from special://xbmc/system/advancedsettings.xml
21:55:19.866 T:547620995072 NOTICE: Contents of special://xbmc/system/advancedsettings.xml are...
false
1
cputemp
gputemp
30
21:55:19.871 T:547620995072 NOTICE: Loaded settings file from special://profile/advancedsettings.xml
21:55:19.871 T:547620995072 NOTICE: Contents of special://profile/advancedsettings.xml are...
mysql
192.168.1.6
3306
kodi
*****
mysql
192.168.1.6
3306
kodi
*****
true
true
1
21:55:19.872 T:547620995072 NOTICE: Log level changed to "LOG_LEVEL_DEBUG"
21:55:19.872 T:547620995072 WARNING: VIDEO database configuration is experimental.
21:55:19.872 T:547620995072 NOTICE: Default Video Player: VideoPlayer
21:55:19.872 T:547620995072 NOTICE: Default Audio Player: paplayer
21:55:19.872 T:547620995072 NOTICE: Disabled debug logging due to GUI setting. Level 1.
21:55:19.872 T:547620995072 NOTICE: Log level changed to "LOG_LEVEL_DEBUG"
21:55:19.873 T:547620995072 NOTICE: CMediaSourceSettings: loading media sources from special://masterprofile/sources.xml
21:55:19.875 T:547620995072 NOTICE: Loading player core factory settings from special://xbmc/system/playercorefactory.xml.
21:55:19.875 T:547620995072 DEBUG: CPlayerCoreConfig::: created player VideoPlayer
21:55:19.875 T:547620995072 DEBUG: CPlayerCoreConfig::: created player PAPlayer
21:55:19.875 T:547620995072 DEBUG: CPlayerSelectionRule::Initialize: creating rule: system rules
21:55:19.875 T:547620995072 DEBUG: CPlayerSelectionRule::Initialize: creating rule: mms/udp
21:55:19.875 T:547620995072 DEBUG: CPlayerSelectionRule::Initialize: creating rule: lastfm/shout
21:55:19.875 T:547620995072 DEBUG: CPlayerSelectionRule::Initialize: creating rule: rtmp
21:55:19.875 T:547620995072 DEBUG: CPlayerSelectionRule::Initialize: creating rule: rtsp
21:55:19.875 T:547620995072 DEBUG: CPlayerSelectionRule::Initialize: creating rule: streams
21:55:19.875 T:547620995072 DEBUG: CPlayerSelectionRule::Initialize: creating rule: aacp/sdp
21:55:19.875 T:547620995072 DEBUG: CPlayerSelectionRule::Initialize: creating rule: mp2
21:55:19.876 T:547620995072 DEBUG: CPlayerSelectionRule::Initialize: creating rule: dvd
21:55:19.876 T:547620995072 DEBUG: CPlayerSelectionRule::Initialize: creating rule: dvdimage
21:55:19.876 T:547620995072 DEBUG: CPlayerSelectionRule::Initialize: creating rule: sdp/asf
21:55:19.876 T:547620995072 DEBUG: CPlayerSelectionRule::Initialize: creating rule: nsv
21:55:19.876 T:547620995072 DEBUG: CPlayerSelectionRule::Initialize: creating rule: radio
21:55:19.876 T:547620995072 NOTICE: Loaded playercorefactory configuration
21:55:19.876 T:547620995072 NOTICE: Loading player core factory settings from special://masterprofile/playercorefactory.xml.
21:55:19.876 T:547620995072 NOTICE: special://masterprofile/playercorefactory.xml does not exist. Skipping.
21:55:19.888 T:547620995072 INFO: creating subdirectories
21:55:19.888 T:547620995072 INFO: userdata folder: special://masterprofile/
21:55:19.888 T:547620995072 INFO: recording folder:
21:55:19.888 T:547620995072 INFO: screenshots folder: /storage/screenshots/
21:55:21.623 T:547620995072 NOTICE: Running database version Addons27
21:55:21.624 T:547620995072 DEBUG: SECTION:LoadDLL(special://xbmcbin/system/libcpluff-aarch64.so)
21:55:21.624 T:547620995072 DEBUG: Loading: /usr/lib/kodi/system/libcpluff-aarch64.so
21:55:21.729 T:547620995072 INFO: ADDON: cpluff: 'Could not read plug-in directory /usr/lib/kodi/addons: No such file or directory'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in xbmc.json has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in metadata.common.fanart.tv has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.cu.lrclyrics has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in resource.images.weathericons.default has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in xbmc.audioencoder has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in repository.gomioa has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in webinterface.default has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in repository.xbmc.org has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in kodi.audiodecoder has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in weather.yahoo has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in screensaver.xbmc.builtin.black has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in kodi.peripheral has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in kodi.guilib has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.module.t1mlib has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in peripheral.joystick has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in kodi.adsp has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in audioencoder.xbmc.builtin.wma has been installed.'
21:55:21.729 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.module.chardet has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in superrepo.kodi.krypton.pictures has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in game.controller.default has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.module.simplejson has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in weather.wunderground has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in service.libreelec.settings has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in screensaver.xbmc.builtin.dim has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.module.idna has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.module.beautifulsoup4 has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in kodi.game has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in metadata.themoviedb.org has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in resource.images.recordlabels.white has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.module.urllib3 has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in xbmc.metadata has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.ipcam has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in kodi.resource has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in xbmc.gui has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.module.pil has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.common.plugin.cache has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in os.openelec.tv has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.skinshortcuts has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.module.unidecode has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in repository.kodi.game has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in xbmc.core has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in os.libreelec.tv has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.module.requests has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.grab.fanart has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in kodi.inputstream has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.module.certifi has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in repository.libreelec.tv has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in xbmc.pvr has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in screensaver.picture.slideshow has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in service.library.data.provider has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in metadata.album.universal has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in audioencoder.xbmc.builtin.aac has been installed.'
21:55:21.730 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.module.routing has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in resource.language.en_gb has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in metadata.common.musicbrainz.org has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in metadata.common.allmusic.com has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in metadata.tvdb.com has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in metadata.local has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.tvaddons.debug.log has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in xbmc.webinterface has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in repository.leopold has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.module.mutagen has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in resource.images.studios.white has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.module.mechanize has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in resource.uisounds.kodi has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in metadata.common.themoviedb.org has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in metadata.common.theaudiodb.com has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in metadata.artists.universal has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in xbmc.python has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in metadata.common.imdb.com has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.module.elementtree has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in skin.aeon.nox.5 has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in xbmc.addon has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in xbmc.codec has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in skin.estuary has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Plug-in script.module.addon.signals has been installed.'
21:55:21.731 T:547620995072 DEBUG: ADDON: cpluff: 'Not all directories were successfully scanned.'
21:55:22.594 T:547532828896 DEBUG: Thread JobWorker start, auto delete: true
21:55:22.605 T:547620995072 NOTICE: ADDONS: Using repository repository.kodi.game
21:55:22.605 T:547620995072 NOTICE: ADDONS: Using repository repository.libreelec.tv
21:55:22.605 T:547620995072 NOTICE: ADDONS: Using repository repository.xbmc.org
21:55:22.605 T:547620995072 NOTICE: ADDONS: Using repository repository.gomioa
21:55:22.605 T:547620995072 NOTICE: ADDONS: Using repository repository.leopold
21:55:22.605 T:547620995072 NOTICE: ADDONS: Using repository superrepo.kodi.krypton.pictures
21:55:22.611 T:547524440288 DEBUG: Thread ActiveAE start, auto delete: false
21:55:22.611 T:547516051680 DEBUG: Thread AESink start, auto delete: false
21:55:22.611 T:547516051680 INFO: CActiveAESink::OpenSink - initialize sink
21:55:22.611 T:547516051680 DEBUG: CActiveAESink::OpenSink - trying to open device ALSA:hdmi:CARD=AMLM8AUDIO,DEV=0
21:55:22.611 T:547516051680 INFO: CAESinkALSA::Initialize - Attempting to open device "default"
21:55:22.615 T:547516051680 INFO: CAESinkALSA::Initialize - Opened device "default"
21:55:22.615 T:547516051680 INFO: CAESinkALSA::InitializeHW - Your hardware does not support AE_FMT_FLOAT, trying other formats
21:55:22.615 T:547516051680 INFO: CAESinkALSA::InitializeHW - Using data format AE_FMT_S32NE
21:55:22.616 T:547516051680 DEBUG: CAESinkALSA::InitializeHW - Request: periodSize 2205, bufferSize 8820
21:55:22.618 T:547516051680 DEBUG: CAESinkALSA::InitializeHW - Got: periodSize 2048, bufferSize 8192
21:55:22.618 T:547516051680 DEBUG: CAESinkALSA::InitializeHW - Setting timeout to 186 ms
21:55:22.619 T:547516051680 DEBUG: CAESinkALSA::GetChannelLayout - Input Channel Count: 2 Output Channel Count: 2
21:55:22.619 T:547516051680 DEBUG: CAESinkALSA::GetChannelLayout - Requested Layout: FL,FR
21:55:22.619 T:547516051680 DEBUG: CAESinkALSA::GetChannelLayout - Got Layout: FL,FR (ALSA: none)
21:55:22.619 T:547516051680 DEBUG: CActiveAESink::OpenSink - ALSA Initialized:
21:55:22.619 T:547516051680 DEBUG: Output Device : AML-M8AUDIO
21:55:22.619 T:547516051680 DEBUG: Sample Rate : 44100
21:55:22.619 T:547516051680 DEBUG: Sample Format : AE_FMT_S32NE
21:55:22.619 T:547516051680 DEBUG: Channel Count : 2
21:55:22.619 T:547516051680 DEBUG: Channel Layout: FL,FR
21:55:22.619 T:547516051680 DEBUG: Frames : 2048
21:55:22.619 T:547516051680 DEBUG: Frame Size : 8
21:55:22.624 T:547507663072 DEBUG: Thread RemoteControl start, auto delete: false
21:55:22.624 T:547507663072 INFO: LIRC Process: using: /run/lirc/lircd
21:55:22.624 T:547507663072 INFO: LIRC Connect: successfully started
21:55:22.624 T:547507663072 DEBUG: Thread RemoteControl 547507663072 terminating
21:55:22.630 T:547620995072 INFO: CKeyboardLayoutManager: loading keyboard layouts from special://xbmc/system/keyboardlayouts...
21:55:22.635 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Arabic QWERTY" successfully loaded
21:55:22.636 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Bulgarian ЯВЕРТЪ" successfully loaded
21:55:22.636 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Bulgarian АБВ" successfully loaded
21:55:22.637 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Chinese BasePY" successfully loaded
21:55:22.637 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Chinese BaiduPY" successfully loaded
21:55:22.638 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Croatian QWERTY" successfully loaded
21:55:22.639 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Czech QWERTZ" successfully loaded
21:55:22.640 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Danish QWERTY" successfully loaded
21:55:22.641 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "English QWERTY" successfully loaded
21:55:22.641 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "English AZERTY" successfully loaded
21:55:22.641 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "English ABC" successfully loaded
21:55:22.642 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "French AZERTY" successfully loaded
21:55:22.643 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "German QWERTZ" successfully loaded
21:55:22.643 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "German ABC" successfully loaded
21:55:22.644 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Greek QWERTY" successfully loaded
21:55:22.645 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Hebrew QWERTY" successfully loaded
21:55:22.645 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Hebrew ABC" successfully loaded
21:55:22.646 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Hungarian QWERTZ" successfully loaded
21:55:22.646 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Icelandic QWERTY" successfully loaded
21:55:22.647 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Italian QWERTY" successfully loaded
21:55:22.648 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Korean ㄱㄴㄷ" successfully loaded
21:55:22.648 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Lithuanian AZERTY" successfully loaded
21:55:22.649 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Lithuanian QWERTY" successfully loaded
21:55:22.649 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Norwegian QWERTY" successfully loaded
21:55:22.650 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Polish QWERTY" successfully loaded
21:55:22.651 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Portuguese (Portugal) QWERTY" successfully loaded
21:55:22.652 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Romanian QWERTY" successfully loaded
21:55:22.652 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Russian ЙЦУКЕН" successfully loaded
21:55:22.653 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Russian АБВ" successfully loaded
21:55:22.653 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Silesian QWERTY" successfully loaded
21:55:22.654 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Slovak QWERTZ" successfully loaded
21:55:22.655 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Slovak QWERTY" successfully loaded
21:55:22.655 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Slovak ABC" successfully loaded
21:55:22.657 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Spanish QWERTY" successfully loaded
21:55:22.657 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Swedish QWERTY" successfully loaded
21:55:22.658 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Turkish QWERTY" successfully loaded
21:55:22.659 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Ukrainian ЙЦУКЕН" successfully loaded
21:55:22.659 T:547620995072 DEBUG: CKeyboardLayoutManager: keyboard layout "Ukrainian АБВ" successfully loaded
21:55:22.660 T:547620995072 DEBUG: UDisks: org.freedesktop.DBus.Error.ServiceUnknown - The name org.freedesktop.UDisks was not provided by any .service files
21:55:22.661 T:547620995072 DEBUG: DeviceKit.Disks: org.freedesktop.DBus.Error.ServiceUnknown - The name org.freedesktop.DeviceKit.Disks was not provided by any .service files
21:55:22.663 T:547620995072 DEBUG: Selected UDev as storage provider
21:55:22.663 T:547620995072 ERROR: AML: no rw on /sys/class/ppmgr/ppmgr_3d_mode
21:55:22.692 T:547620995072 NOTICE: InitWindowSystem: Using EGL Implementation: amlogic
21:55:22.729 T:547620995072 NOTICE: Found resolution 1280 x 720 for display 0 with 1280 x 720 @ 60.000000 Hz
21:55:22.730 T:547620995072 NOTICE: Found resolution 1920 x 1080 for display 0 with 1920 x 1080i @ 60.000000 Hz
21:55:22.730 T:547620995072 NOTICE: Found resolution 1920 x 1080 for display 0 with 1920 x 1080 @ 60.000000 Hz
21:55:22.730 T:547620995072 NOTICE: Found resolution 1920 x 1080 for display 0 with 1920 x 1080 @ 30.000000 Hz
21:55:22.730 T:547620995072 NOTICE: Found resolution 1920 x 1080 for display 0 with 1920 x 1080 @ 24.000000 Hz
21:55:22.730 T:547620995072 NOTICE: Found (1920x1080@60.000000) at 18, setting to RES_DESKTOP at 16
21:55:22.730 T:547620995072 NOTICE: Checking resolution 16
21:55:22.975 T:547620995072 DEBUG: AMLUtils::aml_handle_display_stereo_mode switching 3d modes
21:55:22.975 T:547620995072 DEBUG: AMLUtils::aml_handle_display_stereo_mode old mode 3doff new mode 3doff
21:55:22.975 T:547620995072 DEBUG: AMLUtils::aml_handle_display_stereo_mode - no change needed
21:55:22.976 T:547620995072 DEBUG: CreateWindow: Created surface of size 1920x1080
21:55:22.979 T:547524440288 DEBUG: CActiveAE - display reset event
21:55:22.979 T:547516051680 INFO: CActiveAESink::OpenSink - initialize sink
21:55:22.979 T:547516051680 DEBUG: CActiveAESink::OpenSink - trying to open device ALSA:hdmi:CARD=AMLM8AUDIO,DEV=0
21:55:22.979 T:547516051680 INFO: CAESinkALSA::Initialize - Attempting to open device "default"
21:55:22.983 T:547516051680 INFO: CAESinkALSA::Initialize - Opened device "default"
21:55:22.983 T:547516051680 INFO: CAESinkALSA::InitializeHW - Your hardware does not support AE_FMT_FLOAT, trying other formats
21:55:22.983 T:547516051680 INFO: CAESinkALSA::InitializeHW - Using data format AE_FMT_S32NE
21:55:22.983 T:547516051680 DEBUG: CAESinkALSA::InitializeHW - Request: periodSize 2205, bufferSize 8820
21:55:22.983 T:547516051680 DEBUG: CAESinkALSA::InitializeHW - Got: periodSize 2048, bufferSize 8192
21:55:22.984 T:547516051680 DEBUG: CAESinkALSA::InitializeHW - Setting timeout to 186 ms
21:55:22.984 T:547516051680 DEBUG: CAESinkALSA::GetChannelLayout - Input Channel Count: 2 Output Channel Count: 2
21:55:22.984 T:547516051680 DEBUG: CAESinkALSA::GetChannelLayout - Requested Layout: FL,FR
21:55:22.984 T:547516051680 DEBUG: CAESinkALSA::GetChannelLayout - Got Layout: FL,FR (ALSA: none)
21:55:22.984 T:547516051680 DEBUG: CActiveAESink::OpenSink - ALSA Initialized:
21:55:22.984 T:547516051680 DEBUG: Output Device : AML-M8AUDIO
21:55:22.984 T:547516051680 DEBUG: Sample Rate : 44100
21:55:22.984 T:547516051680 DEBUG: Sample Format : AE_FMT_S32NE
21:55:22.984 T:547516051680 DEBUG: Channel Count : 2
21:55:22.984 T:547516051680 DEBUG: Channel Layout: FL,FR
21:55:22.984 T:547516051680 DEBUG: Frames : 2048
21:55:22.984 T:547516051680 DEBUG: Frame Size : 8
21:55:22.985 T:547524440288 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted
21:55:22.992 T:547620995072 NOTICE: GL_VENDOR = ARM
21:55:22.992 T:547620995072 NOTICE: GL_RENDERER = Mali-450 MP
21:55:22.992 T:547620995072 NOTICE: GL_VERSION = OpenGL ES 2.0
21:55:22.992 T:547620995072 NOTICE: GL_SHADING_LANGUAGE_VERSION = OpenGL ES GLSL ES 1.00
21:55:22.992 T:547620995072 DEBUG: GLES: Extension Support Test - GL_NVX_gpu_memory_info NO
21:55:22.992 T:547620995072 NOTICE: GL_EXTENSIONS = GL_OES_texture_npot GL_OES_vertex_array_object GL_OES_compressed_ETC1_RGB8_texture GL_EXT_compressed_ETC1_RGB8_sub_texture GL_OES_standard_derivatives GL_OES_EGL_image GL_OES_depth24 GL_ARM_rgba8 GL_ARM_mali_shader_binary GL_OES_depth_texture GL_OES_packed_depth_stencil GL_EXT_texture_format_BGRA8888 GL_OES_vertex_half_float GL_EXT_blend_minmax GL_OES_EGL_image_external GL_OES_EGL_sync GL_OES_rgb8_rgba8 GL_EXT_multisampled_render_to_texture GL_EXT_discard_framebuffer GL_OES_get_program_binary GL_ARM_mali_program_binary GL_EXT_shader_texture_lod GL_EXT_robustness GL_OES_depth_texture_cube_map GL_KHR_debug GL_ARM_shader_framebuffer_fetch GL_ARM_shader_framebuffer_fetch_depth_stencil GL_OES_mapbuffer
21:55:22.992 T:547620995072 DEBUG: GLES: Extension Support Test - GL_EXT_texture_format_BGRA8888 YES
21:55:22.992 T:547620995072 DEBUG: GLES: Extension Support Test - GL_IMG_texture_format_BGRA8888 NO
21:55:22.992 T:547620995072 DEBUG: GLES: Extension Support Test - GL_APPLE_texture_format_BGRA8888 NO
21:55:23.013 T:547620995072 DEBUG: GL: Vertex Shader compilation log:
21:55:23.013 T:547620995072 DEBUG: GL: Vertex Shader compiled successfully
21:55:23.014 T:547620995072 DEBUG: GL: Pixel Shader compilation log:
21:55:23.014 T:547620995072 DEBUG: GL: Fragment Shader compiled successfully
21:55:23.015 T:547620995072 DEBUG: GUI Shader [guishader_frag_default.glsl]- Initialise successful : 0x1b85800
21:55:23.026 T:547620995072 DEBUG: GL: Vertex Shader compilation log:
21:55:23.026 T:547620995072 DEBUG: GL: Vertex Shader compiled successfully
21:55:23.027 T:547620995072 DEBUG: GL: Pixel Shader compilation log:
21:55:23.027 T:547620995072 DEBUG: GL: Fragment Shader compiled successfully
21:55:23.027 T:547620995072 DEBUG: GUI Shader [guishader_frag_texture.glsl]- Initialise successful : 0x1c0ca00
21:55:23.038 T:547620995072 DEBUG: GL: Vertex Shader compilation log:
21:55:23.038 T:547620995072 DEBUG: GL: Vertex Shader compiled successfully
21:55:23.039 T:547620995072 DEBUG: GL: Pixel Shader compilation log:
21:55:23.039 T:547620995072 DEBUG: GL: Fragment Shader compiled successfully
21:55:23.040 T:547620995072 DEBUG: GUI Shader [guishader_frag_multi.glsl]- Initialise successful : 0x1c479c0
21:55:23.050 T:547620995072 DEBUG: GL: Vertex Shader compilation log:
21:55:23.051 T:547620995072 DEBUG: GL: Vertex Shader compiled successfully
21:55:23.052 T:547620995072 DEBUG: GL: Pixel Shader compilation log:
21:55:23.052 T:547620995072 DEBUG: GL: Fragment Shader compiled successfully
21:55:23.052 T:547620995072 DEBUG: GUI Shader [guishader_frag_fonts.glsl]- Initialise successful : 0x1c11670
21:55:23.063 T:547620995072 DEBUG: GL: Vertex Shader compilation log:
21:55:23.063 T:547620995072 DEBUG: GL: Vertex Shader compiled successfully
21:55:23.063 T:547620995072 DEBUG: GL: Pixel Shader compilation log:
21:55:23.063 T:547620995072 DEBUG: GL: Fragment Shader compiled successfully
21:55:23.064 T:547620995072 DEBUG: GUI Shader [guishader_frag_texture_noblend.glsl]- Initialise successful : 0x1c15260
21:55:23.074 T:547620995072 DEBUG: GL: Vertex Shader compilation log:
21:55:23.074 T:547620995072 DEBUG: GL: Vertex Shader compiled successfully
21:55:23.075 T:547620995072 DEBUG: GL: Pixel Shader compilation log:
21:55:23.075 T:547620995072 DEBUG: GL: Fragment Shader compiled successfully
21:55:23.075 T:547620995072 DEBUG: GUI Shader [guishader_frag_multi_blendcolor.glsl]- Initialise successful : 0x1c4a7b0
21:55:23.085 T:547620995072 DEBUG: GL: Vertex Shader compilation log:
21:55:23.085 T:547620995072 DEBUG: GL: Vertex Shader compiled successfully
21:55:23.086 T:547620995072 DEBUG: GL: Pixel Shader compilation log:
21:55:23.086 T:547620995072 DEBUG: GL: Fragment Shader compiled successfully
21:55:23.087 T:547620995072 DEBUG: GUI Shader [guishader_frag_rgba.glsl]- Initialise successful : 0x1c4f600
21:55:23.087 T:547620995072 DEBUG: GLES: Extension Support Test - GL_OES_EGL_image_external YES
21:55:23.097 T:547620995072 DEBUG: GL: Vertex Shader compilation log:
21:55:23.097 T:547620995072 DEBUG: GL: Vertex Shader compiled successfully
21:55:23.098 T:547620995072 DEBUG: GL: Pixel Shader compilation log:
21:55:23.099 T:547620995072 DEBUG: GL: Fragment Shader compiled successfully
21:55:23.099 T:547620995072 DEBUG: GUI Shader [guishader_frag_rgba_oes.glsl]- Initialise successful : 0x1c3ddc0
21:55:23.109 T:547620995072 DEBUG: GL: Vertex Shader compilation log:
21:55:23.109 T:547620995072 DEBUG: GL: Vertex Shader compiled successfully
21:55:23.110 T:547620995072 DEBUG: GL: Pixel Shader compilation log:
21:55:23.110 T:547620995072 DEBUG: GL: Fragment Shader compiled successfully
21:55:23.110 T:547620995072 DEBUG: GUI Shader [guishader_frag_rgba_blendcolor.glsl]- Initialise successful : 0x1c40960
21:55:23.120 T:547620995072 DEBUG: GL: Vertex Shader compilation log:
21:55:23.120 T:547620995072 DEBUG: GL: Vertex Shader compiled successfully
21:55:23.122 T:547620995072 DEBUG: GL: Pixel Shader compilation log:
21:55:23.122 T:547620995072 DEBUG: GL: Fragment Shader compiled successfully
21:55:23.123 T:547620995072 DEBUG: GUI Shader [guishader_frag_rgba_bob.glsl]- Initialise successful : 0x1c5f610
21:55:23.123 T:547620995072 DEBUG: GLES: Extension Support Test - GL_OES_EGL_image_external YES
21:55:23.133 T:547620995072 DEBUG: GL: Vertex Shader compilation log:
21:55:23.133 T:547620995072 DEBUG: GL: Vertex Shader compiled successfully
21:55:23.135 T:547620995072 DEBUG: GL: Pixel Shader compilation log:
21:55:23.135 T:547620995072 DEBUG: GL: Fragment Shader compiled successfully
21:55:23.136 T:547620995072 DEBUG: GUI Shader [guishader_frag_rgba_bob_oes.glsl]- Initialise successful : 0x1c53fe0
21:55:23.136 T:547620995072 DEBUG: CWinSystemEGL::CreateNewWindow: No need to create a new window
21:55:23.136 T:547620995072 INFO: GLES: Maximum texture width: 4096
21:55:23.378 T:547620995072 INFO: GLES: Enabling VSYNC
21:55:23.378 T:547620995072 INFO: GLES: Selected vsync mode 10
21:55:23.379 T:547620995072 INFO: load keymapping
21:55:23.382 T:547620995072 INFO: Loading special://xbmc/system/keymaps/appcommand.xml
21:55:23.383 T:547620995072 INFO: Loading special://xbmc/system/keymaps/customcontroller.AppleRemote.xml
21:55:23.385 T:547620995072 INFO: Loading special://xbmc/system/keymaps/customcontroller.Harmony.xml
21:55:23.390 T:547620995072 INFO: Loading special://xbmc/system/keymaps/gamepad.xml
21:55:23.394 T:547620995072 INFO: Loading special://xbmc/system/keymaps/joystick.xml
21:55:23.397 T:547620995072 INFO: Loading special://xbmc/system/keymaps/keyboard.xml
21:55:23.409 T:547620995072 INFO: Loading special://xbmc/system/keymaps/mouse.xml
21:55:23.411 T:547620995072 INFO: Loading special://xbmc/system/keymaps/remote.xml
21:55:23.419 T:547620995072 INFO: Loading special://xbmc/system/keymaps/touchscreen.xml
21:55:23.423 T:547620995072 INFO: Loading special://xbmc/system/Lircmap.xml
21:55:23.428 T:547620995072 INFO: * Adding remote mapping for device 'mceusb'
21:55:23.429 T:547620995072 INFO: * Adding remote mapping for device 'XboxDVDDongle'
21:55:23.429 T:547620995072 INFO: * Adding remote mapping for device 'Microsoft_Xbox'
21:55:23.429 T:547620995072 INFO: * Adding remote mapping for device 'PinnacleSysPCTVRemote'
21:55:23.429 T:547620995072 INFO: * Adding remote mapping for device 'anysee'
21:55:23.429 T:547620995072 INFO: * Adding remote mapping for device 'iMON-PAD'
21:55:23.429 T:547620995072 INFO: * Adding remote mapping for device 'Antec_Veris_RM200'
21:55:23.429 T:547620995072 INFO: * Adding remote mapping for device 'MCE_via_iMON'
21:55:23.429 T:547620995072 INFO: * Adding remote mapping for device 'TwinHanRemote'
21:55:23.429 T:547620995072 INFO: * Adding remote mapping for device 'linux-input-layer'
21:55:23.429 T:547620995072 INFO: * Linking remote mapping for 'linux-input-layer' to 'cx23885_remote'
21:55:23.429 T:547620995072 INFO: * Adding remote mapping for device 'mediacenter'
21:55:23.429 T:547620995072 INFO: * Adding remote mapping for device 'devinput'
21:55:23.430 T:547620995072 DEBUG: CButtonTranslator::Load - no userdata Lircmap.xml found, skipping
21:55:23.430 T:547620995072 INFO: GUI format 1920x1080, Display 1920x1080 @ 60.00 - Full Screen
21:55:23.430 T:547620995072 DEBUG: guilib: Fill viewport on change for solving rendering passes
21:55:23.431 T:547620995072 INFO: CLangInfo: loading resource.language.en_gb language information...
21:55:23.434 T:547620995072 DEBUG: trying to set locale to en_US.UTF-8
21:55:23.454 T:547620995072 INFO: global locale set to C
21:55:23.454 T:547620995072 INFO: CLangInfo: loading resource.language.en_gb language strings...
21:55:23.494 T:547620995072 DEBUG: LocalizeStrings: loaded 3789 strings from file resource://resource.language.en_gb/strings.po
21:55:23.508 T:547620995072 DEBUG: LocalizeStrings: loaded 1 strings from file /usr/share/kodi/addons/audioencoder.xbmc.builtin.aac/resources/language/English/strings.po
21:55:23.509 T:547620995072 DEBUG: LocalizeStrings: loaded 1 strings from file /usr/share/kodi/addons/audioencoder.xbmc.builtin.wma/resources/language/English/strings.po
21:55:23.512 T:547620995072 DEBUG: LocalizeStrings: loaded 18 strings from file /usr/share/kodi/addons/game.controller.default/resources/language/resource.language.en_gb/strings.po
21:55:23.513 T:547620995072 DEBUG: LocalizeStrings: loaded 13 strings from file /usr/share/kodi/addons/metadata.album.universal/resources/language/English/strings.po
21:55:23.515 T:547620995072 DEBUG: LocalizeStrings: loaded 26 strings from file /usr/share/kodi/addons/metadata.artists.universal/resources/language/English/strings.po
21:55:23.523 T:547620995072 DEBUG: POParser: PO file has Win Style Line Endings. Converted in memory to Linux LF for file: /storage/.kodi/addons/metadata.themoviedb.org/resources/language/English/strings.po
21:55:23.523 T:547620995072 DEBUG: LocalizeStrings: loaded 8 strings from file /storage/.kodi/addons/metadata.themoviedb.org/resources/language/English/strings.po
21:55:23.527 T:547620995072 DEBUG: LocalizeStrings: loaded 10 strings from file /storage/.kodi/addons/metadata.tvdb.com/resources/language/English/strings.po
21:55:23.533 T:547620995072 DEBUG: LocalizeStrings: loaded 1 strings from file /usr/share/kodi/addons/screensaver.xbmc.builtin.dim/resources/language/resource.language.en_gb/strings.po
21:55:23.536 T:547620995072 DEBUG: LocalizeStrings: loaded 206 strings from file /usr/share/kodi/addons/service.libreelec.settings/resources/language/English/strings.po
21:55:23.546 T:547620995072 DEBUG: LocalizeStrings: loaded 120 strings from file /storage/.kodi/addons/script.skinshortcuts/resources/language/English/strings.po
21:55:23.550 T:547620995072 DEBUG: LocalizeStrings: loaded 24 strings from file /storage/.kodi/addons/service.library.data.provider/resources/language/resource.language.en_gb/strings.po
21:55:23.556 T:547620995072 DEBUG: LocalizeStrings: loaded 45 strings from file /storage/.kodi/addons/weather.wunderground/resources/language/English/strings.po
21:55:23.560 T:547620995072 DEBUG: LocalizeStrings: loaded 6 strings from file /storage/.kodi/addons/weather.yahoo/resources/language/English/strings.po
21:55:23.569 T:547620995072 DEBUG: LocalizeStrings: loaded 48 strings from file /storage/.kodi/addons/script.cu.lrclyrics/resources/language/English/strings.po
21:55:23.572 T:547620995072 DEBUG: LocalizeStrings: loaded 19 strings from file /storage/.kodi/addons/script.tvaddons.debug.log/resources/language/English/strings.po
21:55:23.575 T:547620995072 DEBUG: LocalizeStrings: loaded 10 strings from file /storage/.kodi/addons/script.ipcam/resources/language/English/strings.xml
21:55:23.580 T:547620995072 DEBUG: LocalizeStrings: loaded 7 strings from file /storage/.kodi/addons/script.common.plugin.cache/resources/language/English/strings.xml
21:55:23.585 T:547620995072 DEBUG: LocalizeStrings: loaded 25 strings from file /storage/.kodi/addons/screensaver.picture.slideshow/resources/language/English/strings.po
21:55:23.590 T:547620995072 DEBUG: LoadMappings - loaded node "Motorola Nyxboard Hybrid"
21:55:23.590 T:547620995072 DEBUG: LoadMappings - loaded node "CEC Adapter"
21:55:23.590 T:547620995072 DEBUG: LoadMappings - loaded node "Pulse-Eight CEC Adapter"
21:55:23.590 T:547620995072 DEBUG: LoadMappings - loaded node "iMON HID device"
21:55:23.591 T:547620995072 DEBUG: LoadMappings - loaded node "WETEK Play remote"
21:55:23.591 T:547620995072 DEBUG: LoadMappings - loaded node ""
21:55:23.591 T:547620995072 DEBUG: CPeripheralBusUSB - initialised udev monitor
21:55:23.591 T:547620995072 DEBUG: SECTION:LoadDLL(libcec.so.4)
21:55:23.592 T:547620995072 DEBUG: Loading: libcec.so.4
21:55:23.633 T:547620995072 DEBUG: Add-on bus: Registering add-on peripheral.joystick
21:55:23.633 T:547620995072 DEBUG: PERIPHERAL - CreateAddon - creating peripheral add-on instance 'Joystick Support'
21:55:23.633 T:547620995072 DEBUG: ADDON: Dll Initializing - Joystick Support
21:55:23.634 T:547620995072 DEBUG: SECTION:LoadDLL(/usr/lib/kodi/addons/peripheral.joystick/peripheral.joystick.so.1.3.4)
21:55:23.634 T:547620995072 DEBUG: Loading: /usr/lib/kodi/addons/peripheral.joystick/peripheral.joystick.so.1.3.4
21:55:23.662 T:547620995072 DEBUG: AddOnLog: Joystick Support: Loaded 14 joystick families with 97 total joysticks
21:55:23.663 T:547620995072 DEBUG: Calling TransferSettings for: Joystick Support
21:55:23.663 T:547187724512 DEBUG: Thread PeripBusUSBUdev start, auto delete: false
21:55:23.663 T:547179335904 DEBUG: Thread PeripBusCEC start, auto delete: false
21:55:23.664 T:547170947296 DEBUG: Thread PeripBusAddon start, auto delete: false
21:55:23.664 T:547620995072 DEBUG: SECTION:LoadDLL(libcurl.so.4)
21:55:23.664 T:547162558688 DEBUG: Thread PeripEventScanner start, auto delete: false
21:55:23.665 T:547620995072 DEBUG: Loading: libcurl.so.4
21:55:23.679 T:547532828896 NOTICE: Running database version Addons27
21:55:23.679 T:547532828896 DEBUG: Initialize, updating databases...
21:55:23.683 T:547532828896 NOTICE: Running database version ViewModes6
21:55:23.772 T:547179335904 DEBUG: GetMappingForDevice - device (0000:0000) mapped to CEC Adapter (type = cec)
21:55:23.859 T:547532828896 NOTICE: Running database version Textures13
21:55:23.861 T:547179335904 DEBUG: Initialise - initialised peripheral on 'AOCEC' with 2 features and 0 sub devices
21:55:23.861 T:547179335904 NOTICE: Register - new cec device registered on cec->AOCEC: CEC Adapter (0000:0000)
21:55:23.879 T:547532828896 INFO: MYSQL: Connected to version 5.7.18-0ubuntu0.16.04.1
21:55:23.913 T:547532828896 NOTICE: Running database version MyMusic60
21:55:23.953 T:547532828896 NOTICE: Running database version MyVideos107
21:55:23.957 T:547532828896 NOTICE: Running database version TV29
21:55:23.961 T:547532828896 NOTICE: Running database version Epg11
21:55:23.965 T:547532828896 DEBUG: Initialize, updating databases... DONE
21:55:23.967 T:547620995072 NOTICE: start dvd mediatype detection
21:55:23.967 T:547620995072 INFO: DPMS: not supported on this platform
21:55:23.967 T:547151552736 DEBUG: Thread DetectDVDMedia start, auto delete: false
21:55:23.967 T:547151552736 DEBUG: Compiled with libcdio Version 0.94
21:55:23.969 T:547151552736 DEBUG: Thread DetectDVDMedia 547151552736 terminating
21:55:24.003 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnClear from xbmc
21:55:24.003 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnClear
21:55:24.020 T:547620995072 INFO: Unloading old skin ...
21:55:24.030 T:547620995072 INFO: load skin from: /storage/.kodi/addons/skin.aeon.nox.5 (version: 6.0.1)
21:55:24.030 T:547620995072 INFO: load fonts for skin...
21:55:24.035 T:547620995072 INFO: Loading colors from /storage/.kodi/addons/skin.aeon.nox.5/colors/red.xml
21:55:24.037 T:547620995072 INFO: Loading fonts from /storage/.kodi/addons/skin.aeon.nox.5/1080i/Font.xml
21:55:24.237 T:547620995072 DEBUG: LocalizeStrings: loaded 261 strings from file /storage/.kodi/addons/skin.aeon.nox.5/language/English/strings.po
21:55:24.239 T:547620995072 INFO: Loading skin includes from /storage/.kodi/addons/skin.aeon.nox.5/1080i/Includes.xml
21:55:24.749 T:547620995072 INFO: load new skin...
21:55:24.749 T:547620995072 INFO: Loading user windows, path /storage/.kodi/addons/skin.aeon.nox.5/1080i
21:55:24.809 T:547620995072 DEBUG: Load Skin XML: 60.57ms
21:55:24.809 T:547620995072 INFO: initialize new skin...
21:55:24.810 T:547620995072 DEBUG: guilib: Fill viewport on change for solving rendering passes
21:55:24.810 T:547620995072 INFO: Loading skin file: Pointer.xml, load type: LOAD_ON_GUI_INIT
21:55:24.814 T:547620995072 DEBUG: OpenBundle - Opened bundle /storage/.kodi/addons/skin.aeon.nox.5/media/red.xbt
21:55:24.835 T:547620995072 DEBUG: OpenBundle - Opened bundle /storage/.kodi/addons/skin.aeon.nox.5/media/Textures.xbt
21:55:24.842 T:547620995072 INFO: Loading skin file: DialogVolumeBar.xml, load type: LOAD_ON_GUI_INIT
21:55:24.854 T:547620995072 INFO: Loading skin file: DialogNotification.xml, load type: LOAD_ON_GUI_INIT
21:55:24.857 T:547620995072 INFO: Loading skin file: DialogSeekBar.xml, load type: LOAD_ON_GUI_INIT
21:55:24.884 T:547620995072 INFO: Loading skin file: DialogBusy.xml, load type: LOAD_ON_GUI_INIT
21:55:24.890 T:547620995072 INFO: Loading skin file: DialogExtendedProgressBar.xml, load type: LOAD_ON_GUI_INIT
21:55:24.895 T:547620995072 INFO: Loading resource://resource.uisounds.kodi/sounds.xml
21:55:24.968 T:547620995072 INFO: skin loaded...
21:55:24.968 T:547620995072 DEBUG: Activating window ID: 12997
21:55:24.968 T:547620995072 DEBUG: ------ Window Init () ------
21:55:24.968 T:547620995072 INFO: load splash image: /usr/share/kodi/media/Splash.png
21:55:25.003 T:547620995072 DEBUG: JSONRPC: JSON schema type definition references an unknown type Setting.Details.Setting
21:55:25.003 T:547620995072 WARNING: JSONRPC: Could not parse type "Setting.Details.SettingList"
21:55:25.003 T:547620995072 INFO: JSONRPC: Adding type "Setting.Details.SettingList" to list of incomplete definitions (waiting for "Setting.Details.Setting")
21:55:25.004 T:547620995072 INFO: JSONRPC: Resolving incomplete types/methods referencing Setting.Details.Setting
21:55:25.055 T:547620995072 INFO: JSONRPC v8.0.0: Successfully initialized
21:55:25.055 T:547620995072 DEBUG: ADDON: Starting service addons.
21:55:25.059 T:547151552736 DEBUG: Thread LanguageInvoker start, auto delete: false
21:55:25.059 T:547151552736 INFO: initializing python engine.
21:55:25.059 T:546722762976 DEBUG: Thread LanguageInvoker start, auto delete: false
21:55:25.059 T:546722762976 INFO: initializing python engine.
21:55:25.059 T:547620995072 DEBUG: Activating window ID: 12999
21:55:25.059 T:546714374368 DEBUG: Thread LanguageInvoker start, auto delete: false
21:55:25.059 T:547620995072 DEBUG: ------ Window Init (Startup.xml) ------
21:55:25.059 T:546714374368 INFO: initializing python engine.
21:55:25.059 T:547620995072 INFO: Loading skin file: Startup.xml, load type: LOAD_EVERY_TIME
21:55:25.061 T:546705985760 DEBUG: Thread Timer start, auto delete: false
21:55:25.071 T:547620995072 DEBUG: Activating window ID: 10000
21:55:25.071 T:547620995072 DEBUG: ------ Window Deinit (Startup.xml) ------
21:55:25.071 T:547620995072 DEBUG: ------ Window Init (Home.xml) ------
21:55:25.071 T:547620995072 INFO: Loading skin file: Home.xml, load type: KEEP_IN_MEMORY
21:55:25.100 T:547151552736 DEBUG: CPythonInvoker(0, /storage/.kodi/addons/script.grab.fanart/service.py): start processing
21:55:25.100 T:546722762976 DEBUG: CPythonInvoker(1, /storage/.kodi/addons/service.library.data.provider/service.py): start processing
21:55:25.100 T:546714374368 DEBUG: CPythonInvoker(2, /storage/.kodi/addons/script.cu.lrclyrics/default.py): start processing
21:55:25.122 T:547620995072 DEBUG: CSettingsManager: requested setting (gamesgeneral.enable) was not found.
21:55:25.163 T:547151552736 DEBUG: -->Python Interpreter Initialized<--
21:55:25.163 T:547151552736 DEBUG: CPythonInvoker(0, /storage/.kodi/addons/script.grab.fanart/service.py): the source file to load is "/storage/.kodi/addons/script.grab.fanart/service.py"
21:55:25.164 T:547151552736 DEBUG: CPythonInvoker(0, /storage/.kodi/addons/script.grab.fanart/service.py): setting the Python path to /storage/.kodi/addons/script.grab.fanart:/usr/lib/python27.zip:/usr/lib/python2.7:/usr/lib/python2.7/plat-linux2:/usr/lib/python2.7/lib-tk:/usr/lib/python2.7/lib-old:/usr/lib/python2.7/lib-dynload:/usr/lib/python2.7/site-packages:/usr/lib/python2.7/site-packages/gtk-2.0
21:55:25.164 T:547151552736 DEBUG: CPythonInvoker(0, /storage/.kodi/addons/script.grab.fanart/service.py): entering source directory /storage/.kodi/addons/script.grab.fanart
21:55:25.183 T:547151552736 DEBUG: CPythonInvoker(0, /storage/.kodi/addons/script.grab.fanart/service.py): instantiating addon using automatically obtained id of "script.grab.fanart" dependent on version 2.19.0 of the xbmc.python api
21:55:25.210 T:546714374368 DEBUG: -->Python Interpreter Initialized<--
21:55:25.210 T:546714374368 DEBUG: CPythonInvoker(2, /storage/.kodi/addons/script.cu.lrclyrics/default.py): the source file to load is "/storage/.kodi/addons/script.cu.lrclyrics/default.py"
21:55:25.210 T:546722762976 DEBUG: -->Python Interpreter Initialized<--
21:55:25.210 T:546722762976 DEBUG: CPythonInvoker(1, /storage/.kodi/addons/service.library.data.provider/service.py): the source file to load is "/storage/.kodi/addons/service.library.data.provider/service.py"
21:55:25.211 T:546714374368 DEBUG: CPythonInvoker(2, /storage/.kodi/addons/script.cu.lrclyrics/default.py): setting the Python path to /storage/.kodi/addons/script.cu.lrclyrics:/storage/.kodi/addons/script.module.beautifulsoup4/lib:/storage/.kodi/addons/script.module.chardet/lib:/usr/lib/python27.zip:/usr/lib/python2.7:/usr/lib/python2.7/plat-linux2:/usr/lib/python2.7/lib-tk:/usr/lib/python2.7/lib-old:/usr/lib/python2.7/lib-dynload:/usr/lib/python2.7/site-packages:/usr/lib/python2.7/site-packages/gtk-2.0
21:55:25.211 T:546714374368 DEBUG: CPythonInvoker(2, /storage/.kodi/addons/script.cu.lrclyrics/default.py): entering source directory /storage/.kodi/addons/script.cu.lrclyrics
21:55:25.211 T:546722762976 DEBUG: CPythonInvoker(1, /storage/.kodi/addons/service.library.data.provider/service.py): setting the Python path to /storage/.kodi/addons/service.library.data.provider:/storage/.kodi/addons/script.module.routing/lib:/storage/.kodi/addons/script.module.simplejson/lib:/usr/lib/python27.zip:/usr/lib/python2.7:/usr/lib/python2.7/plat-linux2:/usr/lib/python2.7/lib-tk:/usr/lib/python2.7/lib-old:/usr/lib/python2.7/lib-dynload:/usr/lib/python2.7/site-packages:/usr/lib/python2.7/site-packages/gtk-2.0
21:55:25.211 T:546722762976 DEBUG: CPythonInvoker(1, /storage/.kodi/addons/service.library.data.provider/service.py): entering source directory /storage/.kodi/addons/service.library.data.provider
21:55:25.211 T:546714374368 DEBUG: CPythonInvoker(2, /storage/.kodi/addons/script.cu.lrclyrics/default.py): instantiating addon using automatically obtained id of "script.cu.lrclyrics" dependent on version 2.25.0 of the xbmc.python api
21:55:25.215 T:546722762976 DEBUG: CPythonInvoker(1, /storage/.kodi/addons/service.library.data.provider/service.py): instantiating addon using automatically obtained id of "service.library.data.provider" dependent on version 2.25.0 of the xbmc.python api
21:55:25.217 T:547620995072 DEBUG: CDirectoryProvider[special://skin/extras/playlists/recentmovies.xsp]: refreshing..
21:55:25.218 T:547620995072 DEBUG: CDirectoryProvider[special://skin/extras/playlists/recommendedmovies.xsp]: refreshing..
21:55:25.218 T:547620995072 DEBUG: CDirectoryProvider[plugin://service.library.data.provider?type=randommovies&reload=]: refreshing..
21:55:25.219 T:546694447328 DEBUG: Thread JobWorker start, auto delete: true
21:55:25.219 T:547620995072 DEBUG: CDirectoryProvider[special://skin/extras/playlists/recentmovies.xsp]: refreshing..
21:55:25.219 T:546686058720 DEBUG: Thread JobWorker start, auto delete: true
21:55:25.220 T:546686058720 DEBUG: StartScript - calling plugin Library Data Provider('plugin://service.library.data.provider/','1','?type=randommovies&reload=')
21:55:25.221 T:546677670112 DEBUG: Thread LanguageInvoker start, auto delete: false
21:55:25.221 T:546677670112 INFO: initializing python engine.
21:55:25.221 T:546677670112 DEBUG: CPythonInvoker(3, /storage/.kodi/addons/service.library.data.provider/plugin.py): start processing
21:55:25.443 T:546694447328 DEBUG: RunQuery took 165 ms for 2 items query: select * from movie_view WHERE (movie_view.idFile IN (SELECT DISTINCT idFile FROM bookmark WHERE type = 1))
21:55:25.560 T:547532828896 DEBUG: RunQuery took 286 ms for 592 items query: select * from movie_view WHERE ((movie_view.playCount IS NULL OR movie_view.playCount = 0))
21:55:25.568 T:546705985760 DEBUG: Thread Timer 546705985760 terminating
21:55:25.699 T:546694447328 DEBUG: RunQuery took 159 ms for 592 items query: select * from movie_view WHERE ((movie_view.playCount IS NULL OR movie_view.playCount = 0))
21:55:25.726 T:546705985760 DEBUG: Thread LanguageInvoker start, auto delete: false
21:55:25.726 T:546705985760 INFO: initializing python engine.
21:55:25.726 T:546705985760 DEBUG: CPythonInvoker(4, /storage/.kodi/addons/script.skinshortcuts/default.py): start processing
21:55:25.729 T:547620995072 DEBUG: ContextMenuManager: addon menus reloaded.
21:55:25.729 T:547620995072 INFO: removing tempfiles
21:55:25.730 T:547620995072 DEBUG: ADDON: Starting service addons.
21:55:25.735 T:546331144416 DEBUG: Thread LanguageInvoker start, auto delete: false
21:55:25.735 T:546331144416 INFO: initializing python engine.
21:55:25.736 T:546322755808 DEBUG: Thread LanguageInvoker start, auto delete: false
21:55:25.736 T:546331144416 DEBUG: CPythonInvoker(5, /usr/share/kodi/addons/service.libreelec.settings/service.py): start processing
21:55:25.736 T:546322755808 INFO: initializing python engine.
21:55:25.736 T:546322755808 DEBUG: CPythonInvoker(6, /storage/.kodi/addons/script.common.plugin.cache/default.py): start processing
21:55:25.751 T:547620995072 DEBUG: CRepositoryUpdater: previous update at 02/22/2018 10:15:50 AM, next at 02/23/2018 10:15:50 AM
21:55:25.752 T:547620995072 NOTICE: initialize done
21:55:25.752 T:547620995072 NOTICE: Running the application...
21:55:25.752 T:546314367200 DEBUG: Thread Timer start, auto delete: false
21:55:25.761 T:547620995072 DEBUG: no profile autoexec.py (/storage/.kodi/userdata/autoexec.py) found, skipping
21:55:25.761 T:547620995072 DEBUG: NetworkMessage - Starting network services
21:55:25.767 T:547620995072 DEBUG: CZeroconfAvahi::clientCallback: client is up and running
21:55:25.767 T:547620995072 NOTICE: starting zeroconf publishing
21:55:25.768 T:547620995072 NOTICE: CWebServer[8080]: Started
21:55:25.768 T:547620995072 NOTICE: starting upnp client
21:55:25.772 T:547620995072 INFO: JSONRPC Server: Successfully initialized
21:55:25.772 T:545838330080 DEBUG: Thread EventServer start, auto delete: false
21:55:25.772 T:545838330080 NOTICE: ES: Starting UDP Event server on port 9777
21:55:25.772 T:547620995072 DEBUG: SECTION:LoadDLL(libshairplay.so.0)
21:55:25.772 T:545838330080 NOTICE: UDP: Listening on port 9777 (ipv6 : true)
21:55:25.774 T:547620995072 DEBUG: Loading: libshairplay.so.0
21:55:25.778 T:545829941472 DEBUG: Thread TCPServer start, auto delete: false
21:55:25.779 T:547620995072 INFO: AIRPLAY: Cleaning up photoassetcache
21:55:25.780 T:547620995072 INFO: AIRPLAY Server: Successfully initialized
21:55:25.781 T:545813164256 DEBUG: Thread AirPlayServer start, auto delete: false
21:55:25.831 T:547532828896 DEBUG: CRecentlyAddedJob::UpdateMusic() - Running RecentlyAdded home screen update
21:55:25.902 T:547532828896 DEBUG: GetRecentlyAddedAlbumSongs() query: SELECT songview.*, songartistview.* FROM (SELECT idAlbum FROM album ORDER BY idAlbum DESC LIMIT 10) AS recentalbums JOIN songview ON songview.idAlbum = recentalbums.idAlbum JOIN songartistview ON songview.idSong = songartistview.idSong ORDER BY songview.idAlbum DESC, songview.idSong, songartistview.idRole, songartistview.iOrder
21:55:25.946 T:546694447328 DEBUG: CZeroconfAvahi::doPublishService identifier: servers.webserver type: _http._tcp name:Kodi (LibreELEC) port:8080
21:55:25.946 T:546694447328 DEBUG: CZeroconfAvahi::addService() named: Kodi (LibreELEC) type: _http._tcp port:8080
21:55:25.950 T:546694447328 DEBUG: CZeroconfAvahi::doPublishService identifier: servers.jsonrpc-http type: _xbmc-jsonrpc-h._tcp name:Kodi (LibreELEC) port:8080
21:55:25.950 T:546694447328 DEBUG: CZeroconfAvahi::addService() named: Kodi (LibreELEC) type: _xbmc-jsonrpc-h._tcp port:8080
21:55:25.953 T:546694447328 DEBUG: CZeroconfAvahi::doPublishService identifier: servers.jsonrpc-tpc type: _xbmc-jsonrpc._tcp name:Kodi (LibreELEC) port:9090
21:55:25.953 T:546694447328 DEBUG: CZeroconfAvahi::addService() named: Kodi (LibreELEC) type: _xbmc-jsonrpc._tcp port:9090
21:55:25.957 T:546694447328 DEBUG: CZeroconfAvahi::doPublishService identifier: servers.eventserver type: _xbmc-events._udp name:Kodi (LibreELEC) port:9777
21:55:25.957 T:546694447328 DEBUG: CZeroconfAvahi::addService() named: Kodi (LibreELEC) type: _xbmc-events._udp port:9777
21:55:25.960 T:546694447328 DEBUG: CZeroconfAvahi::doPublishService identifier: servers.airtunes type: _raop._tcp name:001E063462A3@Kodi (LibreELEC) port:36666
21:55:25.960 T:546694447328 DEBUG: CZeroconfAvahi::addService() named: 001E063462A3@Kodi (LibreELEC) type: _raop._tcp port:36666
21:55:25.963 T:546694447328 DEBUG: CZeroconfAvahi::doPublishService identifier: servers.airplay type: _airplay._tcp name:Kodi (LibreELEC) port:36667
21:55:25.963 T:546694447328 DEBUG: CZeroconfAvahi::addService() named: Kodi (LibreELEC) type: _airplay._tcp port:36667
21:55:26.018 T:547620995072 INFO: Found input device /dev/input/event0
21:55:26.018 T:547620995072 INFO: opened device 'adc_keypad' (file name /dev/input/event0), m_bSkipNonKeyEvents 0
21:55:26.026 T:547532828896 DEBUG: This query part contains a like, we will double backslash in the next field: select idArtist from artist where artist.strArtist like '
21:55:26.077 T:547532828896 DEBUG: GetRecentlyAddedAlbums query: SELECT albumview.*, albumartistview.* FROM (SELECT idAlbum FROM album WHERE strAlbum != '' ORDER BY idAlbum DESC LIMIT 10) AS recentalbums JOIN albumview ON albumview.idAlbum = recentalbums.idAlbum JOIN albumartistview ON albumview.idAlbum = albumartistview.idAlbum ORDER BY albumview.idAlbum desc, albumartistview.iOrder
21:55:26.153 T:547532828896 DEBUG: CRecentlyAddedJob::UpdateVideos() - Running RecentlyAdded home screen update
21:55:26.226 T:546722762976 DEBUG: Library Data Provider: service version 0.3.0 started
21:55:26.241 T:547532828896 DEBUG: RunQuery took 63 ms for 10 items query: select * from movie_view ORDER BY dateAdded desc, idMovie desc LIMIT 10
21:55:26.298 T:547620995072 INFO: Found input device /dev/input/event2
21:55:26.298 T:547620995072 INFO: opened device 'cec_input' (file name /dev/input/event2), m_bSkipNonKeyEvents 0
21:55:26.342 T:546322755808 DEBUG: -->Python Interpreter Initialized<--
21:55:26.342 T:546322755808 DEBUG: CPythonInvoker(6, /storage/.kodi/addons/script.common.plugin.cache/default.py): the source file to load is "/storage/.kodi/addons/script.common.plugin.cache/default.py"
21:55:26.343 T:547151552736 NOTICE: script.grab.fanart: Grab Fanart Service Started
21:55:26.345 T:547151552736 DEBUG: script.grab.fanart: media type is: random
21:55:26.345 T:546705985760 DEBUG: -->Python Interpreter Initialized<--
21:55:26.345 T:546705985760 DEBUG: CPythonInvoker(4, /storage/.kodi/addons/script.skinshortcuts/default.py): the source file to load is "/storage/.kodi/addons/script.skinshortcuts/default.py"
21:55:26.347 T:546331144416 DEBUG: -->Python Interpreter Initialized<--
21:55:26.347 T:546331144416 DEBUG: CPythonInvoker(5, /usr/share/kodi/addons/service.libreelec.settings/service.py): the source file to load is "/usr/share/kodi/addons/service.libreelec.settings/service.py"
21:55:26.347 T:546331144416 DEBUG: CPythonInvoker(5, /usr/share/kodi/addons/service.libreelec.settings/service.py): setting the Python path to /usr/share/kodi/addons/service.libreelec.settings:/usr/lib/python27.zip:/usr/lib/python2.7:/usr/lib/python2.7/plat-linux2:/usr/lib/python2.7/lib-tk:/usr/lib/python2.7/lib-old:/usr/lib/python2.7/lib-dynload:/usr/lib/python2.7/site-packages:/usr/lib/python2.7/site-packages/gtk-2.0
21:55:26.347 T:546331144416 DEBUG: CPythonInvoker(5, /usr/share/kodi/addons/service.libreelec.settings/service.py): entering source directory /usr/share/kodi/addons/service.libreelec.settings
21:55:26.347 T:546322755808 DEBUG: CPythonInvoker(6, /storage/.kodi/addons/script.common.plugin.cache/default.py): setting the Python path to /storage/.kodi/addons/script.common.plugin.cache:/usr/lib/python27.zip:/usr/lib/python2.7:/usr/lib/python2.7/plat-linux2:/usr/lib/python2.7/lib-tk:/usr/lib/python2.7/lib-old:/usr/lib/python2.7/lib-dynload:/usr/lib/python2.7/site-packages:/usr/lib/python2.7/site-packages/gtk-2.0
21:55:26.347 T:546322755808 DEBUG: CPythonInvoker(6, /storage/.kodi/addons/script.common.plugin.cache/default.py): entering source directory /storage/.kodi/addons/script.common.plugin.cache
21:55:26.347 T:546331144416 DEBUG: CPythonInvoker(5, /usr/share/kodi/addons/service.libreelec.settings/service.py): instantiating addon using automatically obtained id of "service.libreelec.settings" dependent on version 2.1.0 of the xbmc.python api
21:55:26.352 T:546322755808 DEBUG: CPythonInvoker(6, /storage/.kodi/addons/script.common.plugin.cache/default.py): instantiating addon using automatically obtained id of "script.common.plugin.cache" dependent on version 2.24.0 of the xbmc.python api
21:55:26.354 T:546677670112 DEBUG: -->Python Interpreter Initialized<--
21:55:26.354 T:546677670112 DEBUG: CPythonInvoker(3, /storage/.kodi/addons/service.library.data.provider/plugin.py): the source file to load is "/storage/.kodi/addons/service.library.data.provider/plugin.py"
21:55:26.419 T:546722762976 DEBUG: RunQuery took 150 ms for 592 items query: select * from movie_view WHERE ((movie_view.playCount IS NULL OR movie_view.playCount < 1))
21:55:26.566 T:546331144416 DEBUG: ## LibreELEC Addon ## 8.2.0
21:55:26.578 T:547620995072 INFO: Found input device /dev/input/event4
21:55:26.578 T:547620995072 INFO: opened device 'MCE IR Keyboard/Mouse (meson-ir)' (file name /dev/input/event4), m_bSkipNonKeyEvents 0
21:55:26.587 T:546677670112 DEBUG: CPythonInvoker(3, /storage/.kodi/addons/service.library.data.provider/plugin.py): setting the Python path to /storage/.kodi/addons/service.library.data.provider:/storage/.kodi/addons/script.module.routing/lib:/storage/.kodi/addons/script.module.simplejson/lib:/usr/lib/python27.zip:/usr/lib/python2.7:/usr/lib/python2.7/plat-linux2:/usr/lib/python2.7/lib-tk:/usr/lib/python2.7/lib-old:/usr/lib/python2.7/lib-dynload:/usr/lib/python2.7/site-packages:/usr/lib/python2.7/site-packages/gtk-2.0
21:55:26.588 T:546677670112 DEBUG: CPythonInvoker(3, /storage/.kodi/addons/service.library.data.provider/plugin.py): entering source directory /storage/.kodi/addons/service.library.data.provider
21:55:26.588 T:546677670112 DEBUG: CPythonInvoker(3, /storage/.kodi/addons/service.library.data.provider/plugin.py): instantiating addon using automatically obtained id of "service.library.data.provider" dependent on version 2.25.0 of the xbmc.python api
21:55:26.598 T:546705985760 DEBUG: CPythonInvoker(4, /storage/.kodi/addons/script.skinshortcuts/default.py): setting the Python path to /storage/.kodi/addons/script.skinshortcuts:/storage/.kodi/addons/script.module.simplejson/lib:/storage/.kodi/addons/script.module.unidecode/lib:/usr/lib/python27.zip:/usr/lib/python2.7:/usr/lib/python2.7/plat-linux2:/usr/lib/python2.7/lib-tk:/usr/lib/python2.7/lib-old:/usr/lib/python2.7/lib-dynload:/usr/lib/python2.7/site-packages:/usr/lib/python2.7/site-packages/gtk-2.0
21:55:26.598 T:546705985760 DEBUG: CPythonInvoker(4, /storage/.kodi/addons/script.skinshortcuts/default.py): entering source directory /storage/.kodi/addons/script.skinshortcuts
21:55:26.598 T:546705985760 DEBUG: CPythonInvoker(4, /storage/.kodi/addons/script.skinshortcuts/default.py): instantiating addon using automatically obtained id of "script.skinshortcuts" dependent on version 2.20.0 of the xbmc.python api
21:55:26.601 T:547151552736 DEBUG: RunQuery took 214 ms for 600 items query: select * from movie_view
21:55:26.804 T:547532828896 DEBUG: RunQuery took 476 ms for 10 items query: select * from episode_view ORDER BY dateAdded desc, idEpisode desc LIMIT 10
21:55:26.828 T:547620995072 INFO: Found input device /dev/input/event6
21:55:26.828 T:547620995072 INFO: opened device 'eventlircd' (file name /dev/input/event6), m_bSkipNonKeyEvents 0
21:55:26.828 T:545591328992 DEBUG: Thread CLinuxInputDevicesCheckHotplugged start, auto delete: false
21:55:26.835 T:547620995072 DEBUG: ------ Window Init (Pointer.xml) ------
21:55:26.837 T:547620995072 DEBUG: LogindUPowerSyscall - Received unknown signal NameAcquired
21:55:26.838 T:547620995072 DEBUG: ------ Window Deinit (Pointer.xml) ------
21:55:26.897 T:546305634528 DEBUG: CZeroconfAvahi::groupCallback: Service successfully established
21:55:26.919 T:547532828896 DEBUG: Previous line repeats 5 times.
21:55:26.919 T:547532828896 DEBUG: RunQuery took 6 ms for 0 items query: select * from musicvideo_view ORDER BY dateAdded desc, idMVideo desc LIMIT 10
21:55:26.920 T:547532828896 DEBUG: CRecentlyAddedJob::UpdateTotal() - Running RecentlyAdded home screen update
21:55:26.969 T:547532828896 DEBUG: GetArtistsByWhere query: SELECT COUNT(DISTINCT artistview.idArtist) FROM artistview WHERE ((EXISTS (SELECT 1 FROM song_artist WHERE song_artist.idArtist = artistview.idArtist AND song_artist.idRole = 1) OR EXISTS (SELECT 1 FROM album_artist WHERE album_artist.idArtist = artistview.idArtist)) AND (artistview.strArtist != '')) AND (artistview.strArtist <> 'Various artists')
21:55:26.995 T:546322755808 DEBUG: StorageServer Module loaded RUN
21:55:26.996 T:546322755808 DEBUG: StorageClient-2.5.4 Starting server
21:55:27.089 T:546677670112 DEBUG: Library Data Provider: script version 0.3.0 started
21:55:27.396 T:546694447328 DEBUG: Caching image '/storage/pictures/backgrounds/262341877007204732image_fullscreen_001_landscape.jpg' to 'a/ad43495f.jpg':
21:55:27.396 T:546694447328 DEBUG: cached image 'special://masterprofile/Thumbnails/a/ad43495f.jpg' size 1920x1080
21:55:27.582 T:545371656416 DEBUG: Thread Timer start, auto delete: false
21:55:27.658 T:546705985760 INFO: CPythonInvoker(4, /storage/.kodi/addons/script.skinshortcuts/default.py): script successfully run
21:55:27.665 T:545371656416 DEBUG: Thread Timer 545371656416 terminating
21:55:27.665 T:545371656416 DEBUG: Thread Timer start, auto delete: false
21:55:27.698 T:547532828896 INFO: WEATHER: Downloading weather
21:55:27.698 T:545388433632 DEBUG: Thread LanguageInvoker start, auto delete: false
21:55:27.699 T:545388433632 INFO: initializing python engine.
21:55:27.699 T:545388433632 DEBUG: CPythonInvoker(7, /storage/.kodi/addons/weather.yahoo/default.py): start processing
21:55:27.780 T:546705985760 INFO: Python script stopped
21:55:27.780 T:546705985760 DEBUG: Thread LanguageInvoker 546705985760 terminating
21:55:27.819 T:545388433632 DEBUG: -->Python Interpreter Initialized<--
21:55:27.819 T:545388433632 DEBUG: CPythonInvoker(7, /storage/.kodi/addons/weather.yahoo/default.py): the source file to load is "/storage/.kodi/addons/weather.yahoo/default.py"
21:55:27.819 T:545388433632 DEBUG: CPythonInvoker(7, /storage/.kodi/addons/weather.yahoo/default.py): setting the Python path to /storage/.kodi/addons/weather.yahoo:/usr/lib/python27.zip:/usr/lib/python2.7:/usr/lib/python2.7/plat-linux2:/usr/lib/python2.7/lib-tk:/usr/lib/python2.7/lib-old:/usr/lib/python2.7/lib-dynload:/usr/lib/python2.7/site-packages:/usr/lib/python2.7/site-packages/gtk-2.0
21:55:27.819 T:545388433632 DEBUG: CPythonInvoker(7, /storage/.kodi/addons/weather.yahoo/default.py): entering source directory /storage/.kodi/addons/weather.yahoo
21:55:27.819 T:545388433632 DEBUG: CPythonInvoker(7, /storage/.kodi/addons/weather.yahoo/default.py): instantiating addon using automatically obtained id of "weather.yahoo" dependent on version 2.25.0 of the xbmc.python api
21:55:28.116 T:546722762976 DEBUG: RunQuery took 1192 ms for 8250 items query: select * from episode_view WHERE ((episode_view.playCount IS NULL OR episode_view.playCount < 1))
21:55:28.124 T:545388433632 DEBUG: weather.yahoo: version 4.3.1 started: ['/storage/.kodi/addons/weather.yahoo/default.py', '1']
21:55:28.136 T:545388433632 DEBUG: weather.yahoo: empty location id
21:55:28.146 T:545388433632 DEBUG: weather.yahoo: available locations: 0
21:55:28.146 T:545388433632 DEBUG: weather.yahoo: finished
21:55:28.146 T:545388433632 INFO: CPythonInvoker(7, /storage/.kodi/addons/weather.yahoo/default.py): script successfully run
21:55:28.177 T:545371656416 DEBUG: Thread Timer 545371656416 terminating
21:55:28.287 T:545388433632 INFO: Python script stopped
21:55:28.287 T:545388433632 DEBUG: Thread LanguageInvoker 545388433632 terminating
21:55:28.328 T:547532828896 DEBUG: POParser: loaded 130 weather tokens
21:55:28.394 T:546331144416 INFO: ## LibreELEC Addon ## system::set_hostname ## LibreELEC
21:55:28.399 T:546331144416 INFO: ## LibreELEC Addon ## system::set_keyboard_layout ## us
21:55:28.399 T:546331144416 INFO: ## LibreELEC Addon ## system::set_keyboard_layout ## loadkmap < `ls -1 /usr/lib/keymaps/*/us.bmap`
21:55:28.504 T:546331144416 INFO: ## LibreELEC Addon ## system::updateThread ## Started
21:55:28.505 T:546331144416 INFO: ## LibreELEC Addon ## system::set_auto_update ## manual
21:55:28.577 T:545371656416 INFO: ## LibreELEC Addon ## _service_::run ## WAITING:
21:55:28.616 T:546705985760 INFO: ## LibreELEC Addon ## xdbus Monitor started. ##
21:55:28.793 T:547151552736 DEBUG: script.grab.fanart: found 595 movies files
21:55:28.917 T:547620995072 DEBUG: LIRC: Update - NEW at 9349:6a 0 KEY_RIGHT devinput (KEY_RIGHT)
21:55:28.917 T:547620995072 DEBUG: OnKey: 168 (0xa8, obc87) pressed, action is Right
21:55:28.977 T:546677670112 DEBUG: Library Data Provider: script version 0.3.0 stopped
21:55:28.977 T:546677670112 INFO: CPythonInvoker(3, /storage/.kodi/addons/service.library.data.provider/plugin.py): script successfully run
21:55:29.014 T:547151552736 DEBUG: RunQuery took 178 ms for 68 items query: SELECT * FROM tvshow_view
21:55:29.081 T:546677670112 INFO: Python script stopped
21:55:29.081 T:546677670112 DEBUG: Thread LanguageInvoker 546677670112 terminating
21:55:29.127 T:546722762976 DEBUG: GetSongsFullByWhere query = SELECT sv.*, songartistview.* FROM (SELECT songview.* FROM songview WHERE ((CAST(songview.iTimesPlayed as DECIMAL(5,1)) < 1)) ORDER BY RAND() LIMIT 20) AS sv JOIN songartistview ON songartistview.idsong = sv.idsong ORDER BY songartistview.idsong, songartistview.idRole, songartistview.iOrder
21:55:29.191 T:546722762976 DEBUG: GetSongsFullByWhere() - took 92 ms
21:55:29.262 T:547151552736 DEBUG: script.grab.fanart: found 67 tv files
21:55:29.293 T:547151552736 DEBUG: GetArtistsByWhere query: SELECT artistview.* FROM artistview WHERE ((EXISTS (SELECT 1 FROM song_artist WHERE song_artist.idArtist = artistview.idArtist AND song_artist.idRole = 1) OR EXISTS (SELECT 1 FROM album_artist WHERE album_artist.idArtist = artistview.idArtist)) AND (artistview.strArtist != '')) AND (artistview.strArtist <> 'Various artists')
21:55:29.333 T:547151552736 DEBUG: Time to retrieve artists from dataset = 39
21:55:29.629 T:546722762976 DEBUG: GetAlbumsByWhere query: SELECT albumview.*, albumartistview.* FROM albumview JOIN albumartistview ON albumartistview.idalbum = albumview.idalbum WHERE albumview.strReleaseType = 'album'
21:55:29.650 T:546722762976 DEBUG: GetAlbumsByWhere - query took 21 ms
21:55:29.689 T:547620995072 DEBUG: LIRC: Update - NEW at 10121:6a 0 KEY_RIGHT devinput (KEY_RIGHT)
21:55:29.689 T:547620995072 DEBUG: OnKey: 168 (0xa8, obc87) pressed, action is Right
21:55:29.916 T:546722762976 DEBUG: RunQuery took 3 ms for 0 items query: select * from musicvideo_view WHERE ((musicvideo_view.playCount IS NULL OR musicvideo_view.playCount < 1))
21:55:30.071 T:546722762976 DEBUG: RunQuery took 137 ms for 592 items query: select * from movie_view WHERE ((movie_view.playCount IS NULL OR movie_view.playCount < 1))
21:55:30.361 T:547151552736 DEBUG: script.grab.fanart: found 0 music files
21:55:30.372 T:547620995072 DEBUG: LIRC: Update - NEW at 10803:6a 0 KEY_RIGHT devinput (KEY_RIGHT)
21:55:30.372 T:547620995072 DEBUG: OnKey: 168 (0xa8, obc87) pressed, action is Right
21:55:30.890 T:547620995072 DEBUG: LIRC: Update - NEW at 11321:6a 0 KEY_RIGHT devinput (KEY_RIGHT)
21:55:30.890 T:547620995072 DEBUG: OnKey: 168 (0xa8, obc87) pressed, action is Right
21:55:31.277 T:546722762976 DEBUG: RunQuery took 725 ms for 8250 items query: select * from episode_view WHERE ((episode_view.playCount IS NULL OR episode_view.playCount < 1))
21:55:31.614 T:547620995072 DEBUG: LIRC: Update - NEW at 12046:6a 0 KEY_RIGHT devinput (KEY_RIGHT)
21:55:31.614 T:547620995072 DEBUG: OnKey: 168 (0xa8, obc87) pressed, action is Right
21:55:32.223 T:547620995072 DEBUG: LIRC: Update - NEW at 12655:6a 0 KEY_RIGHT devinput (KEY_RIGHT)
21:55:32.224 T:547620995072 DEBUG: OnKey: 168 (0xa8, obc87) pressed, action is Right
21:55:32.429 T:546722762976 DEBUG: GetAlbumsByWhere query: SELECT albumview.*, albumartistview.* FROM albumview JOIN albumartistview ON albumartistview.idalbum = albumview.idalbum WHERE albumview.strReleaseType = 'album'
21:55:32.469 T:546722762976 DEBUG: GetAlbumsByWhere - query took 40 ms
21:55:32.689 T:546722762976 DEBUG: RunQuery took 10 ms for 0 items query: select * from musicvideo_view WHERE ((musicvideo_view.playCount IS NULL OR musicvideo_view.playCount < 1))
21:55:32.791 T:546722762976 DEBUG: RunQuery took 71 ms for 2 items query: select * from movie_view WHERE (movie_view.idFile IN (SELECT DISTINCT idFile FROM bookmark WHERE type = 1))
21:55:32.904 T:547620995072 DEBUG: LIRC: Update - NEW at 13335:6a 0 KEY_RIGHT devinput (KEY_RIGHT)
21:55:32.904 T:547620995072 DEBUG: OnKey: 168 (0xa8, obc87) pressed, action is Right
21:55:33.352 T:546722762976 DEBUG: RunQuery took 465 ms for 6 items query: SELECT * FROM tvshow_view WHERE ((CASE WHEN COALESCE(tvshow_view.totalCount - tvshow_view.watchedcount, 0) > 0 THEN 0 ELSE 1 END < 1)) AND ( ((tvshow_view.watchedcount > 0 AND tvshow_view.watchedcount < tvshow_view.totalCount) OR (tvshow_view.watchedcount = 0 AND EXISTS (SELECT 1 FROM episode_view WHERE episode_view.idShow = tvshow_view.idShow AND episode_view.resumeTimeInSeconds > 0))))
21:55:33.587 T:547620995072 DEBUG: LIRC: Update - NEW at 14018:6a 0 KEY_RIGHT devinput (KEY_RIGHT)
21:55:33.587 T:547620995072 DEBUG: OnKey: 168 (0xa8, obc87) pressed, action is Right
21:55:33.678 T:546722762976 DEBUG: RunQuery took 288 ms for 151 items query: select * from episode_view WHERE (episode_view.idShow = 15) AND (((episode_view.playCount IS NULL OR episode_view.playCount < 1)))
21:55:33.678 T:546722762976 DEBUG: DatabaseUtils::GetSortFieldList: unknown field 30
21:55:34.019 T:546722762976 DEBUG: RunQuery took 297 ms for 82 items query: select * from episode_view WHERE (episode_view.idShow = 43) AND (((episode_view.playCount IS NULL OR episode_view.playCount < 1)))
21:55:34.019 T:546722762976 DEBUG: DatabaseUtils::GetSortFieldList: unknown field 30
21:55:34.229 T:547620995072 DEBUG: LIRC: Update - NEW at 14661:6a 0 KEY_RIGHT devinput (KEY_RIGHT)
21:55:34.229 T:547620995072 DEBUG: OnKey: 168 (0xa8, obc87) pressed, action is Right
21:55:34.233 T:547620995072 DEBUG: CDirectoryProvider[addons://sources/audio/]: refreshing..
21:55:34.451 T:546722762976 DEBUG: RunQuery took 364 ms for 6 items query: select * from episode_view WHERE (episode_view.idShow = 42) AND (((episode_view.playCount IS NULL OR episode_view.playCount < 1)))
21:55:34.451 T:546722762976 DEBUG: DatabaseUtils::GetSortFieldList: unknown field 30
21:55:34.781 T:546722762976 DEBUG: RunQuery took 296 ms for 3 items query: select * from episode_view WHERE (episode_view.idShow = 46) AND (((episode_view.playCount IS NULL OR episode_view.playCount < 1)))
21:55:34.781 T:546722762976 DEBUG: DatabaseUtils::GetSortFieldList: unknown field 30
21:55:35.071 T:546722762976 DEBUG: RunQuery took 258 ms for 308 items query: select * from episode_view WHERE (episode_view.idShow = 17) AND (((episode_view.playCount IS NULL OR episode_view.playCount < 1)))
21:55:35.072 T:546722762976 DEBUG: DatabaseUtils::GetSortFieldList: unknown field 30
21:55:35.507 T:546722762976 DEBUG: RunQuery took 383 ms for 32 items query: select * from episode_view WHERE (episode_view.idShow = 54) AND (((episode_view.playCount IS NULL OR episode_view.playCount < 1)))
21:55:35.507 T:546722762976 DEBUG: DatabaseUtils::GetSortFieldList: unknown field 30
21:55:35.580 T:546722762976 DEBUG: GetAlbumsByWhere query: SELECT albumview.*, albumartistview.* FROM albumview JOIN albumartistview ON albumartistview.idalbum = albumview.idalbum WHERE albumview.strReleaseType = 'album'
21:55:35.595 T:546722762976 DEBUG: GetAlbumsByWhere - query took 15 ms
21:55:35.760 T:546722762976 DEBUG: CFavourites::Load - no system favourites found, skipping
21:55:35.900 T:546722762976 DEBUG: RunQuery took 124 ms for 66 items query: SELECT * FROM tvshow_view WHERE ((CASE WHEN COALESCE(tvshow_view.totalCount - tvshow_view.watchedcount, 0) > 0 THEN 0 ELSE 1 END < 1))
21:55:36.057 T:546722762976 DEBUG: Library Data Provider: Total time needed for all queries: 0:00:09.807867
21:55:36.302 T:547620995072 DEBUG: LIRC: Update - NEW at 16734:160 0 KEY_OK devinput (KEY_OK)
21:55:36.302 T:547620995072 DEBUG: OnKey: 11 (0x0b, obc244) pressed, action is Select
21:55:36.303 T:547620995072 DEBUG: Activating window ID: 10502
21:55:36.850 T:547620995072 DEBUG: ------ Window Deinit (Home.xml) ------
21:55:36.898 T:547620995072 DEBUG: ------ Window Init (MyMusicNav.xml) ------
21:55:36.898 T:547620995072 INFO: Loading skin file: MyMusicNav.xml, load type: KEEP_IN_MEMORY
21:55:36.907 T:547620995072 ERROR: Window Translator: Can't find window games
21:55:37.272 T:547620995072 DEBUG: CGUIMediaWindow::GetDirectory ()
21:55:37.272 T:547620995072 DEBUG: ParentPath = []
21:55:37.287 T:547620995072 DEBUG: RetrieveMusicInfo() took 0 msec
21:55:37.331 T:546677670112 DEBUG: Thread BackgroundLoader start, auto delete: false
21:55:37.373 T:546677670112 DEBUG: Thread BackgroundLoader 546677670112 terminating
21:55:37.440 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:55:37.486 T:547532828896 DEBUG: DoWork - took 124 ms to load special://skin/backgrounds/default_bg.jpg
21:55:39.851 T:547620995072 DEBUG: LIRC: Update - NEW at 20282:6c 0 KEY_DOWN devinput (KEY_DOWN)
21:55:39.851 T:547620995072 DEBUG: OnKey: 167 (0xa7, obc88) pressed, action is Down
21:55:40.266 T:547620995072 DEBUG: LIRC: Update - NEW at 20698:6c 0 KEY_DOWN devinput (KEY_DOWN)
21:55:40.266 T:547620995072 DEBUG: OnKey: 167 (0xa7, obc88) pressed, action is Down
21:55:40.724 T:547620995072 DEBUG: LIRC: Update - NEW at 21155:6c 0 KEY_DOWN devinput (KEY_DOWN)
21:55:40.724 T:547620995072 DEBUG: OnKey: 167 (0xa7, obc88) pressed, action is Down
21:55:41.058 T:547620995072 DEBUG: LIRC: Update - NEW at 21489:6c 0 KEY_DOWN devinput (KEY_DOWN)
21:55:41.058 T:547620995072 DEBUG: OnKey: 167 (0xa7, obc88) pressed, action is Down
21:55:41.855 T:547620995072 DEBUG: LIRC: Update - NEW at 22286:160 0 KEY_OK devinput (KEY_OK)
21:55:41.855 T:547620995072 DEBUG: OnKey: 11 (0x0b, obc244) pressed, action is Select
21:55:41.856 T:547620995072 DEBUG: CGUIMediaWindow::GetDirectory (library://music/songs.xml/)
21:55:41.856 T:547620995072 DEBUG: ParentPath = []
21:55:41.904 T:546686058720 DEBUG: GetSongsFullByWhere query = SELECT songview.*, songartistview.* FROM songview JOIN songartistview ON songartistview.idsong = songview.idsong ORDER BY songartistview.idsong, songartistview.idRole, songartistview.iOrder
21:55:41.982 T:546686058720 DEBUG: GetSongsFullByWhere() - took 95 ms
21:55:41.996 T:547620995072 DEBUG: Custom album format = [%B]
21:55:42.052 T:546677670112 DEBUG: Previous line repeats 1 times.
21:55:42.052 T:546677670112 DEBUG: Thread BackgroundLoader start, auto delete: false
21:55:42.148 T:546677670112 DEBUG: This query part contains a like, we will double backslash in the next field: select idArtist from artist where artist.strArtist like '
21:55:43.129 T:547620995072 DEBUG: Previous line repeats 32 times.
21:55:43.129 T:547620995072 DEBUG: LIRC: Update - NEW at 23561:67 0 KEY_UP devinput (KEY_UP)
21:55:43.129 T:547620995072 DEBUG: OnKey: 166 (0xa6, obc89) pressed, action is Up
21:55:43.161 T:546677670112 DEBUG: This query part contains a like, we will double backslash in the next field: select idArtist from artist where artist.strArtist like '
21:55:44.393 T:546677670112 DEBUG: Previous line repeats 41 times.
21:55:44.393 T:546677670112 DEBUG: Thread BackgroundLoader 546677670112 terminating
21:55:44.982 T:547620995072 DEBUG: LIRC: Update - NEW at 25414:67 0 KEY_UP devinput (KEY_UP)
21:55:44.982 T:547620995072 DEBUG: OnKey: 166 (0xa6, obc89) pressed, action is Up
21:55:45.542 T:547620995072 DEBUG: LIRC: Update - NEW at 25974:67 0 KEY_UP devinput (KEY_UP)
21:55:45.542 T:547620995072 DEBUG: OnKey: 166 (0xa6, obc89) pressed, action is Up
21:55:46.225 T:547620995072 DEBUG: LIRC: Update - NEW at 26657:67 0 KEY_UP devinput (KEY_UP)
21:55:46.225 T:547620995072 DEBUG: OnKey: 166 (0xa6, obc89) pressed, action is Up
21:55:46.250 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:55:46.676 T:547620995072 DEBUG: LIRC: Update - NEW at 27107:67 0 KEY_UP devinput (KEY_UP)
21:55:46.676 T:547620995072 DEBUG: OnKey: 166 (0xa6, obc89) pressed, action is Up
21:55:46.710 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:55:47.327 T:547620995072 DEBUG: LIRC: Update - NEW at 27759:67 0 KEY_UP devinput (KEY_UP)
21:55:47.327 T:547620995072 DEBUG: OnKey: 166 (0xa6, obc89) pressed, action is Up
21:55:47.348 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:55:47.885 T:547620995072 DEBUG: LIRC: Update - NEW at 28316:67 0 KEY_UP devinput (KEY_UP)
21:55:47.885 T:547620995072 DEBUG: OnKey: 166 (0xa6, obc89) pressed, action is Up
21:55:47.905 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:55:49.104 T:547620995072 DEBUG: LIRC: Update - NEW at 29536:67 0 KEY_UP devinput (KEY_UP)
21:55:49.104 T:547620995072 DEBUG: OnKey: 166 (0xa6, obc89) pressed, action is Up
21:55:49.115 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:55:52.039 T:547620995072 DEBUG: LIRC: Update - NEW at 32471:67 0 KEY_UP devinput (KEY_UP)
21:55:52.039 T:547620995072 DEBUG: OnKey: 166 (0xa6, obc89) pressed, action is Up
21:55:52.056 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:55:52.995 T:547620995072 DEBUG: LIRC: Update - NEW at 33426:67 0 KEY_UP devinput (KEY_UP)
21:55:52.995 T:547620995072 DEBUG: OnKey: 166 (0xa6, obc89) pressed, action is Up
21:55:53.011 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:55:54.111 T:547620995072 DEBUG: LIRC: Update - NEW at 34543:6c 0 KEY_DOWN devinput (KEY_DOWN)
21:55:54.111 T:547620995072 DEBUG: OnKey: 167 (0xa7, obc88) pressed, action is Down
21:55:54.701 T:547620995072 DEBUG: LIRC: Update - NEW at 35133:160 0 KEY_OK devinput (KEY_OK)
21:55:54.701 T:547620995072 DEBUG: OnKey: 11 (0x0b, obc244) pressed, action is Select
21:55:54.702 T:547620995072 DEBUG: This query part contains a like, we will double backslash in the next field: select idArtist from artist where artist.strArtist like '
21:55:54.729 T:547620995072 DEBUG: SELECT albumview.*,albumartistview.* FROM albumview JOIN albumartistview ON albumview.idAlbum = albumartistview.idAlbum WHERE albumview.idAlbum = 119 ORDER BY albumartistview.iOrder
21:55:54.769 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.769 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.769 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.769 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.769 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.769 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.770 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.770 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.770 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.770 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.770 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.770 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.770 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.770 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.770 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.770 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.770 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.770 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.770 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.770 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.771 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.771 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.771 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.771 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.771 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.771 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.771 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.771 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.771 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.771 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.771 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.771 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.771 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.771 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.772 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.772 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.772 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.772 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.772 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.772 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.772 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.772 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.772 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.772 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.772 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.772 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.772 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.772 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.773 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.773 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.773 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.773 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.773 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.773 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.773 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.773 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.773 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.773 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.773 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.773 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.773 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.773 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.774 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.774 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.774 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.774 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.774 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.774 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.774 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.774 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.774 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.774 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.774 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.774 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.774 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.774 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.775 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.775 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.775 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.775 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.775 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.775 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.775 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.775 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.775 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.775 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.775 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.775 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.775 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.775 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.776 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.776 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.776 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.776 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.776 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.776 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.776 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.776 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.776 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.776 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.776 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.776 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.776 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.776 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.777 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.777 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.777 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.777 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.777 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.777 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.777 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.777 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.777 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.777 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.777 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.777 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.777 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.777 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.778 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.778 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.778 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.778 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.778 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.778 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.778 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.778 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.778 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.778 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.778 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.778 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.779 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.779 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.779 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.779 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.779 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.779 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.779 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.779 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.779 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.779 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.779 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.779 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.779 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.779 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.780 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.780 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.780 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.780 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.780 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.780 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.780 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.780 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.780 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.780 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.780 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.780 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.780 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.780 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.781 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.781 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.781 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.781 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.781 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.781 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.781 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.781 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.781 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.781 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.781 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.781 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.781 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.781 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.782 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.782 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.782 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.782 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.782 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.782 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.782 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.782 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.782 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.782 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.782 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.782 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.782 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.782 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.783 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.783 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.783 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.783 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.783 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.783 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.783 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.783 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.783 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.783 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.783 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.783 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.784 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.784 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.784 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.784 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.784 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.784 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.784 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.784 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.784 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.784 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.784 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.784 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.784 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.784 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.785 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.785 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.785 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.785 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.785 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.785 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.785 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.785 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.785 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.785 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.785 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.785 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.785 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.785 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.786 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.786 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.786 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.786 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.786 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.786 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.786 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.786 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.786 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.786 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.786 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.786 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.786 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.786 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.787 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.787 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.787 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.787 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.787 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.787 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.787 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.787 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.787 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.787 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.787 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.787 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.787 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.787 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.788 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.788 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.788 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.788 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.788 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.788 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.788 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.788 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.788 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.788 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.788 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.789 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.789 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.789 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.789 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.789 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.789 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.789 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.789 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.789 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.789 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.789 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.789 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.789 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.789 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.790 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.790 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.790 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.790 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.790 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.790 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.790 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.790 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.790 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.790 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.790 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.790 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.790 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.791 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.791 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.791 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.791 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.791 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.791 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.791 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.791 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.791 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.791 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.791 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.791 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.791 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.791 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.792 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.792 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.792 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.792 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.792 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.792 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.792 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.792 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.792 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.792 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.792 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.792 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.792 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.792 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.793 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.793 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.793 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.793 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.793 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.793 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.793 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.793 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.793 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.793 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.793 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.793 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.793 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.793 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.794 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.794 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.794 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.794 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.794 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.794 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.794 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.794 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.794 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.794 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.794 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.794 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.794 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.794 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.795 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.795 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.795 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.795 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.795 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.795 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.795 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.795 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.795 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.795 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.795 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.795 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.795 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.795 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.796 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.796 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.796 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.796 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.796 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.796 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.796 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.796 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.796 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.796 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.796 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.796 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.797 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.797 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.797 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.797 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.797 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.797 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.797 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.797 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.797 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.797 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.797 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.797 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.797 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.797 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.798 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.798 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.798 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.798 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.798 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.798 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.798 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.798 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.798 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.798 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.798 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.798 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.798 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.799 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.799 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.799 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.799 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.799 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.799 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.799 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.799 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.799 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.799 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.799 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.799 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.799 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.799 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.800 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.800 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.800 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.800 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.800 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.800 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.800 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.800 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.800 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.800 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.800 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.800 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.800 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.801 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.801 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.801 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.801 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.801 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.801 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.801 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.801 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.801 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.801 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.808 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.808 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.809 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.809 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.809 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.809 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.809 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.809 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.810 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.810 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.810 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.810 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.810 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.810 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.811 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.811 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.811 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.811 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.811 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.812 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.812 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.812 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.812 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.812 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.812 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.813 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.813 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.813 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.813 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.813 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.813 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.814 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.814 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.814 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.814 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.814 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.814 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.815 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.815 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.815 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.815 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.815 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.816 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.816 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.816 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.816 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.816 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.816 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.816 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.816 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.817 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.817 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.817 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.817 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.817 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.817 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.817 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.818 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.818 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.818 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.818 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.818 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.818 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.818 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.818 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.818 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.819 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.819 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.819 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.819 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.819 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.819 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.819 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.819 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.819 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.820 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.820 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.820 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.820 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.820 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.820 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.820 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.821 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.821 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.821 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.821 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.821 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.821 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.821 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.822 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.822 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.822 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.822 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.822 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.822 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.822 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.823 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.823 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.823 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.823 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.823 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.823 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.823 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.824 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.824 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.824 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.824 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.824 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.824 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.824 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.825 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.825 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.825 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.825 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.825 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.825 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.825 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.826 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.826 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.826 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.826 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.826 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.826 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.826 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.827 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.827 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.827 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.827 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.827 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnAdd from xbmc
21:55:54.827 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 2, from xbmc, message OnAdd
21:55:54.842 T:547620995072 DEBUG: Loading settings for musicdb://songs/166.m4a
21:55:54.843 T:547620995072 DEBUG: CPlayerCoreFactory::GetPlayers(musicdb://songs/166.m4a)
21:55:54.843 T:547620995072 DEBUG: CPlayerSelectionRule::GetPlayers: considering rule: system rules
21:55:54.843 T:547620995072 DEBUG: CPlayerSelectionRule::GetPlayers: matches rule: system rules
21:55:54.843 T:547620995072 DEBUG: CPlayerSelectionRule::GetPlayers: considering rule: mms/udp
21:55:54.843 T:547620995072 DEBUG: CPlayerSelectionRule::GetPlayers: considering rule: lastfm/shout
21:55:54.843 T:547620995072 DEBUG: CPlayerSelectionRule::GetPlayers: considering rule: rtmp
21:55:54.843 T:547620995072 DEBUG: CPlayerSelectionRule::GetPlayers: considering rule: rtsp
21:55:54.843 T:547620995072 DEBUG: CPlayerSelectionRule::GetPlayers: considering rule: streams
21:55:54.843 T:547620995072 DEBUG: CPlayerSelectionRule::GetPlayers: considering rule: dvd
21:55:54.843 T:547620995072 DEBUG: CPlayerSelectionRule::GetPlayers: considering rule: dvdimage
21:55:54.843 T:547620995072 DEBUG: CPlayerSelectionRule::GetPlayers: considering rule: sdp/asf
21:55:54.843 T:547620995072 DEBUG: CPlayerSelectionRule::GetPlayers: considering rule: nsv
21:55:54.843 T:547620995072 DEBUG: CPlayerSelectionRule::GetPlayers: considering rule: radio
21:55:54.843 T:547620995072 DEBUG: CPlayerCoreFactory::GetPlayers: matched 0 rules with players
21:55:54.843 T:547620995072 DEBUG: CPlayerCoreFactory::GetPlayers: adding audiodefaultplayer (PAPlayer)
21:55:54.843 T:547620995072 DEBUG: CPlayerCoreFactory::GetPlayers: for video=0, audio=1
21:55:54.843 T:547620995072 DEBUG: CPlayerCoreFactory::GetPlayers: for video=1, audio=1
21:55:54.843 T:547620995072 DEBUG: CPlayerCoreFactory::GetPlayers: adding player: VideoPlayer
21:55:54.843 T:547620995072 DEBUG: CPlayerCoreFactory::GetPlayers: added 2 players
21:55:54.900 T:547620995072 DEBUG: CFileCache::Open - opening using cache
21:55:54.901 T:547620995072 DEBUG: CurlFile::Open(0x39850b0) ftp://192.168.1.5:21/!!Music/The%20Beatles%20-%20Yesterday.m4a
21:55:54.901 T:547620995072 INFO: easy_aquire - Created session to ftp://192.168.1.5
21:55:55.129 T:546677670112 DEBUG: Thread FileCache start, auto delete: false
21:55:55.130 T:547620995072 DEBUG: Open - probing detected format [mov,mp4,m4a,3gp,3g2,mj2]
21:55:55.353 T:546677670112 DEBUG: CurlFile::CReadState::Connect - Resume from position 598583
21:55:55.387 T:547620995072 DEBUG: ffmpeg[7F80C14000]: [mov,mp4,m4a,3gp,3g2,mj2] stream 0, timescale not set
21:55:55.388 T:547620995072 DEBUG: Open - avformat_find_stream_info starting
21:55:55.396 T:547620995072 DEBUG: Open - av_find_stream_info finished
21:55:55.397 T:547620995072 DEBUG: CDVDDemuxFFmpeg::AddStream ID: 0
21:55:55.397 T:547620995072 DEBUG: CDVDDemuxFFmpeg::AddStream ID: 1
21:55:55.397 T:547620995072 DEBUG: FactoryCodec - Audio: passthrough - Opening
21:55:55.397 T:547620995072 DEBUG: FactoryCodec - Audio: passthrough - Failed
21:55:55.398 T:547620995072 DEBUG: FactoryCodec - Audio: FFmpeg - Opening
21:55:55.400 T:547620995072 DEBUG: FactoryCodec - Audio: FFmpeg - Opened
21:55:55.468 T:547620995072 DEBUG: CFileCache::Open - opening using cache
21:55:55.468 T:547620995072 DEBUG: CurlFile::Open(0x3a7f580) ftp://192.168.1.5:21/!!Music/The%20Beatles%20-%20Yesterday.m4a
21:55:55.469 T:547620995072 INFO: easy_aquire - Created session to ftp://192.168.1.5
21:55:55.505 T:546677670112 INFO: CFileCache::Process - Source read didn't return any data! Hit eof(?)
21:55:55.513 T:545380045024 DEBUG: Thread FileCache start, auto delete: false
21:55:55.513 T:545380045024 DEBUG: CurlFile::CReadState::Connect - Resume from position 4702991
21:55:55.526 T:547620995072 DEBUG: Seek - waiting for position 4768527.
21:55:55.543 T:545380045024 DEBUG: CurlFile::CReadState::Connect - Resume from position 598583
21:55:55.554 T:545380045024 DEBUG: CurlFile::CReadState::Connect - Resume from position 4702991
21:55:55.566 T:547620995072 DEBUG: Seek - waiting for position 4768527.
21:55:55.569 T:545380045024 DEBUG: CurlFile::CReadState::Connect - Resume from position 55998
21:55:55.586 T:545380045024 DEBUG: CurlFile::CReadState::Connect - Resume from position 288
21:55:55.606 T:545380045024 DEBUG: CurlFile::CReadState::Connect - Resume from position 256
21:55:55.632 T:547620995072 DEBUG: SeekTime - unknown position after seek
21:55:55.633 T:545380045024 DEBUG: Previous line repeats 1 times.
21:55:55.633 T:545380045024 DEBUG: Thread FileCache 545380045024 terminating
21:55:55.727 T:547620995072 INFO: AudioDecoder: File is queued
21:55:55.729 T:547524440288 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted
21:55:55.729 T:547620995072 DEBUG: AudioDecoder::GetReplayGain - Final Replaygain applied: 1.000000, Track/Album Gain 89.000000, Peak 1.000000
21:55:55.738 T:547620995072 INFO: PAPlayer::PrepareStream - Ready
21:55:55.738 T:547620995072 DEBUG: PlayFile: OpenFile succeed, play state 1
21:55:55.738 T:545380045024 DEBUG: Thread PAPlayer start, auto delete: false
21:55:55.738 T:545380045024 DEBUG: PAPlayer::Process - Playback started
21:55:55.738 T:545380045024 DEBUG: OnPlayBackStarted: play state was 1, starting 0
21:55:55.773 T:547532828896 DEBUG: CGUIInfoManager::SetCurrentSong(musicdb://songs/166.m4a)
21:55:55.777 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnPlay from xbmc
21:55:55.777 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 1, from xbmc, message OnPlay
21:55:55.824 T:547532828896 DEBUG: This query part contains a like, we will double backslash in the next field: select idArtist from artist where artist.strArtist like '
21:55:55.844 T:547532828896 DEBUG: Loading additional tag info for file ftp://192.168.1.5:21/!!Music/The Beatles - Yesterday.m4a
21:55:55.847 T:547532828896 DEBUG: CFileCache::Open - opening using cache
21:55:55.847 T:547532828896 DEBUG: CurlFile::Open(0x7f68319a30) ftp://192.168.1.5:21/!!Music/The%20Beatles%20-%20Yesterday.m4a
21:55:55.860 T:545804775648 DEBUG: Thread FileCache start, auto delete: false
21:55:55.860 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 4702991
21:55:55.872 T:547532828896 DEBUG: Seek - waiting for position 4768527.
21:55:55.891 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 598583
21:55:55.903 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 4702991
21:55:55.917 T:547532828896 DEBUG: Seek - waiting for position 4768527.
21:55:55.920 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 55998
21:55:55.934 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 288
21:55:55.949 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 256
21:55:55.969 T:545804775648 DEBUG: Thread FileCache 545804775648 terminating
21:55:56.783 T:545829941472 DEBUG: JSONRPC Server: New connection detected
21:55:56.783 T:545829941472 INFO: JSONRPC Server: New connection added
21:55:56.793 T:545829941472 DEBUG: JSONRPC Server: New connection detected
21:55:56.793 T:545829941472 INFO: JSONRPC Server: New connection added
21:55:57.177 T:545829941472 DEBUG: JSONRPC Server: New connection detected
21:55:57.177 T:545829941472 INFO: JSONRPC Server: New connection added
21:56:16.487 T:547620995072 DEBUG: LIRC: Update - NEW at 56919:ae 0 KEY_EXIT devinput (KEY_EXIT)
21:56:16.487 T:547620995072 DEBUG: OnKey: menu (0xd8) pressed, action is Back
21:56:16.502 T:547620995072 DEBUG: CGUIMediaWindow::GetDirectory ()
21:56:16.503 T:547620995072 DEBUG: ParentPath = []
21:56:16.522 T:547620995072 DEBUG: RetrieveMusicInfo() took 0 msec
21:56:16.562 T:545804775648 DEBUG: Thread BackgroundLoader start, auto delete: false
21:56:16.601 T:545804775648 DEBUG: Thread BackgroundLoader 545804775648 terminating
21:56:16.820 T:545829941472 DEBUG: JSONRPC Server: New connection detected
21:56:16.820 T:545829941472 INFO: JSONRPC Server: New connection added
21:56:17.607 T:547620995072 DEBUG: LIRC: Update - NEW at 58039:ae 0 KEY_EXIT devinput (KEY_EXIT)
21:56:17.607 T:547620995072 DEBUG: OnKey: menu (0xd8) pressed, action is Back
21:56:17.609 T:547620995072 DEBUG: CGUIWindowManager::PreviousWindow: Deactivate
21:56:18.166 T:547620995072 DEBUG: ------ Window Deinit (MyMusicNav.xml) ------
21:56:18.168 T:547620995072 DEBUG: CGUIWindowManager::PreviousWindow: Activate new
21:56:18.169 T:547620995072 DEBUG: ------ Window Init (Home.xml) ------
21:56:18.169 T:547620995072 DEBUG: CSettingsManager: requested setting (gamesgeneral.enable) was not found.
21:56:18.169 T:547620995072 DEBUG: CDirectoryProvider[plugin://service.library.data.provider?type=randommovies&reload=20180223025526]: refreshing..
21:56:18.171 T:546694447328 DEBUG: StartScript - calling plugin Library Data Provider('plugin://service.library.data.provider/','2','?type=randommovies&reload=20180223025526')
21:56:18.171 T:545804775648 DEBUG: Thread LanguageInvoker start, auto delete: false
21:56:18.172 T:545804775648 INFO: initializing python engine.
21:56:18.172 T:545804775648 DEBUG: CPythonInvoker(8, /storage/.kodi/addons/service.library.data.provider/plugin.py): start processing
21:56:18.176 T:545574551776 DEBUG: Thread LanguageInvoker start, auto delete: false
21:56:18.176 T:546686058720 DEBUG: CRecentlyAddedJob::UpdateMusic() - Running RecentlyAdded home screen update
21:56:18.176 T:545574551776 INFO: initializing python engine.
21:56:18.176 T:545574551776 DEBUG: CPythonInvoker(9, /storage/.kodi/addons/script.skinshortcuts/default.py): start processing
21:56:18.190 T:545363267808 DEBUG: Thread JobWorker start, auto delete: true
21:56:18.206 T:545804775648 DEBUG: -->Python Interpreter Initialized<--
21:56:18.206 T:545804775648 DEBUG: CPythonInvoker(8, /storage/.kodi/addons/service.library.data.provider/plugin.py): the source file to load is "/storage/.kodi/addons/service.library.data.provider/plugin.py"
21:56:18.206 T:545804775648 DEBUG: CPythonInvoker(8, /storage/.kodi/addons/service.library.data.provider/plugin.py): setting the Python path to /storage/.kodi/addons/service.library.data.provider:/storage/.kodi/addons/script.module.routing/lib:/storage/.kodi/addons/script.module.simplejson/lib:/usr/lib/python27.zip:/usr/lib/python2.7:/usr/lib/python2.7/plat-linux2:/usr/lib/python2.7/lib-tk:/usr/lib/python2.7/lib-old:/usr/lib/python2.7/lib-dynload:/usr/lib/python2.7/site-packages:/usr/lib/python2.7/site-packages/gtk-2.0
21:56:18.206 T:545804775648 DEBUG: CPythonInvoker(8, /storage/.kodi/addons/service.library.data.provider/plugin.py): entering source directory /storage/.kodi/addons/service.library.data.provider
21:56:18.231 T:545804775648 DEBUG: CPythonInvoker(8, /storage/.kodi/addons/service.library.data.provider/plugin.py): instantiating addon using automatically obtained id of "service.library.data.provider" dependent on version 2.25.0 of the xbmc.python api
21:56:18.243 T:545363267808 ERROR: CCurlFile::Stat - Failed: FTP: couldn't retrieve (RETR failed) the specified file(19) for ftp://192.168.1.5:21/!!Music/cdart.png
21:56:18.243 T:545363267808 DEBUG: GetImageHash - unable to stat url ftp://192.168.1.5:21/!!Music/cdart.png
21:56:18.255 T:546686058720 DEBUG: GetRecentlyAddedAlbumSongs() query: SELECT songview.*, songartistview.* FROM (SELECT idAlbum FROM album ORDER BY idAlbum DESC LIMIT 10) AS recentalbums JOIN songview ON songview.idAlbum = recentalbums.idAlbum JOIN songartistview ON songview.idSong = songartistview.idSong ORDER BY songview.idAlbum DESC, songview.idSong, songartistview.idRole, songartistview.iOrder
21:56:18.265 T:545574551776 DEBUG: -->Python Interpreter Initialized<--
21:56:18.266 T:545574551776 DEBUG: CPythonInvoker(9, /storage/.kodi/addons/script.skinshortcuts/default.py): the source file to load is "/storage/.kodi/addons/script.skinshortcuts/default.py"
21:56:18.330 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:56:18.335 T:545574551776 DEBUG: CPythonInvoker(9, /storage/.kodi/addons/script.skinshortcuts/default.py): setting the Python path to /storage/.kodi/addons/script.skinshortcuts:/storage/.kodi/addons/script.module.simplejson/lib:/storage/.kodi/addons/script.module.unidecode/lib:/usr/lib/python27.zip:/usr/lib/python2.7:/usr/lib/python2.7/plat-linux2:/usr/lib/python2.7/lib-tk:/usr/lib/python2.7/lib-old:/usr/lib/python2.7/lib-dynload:/usr/lib/python2.7/site-packages:/usr/lib/python2.7/site-packages/gtk-2.0
21:56:18.335 T:545574551776 DEBUG: CPythonInvoker(9, /storage/.kodi/addons/script.skinshortcuts/default.py): entering source directory /storage/.kodi/addons/script.skinshortcuts
21:56:18.336 T:545804775648 DEBUG: Library Data Provider: script version 0.3.0 started
21:56:18.336 T:545574551776 DEBUG: CPythonInvoker(9, /storage/.kodi/addons/script.skinshortcuts/default.py): instantiating addon using automatically obtained id of "script.skinshortcuts" dependent on version 2.20.0 of the xbmc.python api
21:56:18.344 T:546686058720 DEBUG: This query part contains a like, we will double backslash in the next field: select idArtist from artist where artist.strArtist like '
21:56:18.362 T:546686058720 DEBUG: GetRecentlyAddedAlbums query: SELECT albumview.*, albumartistview.* FROM (SELECT idAlbum FROM album WHERE strAlbum != '' ORDER BY idAlbum DESC LIMIT 10) AS recentalbums JOIN albumview ON albumview.idAlbum = recentalbums.idAlbum JOIN albumartistview ON albumview.idAlbum = albumartistview.idAlbum ORDER BY albumview.idAlbum desc, albumartistview.iOrder
21:56:18.391 T:547532828896 DEBUG: DoWork - took 168 ms to load special://masterprofile/Thumbnails/a/ad43495f.jpg
21:56:18.399 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:56:18.423 T:546686058720 DEBUG: CRecentlyAddedJob::UpdateVideos() - Running RecentlyAdded home screen update
21:56:18.451 T:545363267808 DEBUG: DoWork - took 185 ms to load special://masterprofile/Thumbnails/6/61f44d95.jpg
21:56:18.534 T:546686058720 DEBUG: RunQuery took 56 ms for 10 items query: select * from movie_view ORDER BY dateAdded desc, idMovie desc LIMIT 10
21:56:18.621 T:545338257632 DEBUG: Thread Timer start, auto delete: false
21:56:18.646 T:545574551776 INFO: CPythonInvoker(9, /storage/.kodi/addons/script.skinshortcuts/default.py): script successfully run
21:56:18.654 T:545338257632 DEBUG: Thread Timer 545338257632 terminating
21:56:18.655 T:545049833696 DEBUG: Thread Timer start, auto delete: false
21:56:18.756 T:545574551776 INFO: Python script stopped
21:56:18.756 T:545574551776 DEBUG: Thread LanguageInvoker 545574551776 terminating
21:56:18.989 T:545804775648 DEBUG: Library Data Provider: script version 0.3.0 stopped
21:56:18.989 T:545804775648 INFO: CPythonInvoker(8, /storage/.kodi/addons/service.library.data.provider/plugin.py): script successfully run
21:56:18.997 T:546686058720 DEBUG: RunQuery took 382 ms for 10 items query: select * from episode_view ORDER BY dateAdded desc, idEpisode desc LIMIT 10
21:56:19.094 T:545804775648 INFO: Python script stopped
21:56:19.095 T:545804775648 DEBUG: Thread LanguageInvoker 545804775648 terminating
21:56:19.116 T:546686058720 DEBUG: RunQuery took 2 ms for 0 items query: select * from musicvideo_view ORDER BY dateAdded desc, idMVideo desc LIMIT 10
21:56:19.118 T:546686058720 DEBUG: CRecentlyAddedJob::UpdateTotal() - Running RecentlyAdded home screen update
21:56:19.131 T:546686058720 DEBUG: GetArtistsByWhere query: SELECT COUNT(DISTINCT artistview.idArtist) FROM artistview WHERE ((EXISTS (SELECT 1 FROM song_artist WHERE song_artist.idArtist = artistview.idArtist AND song_artist.idRole = 1) OR EXISTS (SELECT 1 FROM album_artist WHERE album_artist.idArtist = artistview.idArtist)) AND (artistview.strArtist != '')) AND (artistview.strArtist <> 'Various artists')
21:56:19.170 T:545049833696 DEBUG: Thread Timer 545049833696 terminating
21:56:38.894 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:56:38.942 T:547532828896 DEBUG: DoWork - took 171 ms to load special://masterprofile/Thumbnails/5/5a433fae.jpg
21:56:48.587 T:547620995072 INFO: CheckIdle - Closing session to ftp://192.168.1.5 (easy=0x3a83fe0, multi=0x3a7fb10)
21:56:49.153 T:547620995072 DEBUG: LIRC: Update - NEW at 89585:69 0 KEY_LEFT devinput (KEY_LEFT)
21:56:49.154 T:547620995072 DEBUG: OnKey: 169 (0xa9, obc86) pressed, action is Left
21:56:59.369 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:56:59.415 T:545363267808 DEBUG: DoWork - took 145 ms to load special://masterprofile/Thumbnails/f/f0361f9b.jpg
21:57:19.890 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:57:19.935 T:546694447328 DEBUG: DoWork - took 164 ms to load special://masterprofile/Thumbnails/1/1361cfc8.jpg
21:57:40.392 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:57:40.436 T:547532828896 DEBUG: DoWork - took 166 ms to load special://masterprofile/Thumbnails/6/670f8275.jpg
21:57:47.374 T:545380045024 DEBUG: OnQueueNextItem: play state was 2, starting 0
21:57:47.461 T:545363267808 DEBUG: CFileCache::Open - opening using cache
21:57:47.462 T:545363267808 DEBUG: CurlFile::Open(0x7ef41256d0) ftp://192.168.1.5:21/!!Music/Joe%20Cocker%20-%20You%20Are%20So%20Beautiful.m4a
21:57:47.462 T:545363267808 INFO: easy_aquire - Created session to ftp://192.168.1.5
21:57:47.716 T:545049833696 DEBUG: Thread FileCache start, auto delete: false
21:57:47.719 T:545363267808 DEBUG: Open - probing detected format [mov,mp4,m4a,3gp,3g2,mj2]
21:57:47.957 T:545049833696 DEBUG: CurlFile::CReadState::Connect - Resume from position 611528
21:57:47.979 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [mov,mp4,m4a,3gp,3g2,mj2] stream 0, timescale not set
21:57:47.979 T:545363267808 DEBUG: Open - avformat_find_stream_info starting
21:57:47.983 T:545363267808 DEBUG: Open - av_find_stream_info finished
21:57:47.984 T:545363267808 DEBUG: CDVDDemuxFFmpeg::AddStream ID: 0
21:57:47.984 T:545363267808 DEBUG: CDVDDemuxFFmpeg::AddStream ID: 1
21:57:47.984 T:545363267808 DEBUG: FactoryCodec - Audio: passthrough - Opening
21:57:47.984 T:545363267808 DEBUG: FactoryCodec - Audio: passthrough - Failed
21:57:47.984 T:545363267808 DEBUG: FactoryCodec - Audio: FFmpeg - Opening
21:57:47.987 T:545363267808 DEBUG: FactoryCodec - Audio: FFmpeg - Opened
21:57:48.052 T:545363267808 DEBUG: CFileCache::Open - opening using cache
21:57:48.053 T:545363267808 DEBUG: CurlFile::Open(0x7ef407e780) ftp://192.168.1.5:21/!!Music/Joe%20Cocker%20-%20You%20Are%20So%20Beautiful.m4a
21:57:48.054 T:545363267808 INFO: easy_aquire - Created session to ftp://192.168.1.5
21:57:48.076 T:545804775648 DEBUG: Thread FileCache start, auto delete: false
21:57:48.076 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 5886216
21:57:48.090 T:545363267808 DEBUG: Seek - waiting for position 5951752.
21:57:48.126 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 611528
21:57:48.157 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 5886216
21:57:48.184 T:545363267808 DEBUG: Seek - waiting for position 5951752.
21:57:48.192 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 62810
21:57:48.235 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 288
21:57:48.271 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 256
21:57:48.314 T:545363267808 DEBUG: SeekTime - unknown position after seek
21:57:48.315 T:545804775648 DEBUG: Previous line repeats 1 times.
21:57:48.315 T:545804775648 DEBUG: Thread FileCache 545804775648 terminating
21:57:48.369 T:545049833696 INFO: CFileCache::Process - Source read didn't return any data! Hit eof(?)
21:57:48.415 T:545363267808 INFO: AudioDecoder: File is queued
21:57:48.417 T:545363267808 DEBUG: AudioDecoder::GetReplayGain - Final Replaygain applied: 1.000000, Track/Album Gain 89.000000, Peak 1.000000
21:57:48.418 T:547524440288 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted
21:57:48.427 T:545363267808 INFO: PAPlayer::PrepareStream - Ready
21:57:52.341 T:545380045024 DEBUG: OnPlayBackStarted: play state was 2, starting 0
21:57:52.353 T:546694447328 DEBUG: CGUIInfoManager::SetCurrentSong(musicdb://songs/97.m4a)
21:57:52.358 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnPlay from xbmc
21:57:52.358 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 1, from xbmc, message OnPlay
21:57:52.362 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:57:52.389 T:546694447328 DEBUG: This query part contains a like, we will double backslash in the next field: select idArtist from artist where artist.strArtist like '
21:57:52.426 T:546694447328 DEBUG: Loading additional tag info for file ftp://192.168.1.5:21/!!Music/Joe Cocker - You Are So Beautiful.m4a
21:57:52.429 T:546694447328 DEBUG: CFileCache::Open - opening using cache
21:57:52.429 T:546694447328 DEBUG: CurlFile::Open(0x7f34068d80) ftp://192.168.1.5:21/!!Music/Joe%20Cocker%20-%20You%20Are%20So%20Beautiful.m4a
21:57:52.446 T:545804775648 DEBUG: Thread FileCache start, auto delete: false
21:57:52.446 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 5886216
21:57:52.453 T:547532828896 DEBUG: DoWork - Saving file state for audio item musicdb://songs/166.m4a
21:57:52.458 T:546694447328 DEBUG: Seek - waiting for position 5951752.
21:57:52.465 T:547532828896 DEBUG: DoWork - Marking audio item musicdb://songs/166.m4a as listened
21:57:52.466 T:547532828896 DEBUG: Mysql execute: UPDATE song SET iTimesPlayed=iTimesPlayed+1, lastplayed=CURRENT_TIMESTAMP where idSong=166
21:57:52.475 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 611528
21:57:52.487 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 5886216
21:57:52.499 T:546694447328 DEBUG: Seek - waiting for position 5951752.
21:57:52.501 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 62810
21:57:52.516 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 288
21:57:52.529 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 256
21:57:52.538 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnUpdate from xbmc
21:57:52.538 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 32, from xbmc, message OnUpdate
21:57:52.547 T:545804775648 DEBUG: Thread FileCache 545804775648 terminating
21:57:52.564 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:57:52.571 T:546686058720 ERROR: CCurlFile::Stat - Failed: FTP: couldn't retrieve (RETR failed) the specified file(19) for ftp://192.168.1.5:21/!!Music/cdart.png
21:57:52.571 T:546686058720 DEBUG: GetImageHash - unable to stat url ftp://192.168.1.5:21/!!Music/cdart.png
21:57:53.233 T:546694447328 DEBUG: Caching image '/storage/pictures/backgrounds/ffffffff-db05-1292-ffff-ffffc957c74d.0.jpg' to 'b/b07eb05f.jpg':
21:57:53.394 T:545804775648 DEBUG: CWebServer[8080]: request received for /jsonrpc?Application.GetProperties
21:57:53.409 T:545804775648 DEBUG: Previous line repeats 3 times.
21:57:53.409 T:545804775648 DEBUG: CWebServer[8080]: request received for /jsonrpc?Player.GetActivePlayers
21:57:53.419 T:545804775648 DEBUG: Previous line repeats 3 times.
21:57:53.419 T:545804775648 DEBUG: CWebServer[8080]: request received for /jsonrpc?Base
21:57:53.660 T:545804775648 DEBUG: Previous line repeats 3 times.
21:57:53.660 T:545804775648 DEBUG: CWebServer[8080]: request received for /image/image%3A%2F%2Fmusic%40ftp%253a%252f%252f192.168.1.5%253a21%252f!!Music%252fJoe%2520Cocker%2520-%2520With%2520a%2520Little%2520Help%2520From%2520My%2520Friends.m4a%2F
21:57:53.965 T:546694447328 DEBUG: cached image 'special://masterprofile/Thumbnails/b/b07eb05f.jpg' size 1920x1080
21:58:00.375 T:546677670112 DEBUG: Thread FileCache 546677670112 terminating
21:58:00.745 T:547524440288 DEBUG: CActiveAE::DiscardStream - audio stream deleted
21:58:00.746 T:547524440288 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted
21:58:00.746 T:545380045024 DEBUG: Previous line repeats 2 times.
21:58:00.746 T:545380045024 DEBUG: PAPlayer::ProcessStreams - Stream Freed
21:58:13.223 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:58:13.271 T:545363267808 DEBUG: DoWork - took 168 ms to load special://masterprofile/Thumbnails/d/d5fb6a62.jpg
21:58:22.919 T:547620995072 INFO: CheckIdle - Closing session to ftp://192.168.1.5 (easy=0x7ef4088350, multi=0x7ef400c5d0)
21:58:30.652 T:547620995072 INFO: CheckIdle - Closing session to ftp://192.168.1.5 (easy=0x398c360, multi=0x3985500)
21:58:33.754 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:58:33.801 T:547532828896 DEBUG: Caching image '/storage/pictures/backgrounds/Lake Wanaka, New Zealand 1920x1080.jpg' to '7/72f4a614.jpg':
21:58:33.801 T:547532828896 DEBUG: cached image 'special://masterprofile/Thumbnails/7/72f4a614.jpg' size 1920x1080
21:58:53.102 T:547620995072 DEBUG: LIRC: Update - NEW at 213534:6a 0 KEY_RIGHT devinput (KEY_RIGHT)
21:58:53.102 T:547620995072 DEBUG: OnKey: 168 (0xa8, obc87) pressed, action is Right
21:58:54.228 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:58:54.275 T:546686058720 DEBUG: DoWork - took 154 ms to load special://masterprofile/Thumbnails/1/1830360d.jpg
21:58:55.453 T:547620995072 DEBUG: LIRC: Update - NEW at 215886:6a 0 KEY_RIGHT devinput (KEY_RIGHT)
21:58:55.453 T:547620995072 DEBUG: OnKey: 168 (0xa8, obc87) pressed, action is Right
21:59:14.725 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:59:14.772 T:546694447328 DEBUG: DoWork - took 152 ms to load special://masterprofile/Thumbnails/e/ec9a512f.jpg
21:59:35.239 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:59:35.287 T:545363267808 DEBUG: DoWork - took 166 ms to load special://masterprofile/Thumbnails/2/2d86bcd0.jpg
21:59:52.460 T:547620995072 DEBUG: LIRC: Update - NEW at 272893:69 0 KEY_LEFT devinput (KEY_LEFT)
21:59:52.460 T:547620995072 DEBUG: OnKey: 169 (0xa9, obc86) pressed, action is Left
21:59:55.161 T:547620995072 DEBUG: LIRC: Update - NEW at 275594:6a 0 KEY_RIGHT devinput (KEY_RIGHT)
21:59:55.161 T:547620995072 DEBUG: OnKey: 168 (0xa8, obc87) pressed, action is Right
21:59:55.722 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
21:59:55.769 T:546686058720 DEBUG: DoWork - took 142 ms to load special://masterprofile/Thumbnails/5/5b6399ee.jpg
22:00:16.263 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:00:16.310 T:546694447328 DEBUG: DoWork - took 149 ms to load special://masterprofile/Thumbnails/4/475c1c18.jpg
22:00:21.967 T:545380045024 DEBUG: OnQueueNextItem: play state was 2, starting 0
22:00:22.042 T:547532828896 DEBUG: CFileCache::Open - opening using cache
22:00:22.042 T:547532828896 DEBUG: CurlFile::Open(0x7f6803ccd0) ftp://192.168.1.5:21/!!Music/The%20Rolling%20Stones%20-%20You%20Can%27t%20Always%20Get%20What%20You%20Want.m4a
22:00:22.043 T:547532828896 INFO: easy_aquire - Created session to ftp://192.168.1.5
22:00:22.056 T:545032007904 DEBUG: Thread FileCache start, auto delete: false
22:00:22.059 T:547532828896 DEBUG: Open - probing detected format [mov,mp4,m4a,3gp,3g2,mj2]
22:00:22.070 T:545032007904 DEBUG: CurlFile::CReadState::Connect - Resume from position 676278
22:00:22.278 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [mov,mp4,m4a,3gp,3g2,mj2] stream 0, timescale not set
22:00:22.280 T:547532828896 DEBUG: Open - avformat_find_stream_info starting
22:00:22.283 T:547532828896 DEBUG: Open - av_find_stream_info finished
22:00:22.284 T:547532828896 DEBUG: CDVDDemuxFFmpeg::AddStream ID: 0
22:00:22.284 T:547532828896 DEBUG: CDVDDemuxFFmpeg::AddStream ID: 1
22:00:22.284 T:547532828896 DEBUG: FactoryCodec - Audio: passthrough - Opening
22:00:22.284 T:547532828896 DEBUG: FactoryCodec - Audio: passthrough - Failed
22:00:22.284 T:547532828896 DEBUG: FactoryCodec - Audio: FFmpeg - Opening
22:00:22.286 T:547532828896 DEBUG: FactoryCodec - Audio: FFmpeg - Opened
22:00:22.355 T:547532828896 DEBUG: CFileCache::Open - opening using cache
22:00:22.355 T:547532828896 DEBUG: CurlFile::Open(0x7f6831b870) ftp://192.168.1.5:21/!!Music/The%20Rolling%20Stones%20-%20You%20Can%27t%20Always%20Get%20What%20You%20Want.m4a
22:00:22.356 T:547532828896 INFO: easy_aquire - Created session to ftp://192.168.1.5
22:00:22.507 T:546677670112 DEBUG: Thread FileCache start, auto delete: false
22:00:22.507 T:546677670112 DEBUG: CurlFile::CReadState::Connect - Resume from position 15360405
22:00:22.541 T:547532828896 DEBUG: Seek - waiting for position 15425941.
22:00:22.588 T:546677670112 DEBUG: CurlFile::CReadState::Connect - Resume from position 676278
22:00:22.602 T:546677670112 DEBUG: CurlFile::CReadState::Connect - Resume from position 15360405
22:00:22.617 T:547532828896 DEBUG: Seek - waiting for position 15425941.
22:00:22.621 T:546677670112 DEBUG: CurlFile::CReadState::Connect - Resume from position 114278
22:00:22.636 T:546677670112 DEBUG: CurlFile::CReadState::Connect - Resume from position 288
22:00:22.649 T:546677670112 DEBUG: CurlFile::CReadState::Connect - Resume from position 256
22:00:22.666 T:547532828896 DEBUG: SeekTime - unknown position after seek
22:00:22.667 T:546677670112 DEBUG: Previous line repeats 1 times.
22:00:22.667 T:546677670112 DEBUG: Thread FileCache 546677670112 terminating
22:00:22.769 T:547532828896 INFO: AudioDecoder: File is queued
22:00:22.771 T:547524440288 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted
22:00:22.771 T:547532828896 DEBUG: AudioDecoder::GetReplayGain - Final Replaygain applied: 1.000000, Track/Album Gain 89.000000, Peak 1.000000
22:00:22.779 T:547532828896 INFO: PAPlayer::PrepareStream - Ready
22:00:25.153 T:545032007904 INFO: CFileCache::Process - Source read didn't return any data! Hit eof(?)
22:00:26.983 T:545380045024 DEBUG: OnPlayBackStarted: play state was 2, starting 0
22:00:26.993 T:546686058720 DEBUG: CGUIInfoManager::SetCurrentSong(musicdb://songs/173.m4a)
22:00:26.994 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnPlay from xbmc
22:00:26.994 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 1, from xbmc, message OnPlay
22:00:26.998 T:546694447328 DEBUG: DoWork - Saving file state for audio item musicdb://songs/97.m4a
22:00:27.010 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:00:27.032 T:546694447328 DEBUG: DoWork - Marking audio item musicdb://songs/97.m4a as listened
22:00:27.033 T:546694447328 DEBUG: Mysql execute: UPDATE song SET iTimesPlayed=iTimesPlayed+1, lastplayed=CURRENT_TIMESTAMP where idSong=97
22:00:27.037 T:546686058720 DEBUG: This query part contains a like, we will double backslash in the next field: select idArtist from artist where artist.strArtist like '
22:00:27.071 T:546686058720 DEBUG: Loading additional tag info for file ftp://192.168.1.5:21/!!Music/The Rolling Stones - You Can't Always Get What You Want.m4a
22:00:27.075 T:546686058720 DEBUG: CFileCache::Open - opening using cache
22:00:27.075 T:546686058720 DEBUG: CurlFile::Open(0x7f38032290) ftp://192.168.1.5:21/!!Music/The%20Rolling%20Stones%20-%20You%20Can%27t%20Always%20Get%20What%20You%20Want.m4a
22:00:27.102 T:546677670112 DEBUG: Thread FileCache start, auto delete: false
22:00:27.102 T:546677670112 DEBUG: CurlFile::CReadState::Connect - Resume from position 15360405
22:00:27.133 T:546686058720 DEBUG: Seek - waiting for position 15425941.
22:00:27.171 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnUpdate from xbmc
22:00:27.171 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 32, from xbmc, message OnUpdate
22:00:27.182 T:546677670112 DEBUG: CurlFile::CReadState::Connect - Resume from position 676278
22:00:27.193 T:546694447328 INFO: easy_aquire - Created session to ftp://192.168.1.5
22:00:27.208 T:546694447328 ERROR: CCurlFile::Stat - Failed: FTP: couldn't retrieve (RETR failed) the specified file(19) for ftp://192.168.1.5:21/!!Music/cdart.png
22:00:27.208 T:546694447328 DEBUG: GetImageHash - unable to stat url ftp://192.168.1.5:21/!!Music/cdart.png
22:00:27.219 T:546677670112 DEBUG: CurlFile::CReadState::Connect - Resume from position 15360405
22:00:27.228 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:00:27.245 T:546686058720 DEBUG: Seek - waiting for position 15425941.
22:00:27.255 T:546677670112 DEBUG: CurlFile::CReadState::Connect - Resume from position 114278
22:00:27.279 T:546677670112 DEBUG: CurlFile::CReadState::Connect - Resume from position 288
22:00:27.295 T:546677670112 DEBUG: CurlFile::CReadState::Connect - Resume from position 256
22:00:27.311 T:546677670112 DEBUG: Thread FileCache 546677670112 terminating
22:00:27.395 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:00:27.440 T:547532828896 DEBUG: DoWork - took 194 ms to load special://masterprofile/Thumbnails/7/7c6375bd.jpg
22:00:28.024 T:546677670112 DEBUG: CWebServer[8080]: request received for /jsonrpc?Application.GetProperties
22:00:28.041 T:546677670112 DEBUG: Previous line repeats 3 times.
22:00:28.041 T:546677670112 DEBUG: CWebServer[8080]: request received for /jsonrpc?Player.GetActivePlayers
22:00:28.056 T:546677670112 DEBUG: Previous line repeats 3 times.
22:00:28.056 T:546677670112 DEBUG: CWebServer[8080]: request received for /jsonrpc?Base
22:00:34.984 T:545380045024 DEBUG: Previous line repeats 3 times.
22:00:34.984 T:545380045024 INFO: PAPlayer::ProcessStream - Stream Finished
22:00:34.985 T:545049833696 DEBUG: Thread FileCache 545049833696 terminating
22:00:35.387 T:547524440288 DEBUG: CActiveAE::DiscardStream - audio stream deleted
22:00:35.387 T:547524440288 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted
22:00:35.387 T:545380045024 DEBUG: Previous line repeats 2 times.
22:00:35.387 T:545380045024 DEBUG: PAPlayer::ProcessStreams - Stream Freed
22:00:47.860 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:00:47.907 T:545363267808 DEBUG: DoWork - took 162 ms to load special://masterprofile/Thumbnails/e/e1d1af31.jpg
22:00:57.677 T:547620995072 INFO: CheckIdle - Closing session to ftp://192.168.1.5 (easy=0x7f68153b90, multi=0x7f680261f0)
22:00:57.678 T:547620995072 INFO: CheckIdle - Closing session to ftp://192.168.1.5 (easy=0x7f3418bdc0, multi=(nil))
22:01:05.110 T:547620995072 INFO: CheckIdle - Closing session to ftp://192.168.1.5 (easy=0x7ef4151c40, multi=0x7ef40c40c0)
22:01:08.352 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:01:08.400 T:546694447328 DEBUG: DoWork - took 156 ms to load special://masterprofile/Thumbnails/1/1be8bf85.jpg
22:01:28.858 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:01:28.906 T:546686058720 DEBUG: Caching image '/storage/pictures/backgrounds/211512773023536628evergreen_53409172_500kb_1920x1080.jpg' to 'c/c9c10c5c.jpg':
22:01:28.906 T:546686058720 DEBUG: cached image 'special://masterprofile/Thumbnails/c/c9c10c5c.jpg' size 1920x1080
22:01:49.391 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:01:49.437 T:547532828896 DEBUG: DoWork - took 159 ms to load special://masterprofile/Thumbnails/d/d2cd9e16.jpg
22:02:10.275 T:546694447328 DEBUG: Caching image '/storage/pictures/backgrounds/00000000-27c5-50f2-0000-0000161805ad.0.jpg' to '9/928c0f89.jpg':
22:02:10.969 T:546694447328 DEBUG: cached image 'special://masterprofile/Thumbnails/9/928c0f89.jpg' size 1920x1080
22:02:27.677 T:547620995072 DEBUG: LIRC: Update - NEW at 428110:6a 0 KEY_RIGHT devinput (KEY_RIGHT)
22:02:27.677 T:547620995072 DEBUG: OnKey: 168 (0xa8, obc87) pressed, action is Right
22:02:30.389 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:02:30.436 T:546686058720 DEBUG: DoWork - took 158 ms to load special://masterprofile/Thumbnails/4/42031b7a.jpg
22:02:50.896 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:02:50.944 T:547532828896 DEBUG: DoWork - took 167 ms to load special://masterprofile/Thumbnails/b/bb3ae47f.jpg
22:03:11.394 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:03:11.440 T:546694447328 DEBUG: DoWork - took 162 ms to load special://masterprofile/Thumbnails/9/9b71a50d.jpg
22:03:31.859 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:03:31.906 T:547532828896 DEBUG: DoWork - took 128 ms to load special://masterprofile/Thumbnails/2/25b14436.jpg
22:03:52.348 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:04:12.927 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:04:12.983 T:547532828896 DEBUG: Caching image '/storage/pictures/backgrounds/Athabasca Glacier 1920x1080.jpg' to '9/94b8a9b9.jpg':
22:04:12.983 T:547532828896 DEBUG: cached image 'special://masterprofile/Thumbnails/9/94b8a9b9.jpg' size 1920x1080
22:04:33.624 T:545363267808 DEBUG: Caching image '/storage/pictures/backgrounds/211552347718140121evergreen_offset_37544_500kb_1920x1080.jpg' to 'd/d16595ac.jpg':
22:04:33.624 T:545363267808 DEBUG: cached image 'special://masterprofile/Thumbnails/d/d16595ac.jpg' size 1920x1080
22:04:43.710 T:547620995072 DEBUG: LIRC: Update - NEW at 564143:69 0 KEY_LEFT devinput (KEY_LEFT)
22:04:43.710 T:547620995072 DEBUG: OnKey: 169 (0xa9, obc86) pressed, action is Left
22:04:53.950 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:04:53.997 T:546694447328 DEBUG: DoWork - took 186 ms to load special://masterprofile/Thumbnails/b/ba35cc02.jpg
22:05:14.440 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:05:14.487 T:547532828896 DEBUG: DoWork - took 176 ms to load special://masterprofile/Thumbnails/0/05e4c6a9.jpg
22:05:34.919 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:05:34.966 T:546694447328 DEBUG: DoWork - took 156 ms to load special://masterprofile/Thumbnails/a/a0e22668.jpg
22:05:55.416 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:05:55.464 T:547532828896 DEBUG: DoWork - took 152 ms to load special://masterprofile/Thumbnails/6/6c4135d6.jpg
22:06:15.951 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:06:15.996 T:546694447328 DEBUG: DoWork - took 152 ms to load special://masterprofile/Thumbnails/e/eb6c7bca.jpg
22:06:36.493 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:06:36.543 T:547532828896 DEBUG: DoWork - took 199 ms to load special://masterprofile/Thumbnails/e/ea86bbe6.jpg
22:06:56.962 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:06:57.009 T:546694447328 DEBUG: DoWork - took 148 ms to load special://masterprofile/Thumbnails/2/2c03fbe6.jpg
22:07:13.527 T:547620995072 DEBUG: LIRC: Update - NEW at 713960:69 0 KEY_LEFT devinput (KEY_LEFT)
22:07:13.527 T:547620995072 DEBUG: OnKey: 169 (0xa9, obc86) pressed, action is Left
22:07:17.483 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:07:17.532 T:547532828896 DEBUG: DoWork - took 170 ms to load special://masterprofile/Thumbnails/3/3449686e.jpg
22:07:37.984 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:07:38.032 T:545363267808 DEBUG: DoWork - took 171 ms to load special://masterprofile/Thumbnails/8/8b5445ce.jpg
22:07:42.411 T:545380045024 DEBUG: OnQueueNextItem: play state was 2, starting 0
22:07:42.494 T:546686058720 DEBUG: CFileCache::Open - opening using cache
22:07:42.494 T:546686058720 DEBUG: CurlFile::Open(0x7f38031940) ftp://192.168.1.5:21/!!Music/Ray%20Charles%20-%20You%20Don%27t%20Know%20Me.m4a
22:07:42.495 T:546686058720 INFO: easy_aquire - Created session to ftp://192.168.1.5
22:07:42.731 T:545049833696 DEBUG: Thread FileCache start, auto delete: false
22:07:42.733 T:546686058720 DEBUG: Open - probing detected format [mov,mp4,m4a,3gp,3g2,mj2]
22:07:42.951 T:545049833696 DEBUG: CurlFile::CReadState::Connect - Resume from position 644548
22:07:42.966 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [mov,mp4,m4a,3gp,3g2,mj2] stream 0, timescale not set
22:07:42.967 T:546686058720 DEBUG: Open - avformat_find_stream_info starting
22:07:42.977 T:546686058720 DEBUG: Open - av_find_stream_info finished
22:07:42.979 T:546686058720 DEBUG: CDVDDemuxFFmpeg::AddStream ID: 0
22:07:42.980 T:546686058720 DEBUG: CDVDDemuxFFmpeg::AddStream ID: 1
22:07:42.981 T:546686058720 DEBUG: FactoryCodec - Audio: passthrough - Opening
22:07:42.981 T:546686058720 DEBUG: FactoryCodec - Audio: passthrough - Failed
22:07:42.981 T:546686058720 DEBUG: FactoryCodec - Audio: FFmpeg - Opening
22:07:42.988 T:546686058720 DEBUG: FactoryCodec - Audio: FFmpeg - Opened
22:07:43.058 T:546686058720 DEBUG: CFileCache::Open - opening using cache
22:07:43.058 T:546686058720 DEBUG: CurlFile::Open(0x7f3804ed30) ftp://192.168.1.5:21/!!Music/Ray%20Charles%20-%20You%20Don%27t%20Know%20Me.m4a
22:07:43.061 T:546686058720 INFO: easy_aquire - Created session to ftp://192.168.1.5
22:07:43.078 T:545574551776 DEBUG: Thread FileCache start, auto delete: false
22:07:43.078 T:545574551776 DEBUG: CurlFile::CReadState::Connect - Resume from position 7760875
22:07:43.103 T:546686058720 DEBUG: Seek - waiting for position 7826411.
22:07:43.147 T:545574551776 DEBUG: CurlFile::CReadState::Connect - Resume from position 644548
22:07:43.172 T:545574551776 DEBUG: CurlFile::CReadState::Connect - Resume from position 7760875
22:07:43.198 T:546686058720 DEBUG: Seek - waiting for position 7826411.
22:07:43.207 T:545574551776 DEBUG: CurlFile::CReadState::Connect - Resume from position 69250
22:07:43.249 T:545574551776 DEBUG: CurlFile::CReadState::Connect - Resume from position 288
22:07:43.279 T:545574551776 DEBUG: CurlFile::CReadState::Connect - Resume from position 256
22:07:43.308 T:545574551776 DEBUG: Thread FileCache 545574551776 terminating
22:07:43.309 T:546686058720 DEBUG: SeekTime - unknown position after seek
22:07:43.411 T:546686058720 DEBUG: Previous line repeats 1 times.
22:07:43.411 T:546686058720 INFO: AudioDecoder: File is queued
22:07:43.412 T:546686058720 DEBUG: AudioDecoder::GetReplayGain - Final Replaygain applied: 1.000000, Track/Album Gain 89.000000, Peak 1.000000
22:07:43.413 T:547524440288 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted
22:07:43.421 T:546686058720 INFO: PAPlayer::PrepareStream - Ready
22:07:43.792 T:545049833696 INFO: CFileCache::Process - Source read didn't return any data! Hit eof(?)
22:07:47.417 T:545380045024 DEBUG: OnPlayBackStarted: play state was 2, starting 0
22:07:47.428 T:547532828896 DEBUG: CGUIInfoManager::SetCurrentSong(musicdb://songs/139.m4a)
22:07:47.428 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnPlay from xbmc
22:07:47.428 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 1, from xbmc, message OnPlay
22:07:47.429 T:545363267808 DEBUG: DoWork - Saving file state for audio item musicdb://songs/173.m4a
22:07:47.444 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:07:47.468 T:545363267808 DEBUG: DoWork - Marking audio item musicdb://songs/173.m4a as listened
22:07:47.468 T:545363267808 DEBUG: Mysql execute: UPDATE song SET iTimesPlayed=iTimesPlayed+1, lastplayed=CURRENT_TIMESTAMP where idSong=173
22:07:47.474 T:547532828896 DEBUG: This query part contains a like, we will double backslash in the next field: select idArtist from artist where artist.strArtist like '
22:07:47.522 T:547532828896 DEBUG: Loading additional tag info for file ftp://192.168.1.5:21/!!Music/Ray Charles - You Don't Know Me.m4a
22:07:47.525 T:547532828896 DEBUG: CFileCache::Open - opening using cache
22:07:47.525 T:547532828896 DEBUG: CurlFile::Open(0x7f6803a6f0) ftp://192.168.1.5:21/!!Music/Ray%20Charles%20-%20You%20Don%27t%20Know%20Me.m4a
22:07:47.539 T:545574551776 DEBUG: Thread FileCache start, auto delete: false
22:07:47.539 T:545574551776 DEBUG: CurlFile::CReadState::Connect - Resume from position 7760875
22:07:47.545 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnUpdate from xbmc
22:07:47.545 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 32, from xbmc, message OnUpdate
22:07:47.551 T:547532828896 DEBUG: Seek - waiting for position 7826411.
22:07:47.569 T:546694447328 INFO: easy_aquire - Created session to ftp://192.168.1.5
22:07:47.575 T:546694447328 ERROR: CCurlFile::Stat - Failed: FTP: couldn't retrieve (RETR failed) the specified file(19) for ftp://192.168.1.5:21/!!Music/cdart.png
22:07:47.575 T:546694447328 DEBUG: GetImageHash - unable to stat url ftp://192.168.1.5:21/!!Music/cdart.png
22:07:47.577 T:545574551776 DEBUG: CurlFile::CReadState::Connect - Resume from position 644548
22:07:47.581 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:07:47.595 T:545574551776 DEBUG: CurlFile::CReadState::Connect - Resume from position 7760875
22:07:47.610 T:547532828896 DEBUG: Seek - waiting for position 7826411.
22:07:47.614 T:545574551776 DEBUG: CurlFile::CReadState::Connect - Resume from position 69250
22:07:47.635 T:545574551776 DEBUG: CurlFile::CReadState::Connect - Resume from position 288
22:07:47.670 T:545574551776 DEBUG: CurlFile::CReadState::Connect - Resume from position 256
22:07:47.705 T:545574551776 DEBUG: Thread FileCache 545574551776 terminating
22:07:47.757 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:07:47.806 T:546694447328 DEBUG: Caching image '/storage/pictures/backgrounds/211498604339457205evergreen_offset_28663_500kb_1920x1080.jpg' to '5/596a5e29.jpg':
22:07:47.806 T:546694447328 DEBUG: cached image 'special://masterprofile/Thumbnails/5/596a5e29.jpg' size 1920x1080
22:07:48.459 T:545574551776 DEBUG: CWebServer[8080]: request received for /jsonrpc?Application.GetProperties
22:07:48.474 T:545804775648 DEBUG: Previous line repeats 3 times.
22:07:48.474 T:545804775648 DEBUG: CWebServer[8080]: request received for /jsonrpc?Player.GetActivePlayers
22:07:48.483 T:545804775648 DEBUG: Previous line repeats 3 times.
22:07:48.483 T:545804775648 DEBUG: CWebServer[8080]: request received for /jsonrpc?Base
22:07:55.376 T:545380045024 DEBUG: Previous line repeats 3 times.
22:07:55.377 T:545380045024 INFO: PAPlayer::ProcessStream - Stream Finished
22:07:55.378 T:545032007904 DEBUG: Thread FileCache 545032007904 terminating
22:07:55.783 T:547524440288 DEBUG: CActiveAE::DiscardStream - audio stream deleted
22:07:55.783 T:547524440288 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted
22:07:55.783 T:545380045024 DEBUG: Previous line repeats 2 times.
22:07:55.783 T:545380045024 DEBUG: PAPlayer::ProcessStreams - Stream Freed
22:08:08.629 T:545363267808 DEBUG: Caching image '/storage/pictures/backgrounds/00000000-66e4-8cf5-0000-0000553741b0.0.jpg' to 'd/d60ce8b7.jpg':
22:08:09.336 T:545363267808 DEBUG: cached image 'special://masterprofile/Thumbnails/d/d60ce8b7.jpg' size 1920x1080
22:08:18.077 T:547620995072 INFO: CheckIdle - Closing session to ftp://192.168.1.5 (easy=0x7f381897d0, multi=0x7f38140e20)
22:08:18.078 T:547620995072 INFO: CheckIdle - Closing session to ftp://192.168.1.5 (easy=0x7f3418bdc0, multi=(nil))
22:08:25.477 T:547620995072 INFO: CheckIdle - Closing session to ftp://192.168.1.5 (easy=0x7f68063070, multi=0x7f68071cc0)
22:08:28.765 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:08:28.811 T:546686058720 DEBUG: DoWork - took 165 ms to load special://masterprofile/Thumbnails/9/981a3c99.jpg
22:08:49.295 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:08:49.349 T:547532828896 DEBUG: DoWork - took 170 ms to load special://masterprofile/Thumbnails/e/e3f4428b.jpg
22:09:07.778 T:547620995072 DEBUG: LIRC: Update - NEW at 828211:69 0 KEY_LEFT devinput (KEY_LEFT)
22:09:07.778 T:547620995072 DEBUG: OnKey: 169 (0xa9, obc86) pressed, action is Left
22:09:10.205 T:546694447328 DEBUG: Caching image '/storage/pictures/backgrounds/240066403682976745image_fullscreen_001_landscape.jpg' to 'c/c38e3fb5.jpg':
22:09:10.206 T:546694447328 DEBUG: cached image 'special://masterprofile/Thumbnails/c/c38e3fb5.jpg' size 1920x1080
22:09:30.311 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:09:30.369 T:545363267808 DEBUG: DoWork - took 159 ms to load special://masterprofile/Thumbnails/7/7acfd8c6.jpg
22:09:50.837 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:09:50.890 T:546686058720 DEBUG: Caching image '/storage/pictures/backgrounds/The Bastei, Germany 1920x1080.jpg' to '7/744f8da4.jpg':
22:09:50.891 T:546686058720 DEBUG: cached image 'special://masterprofile/Thumbnails/7/744f8da4.jpg' size 1920x1080
22:10:11.318 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:10:11.364 T:547532828896 DEBUG: DoWork - took 153 ms to load special://masterprofile/Thumbnails/2/240c7c30.jpg
22:10:25.376 T:547620995072 DEBUG: LIRC: Update - NEW at 905809:69 0 KEY_LEFT devinput (KEY_LEFT)
22:10:25.376 T:547620995072 DEBUG: OnKey: 169 (0xa9, obc86) pressed, action is Left
22:10:31.840 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:10:31.887 T:546694447328 DEBUG: Caching image '/storage/pictures/backgrounds/Pyrenees, France 1920x1080.jpg' to 'a/a35ab6a4.jpg':
22:10:31.887 T:546694447328 DEBUG: cached image 'special://masterprofile/Thumbnails/a/a35ab6a4.jpg' size 1920x1080
22:10:52.267 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:10:52.860 T:545380045024 DEBUG: OnQueueNextItem: play state was 2, starting 0
22:10:52.940 T:547532828896 DEBUG: CFileCache::Open - opening using cache
22:10:52.941 T:547532828896 DEBUG: CurlFile::Open(0x7f6803ccd0) ftp://192.168.1.5:21/!!Music/Bon%20Jovi%20-%20You%20Give%20Love%20a%20Bad%20Name.m4a
22:10:52.941 T:547532828896 INFO: easy_aquire - Created session to ftp://192.168.1.5
22:10:53.161 T:545032007904 DEBUG: Thread FileCache start, auto delete: false
22:10:53.163 T:547532828896 DEBUG: Open - probing detected format [mov,mp4,m4a,3gp,3g2,mj2]
22:10:53.430 T:545032007904 DEBUG: CurlFile::CReadState::Connect - Resume from position 1528802
22:10:53.455 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [mov,mp4,m4a,3gp,3g2,mj2] stream 0, timescale not set
22:10:53.456 T:547532828896 DEBUG: Open - avformat_find_stream_info starting
22:10:53.472 T:547532828896 DEBUG: Open - av_find_stream_info finished
22:10:53.472 T:547532828896 DEBUG: CDVDDemuxFFmpeg::AddStream ID: 0
22:10:53.472 T:547532828896 DEBUG: CDVDDemuxFFmpeg::AddStream ID: 1
22:10:53.472 T:547532828896 DEBUG: FactoryCodec - Audio: passthrough - Opening
22:10:53.472 T:547532828896 DEBUG: FactoryCodec - Audio: passthrough - Failed
22:10:53.472 T:547532828896 DEBUG: FactoryCodec - Audio: FFmpeg - Opening
22:10:53.474 T:547532828896 DEBUG: FactoryCodec - Audio: FFmpeg - Opened
22:10:53.547 T:547532828896 DEBUG: CFileCache::Open - opening using cache
22:10:53.547 T:547532828896 DEBUG: CurlFile::Open(0x7f680756a0) ftp://192.168.1.5:21/!!Music/Bon%20Jovi%20-%20You%20Give%20Love%20a%20Bad%20Name.m4a
22:10:53.547 T:547532828896 INFO: easy_aquire - Created session to ftp://192.168.1.5
22:10:53.579 T:545338257632 DEBUG: Thread FileCache start, auto delete: false
22:10:53.579 T:545338257632 DEBUG: CurlFile::CReadState::Connect - Resume from position 8751233
22:10:53.609 T:547532828896 DEBUG: Seek - waiting for position 8816769.
22:10:53.658 T:545338257632 DEBUG: CurlFile::CReadState::Connect - Resume from position 1005668
22:10:53.693 T:545338257632 DEBUG: CurlFile::CReadState::Connect - Resume from position 1528802
22:10:53.724 T:545338257632 DEBUG: CurlFile::CReadState::Connect - Resume from position 8751233
22:10:53.736 T:547532828896 DEBUG: Seek - waiting for position 8816769.
22:10:53.739 T:545338257632 DEBUG: CurlFile::CReadState::Connect - Resume from position 73858
22:10:53.781 T:545338257632 DEBUG: CurlFile::CReadState::Connect - Resume from position 288
22:10:53.797 T:545338257632 DEBUG: CurlFile::CReadState::Connect - Resume from position 256
22:10:53.821 T:545338257632 DEBUG: Thread FileCache 545338257632 terminating
22:10:53.824 T:547532828896 DEBUG: SeekTime - unknown position after seek
22:10:53.930 T:547532828896 DEBUG: Previous line repeats 1 times.
22:10:53.930 T:547532828896 INFO: AudioDecoder: File is queued
22:10:53.931 T:547532828896 DEBUG: AudioDecoder::GetReplayGain - Final Replaygain applied: 1.000000, Track/Album Gain 89.000000, Peak 1.000000
22:10:53.932 T:547524440288 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted
22:10:53.941 T:547532828896 INFO: PAPlayer::PrepareStream - Ready
22:10:54.296 T:545032007904 INFO: CFileCache::Process - Source read didn't return any data! Hit eof(?)
22:10:57.876 T:545380045024 DEBUG: OnPlayBackStarted: play state was 2, starting 0
22:10:57.891 T:546694447328 DEBUG: CGUIInfoManager::SetCurrentSong(musicdb://songs/22.m4a)
22:10:57.898 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnPlay from xbmc
22:10:57.898 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 1, from xbmc, message OnPlay
22:10:57.914 T:546686058720 DEBUG: DoWork - Saving file state for audio item musicdb://songs/139.m4a
22:10:57.922 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:10:57.924 T:546694447328 DEBUG: This query part contains a like, we will double backslash in the next field: select idArtist from artist where artist.strArtist like '
22:10:57.936 T:546686058720 DEBUG: DoWork - Marking audio item musicdb://songs/139.m4a as listened
22:10:57.936 T:546686058720 DEBUG: Mysql execute: UPDATE song SET iTimesPlayed=iTimesPlayed+1, lastplayed=CURRENT_TIMESTAMP where idSong=139
22:10:57.946 T:546694447328 DEBUG: Loading additional tag info for file ftp://192.168.1.5:21/!!Music/Bon Jovi - You Give Love a Bad Name.m4a
22:10:57.949 T:546694447328 DEBUG: CFileCache::Open - opening using cache
22:10:57.949 T:546694447328 DEBUG: CurlFile::Open(0x7f34068d80) ftp://192.168.1.5:21/!!Music/Bon%20Jovi%20-%20You%20Give%20Love%20a%20Bad%20Name.m4a
22:10:57.971 T:545338257632 DEBUG: Thread FileCache start, auto delete: false
22:10:57.971 T:545338257632 DEBUG: CurlFile::CReadState::Connect - Resume from position 8751233
22:10:57.999 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnUpdate from xbmc
22:10:57.999 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 32, from xbmc, message OnUpdate
22:10:58.000 T:546694447328 DEBUG: Seek - waiting for position 8816769.
22:10:58.020 T:546686058720 INFO: easy_aquire - Created session to ftp://192.168.1.5
22:10:58.029 T:546686058720 ERROR: CCurlFile::Stat - Failed: FTP: couldn't retrieve (RETR failed) the specified file(19) for ftp://192.168.1.5:21/!!Music/cdart.png
22:10:58.029 T:546686058720 DEBUG: GetImageHash - unable to stat url ftp://192.168.1.5:21/!!Music/cdart.png
22:10:58.039 T:545338257632 DEBUG: CurlFile::CReadState::Connect - Resume from position 1005668
22:10:58.052 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:10:58.069 T:545338257632 DEBUG: CurlFile::CReadState::Connect - Resume from position 1528802
22:10:58.093 T:545338257632 DEBUG: CurlFile::CReadState::Connect - Resume from position 8751233
22:10:58.123 T:546694447328 DEBUG: Seek - waiting for position 8816769.
22:10:58.131 T:545338257632 DEBUG: CurlFile::CReadState::Connect - Resume from position 73858
22:10:58.194 T:545338257632 DEBUG: CurlFile::CReadState::Connect - Resume from position 288
22:10:58.222 T:545338257632 DEBUG: CurlFile::CReadState::Connect - Resume from position 256
22:10:58.260 T:545338257632 DEBUG: Thread FileCache 545338257632 terminating
22:10:58.280 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:10:58.325 T:547532828896 DEBUG: DoWork - took 229 ms to load special://masterprofile/Thumbnails/3/369add5b.jpg
22:10:58.924 T:545338257632 DEBUG: CWebServer[8080]: request received for /jsonrpc?Application.GetProperties
22:10:58.939 T:545338257632 DEBUG: Previous line repeats 3 times.
22:10:58.939 T:545338257632 DEBUG: CWebServer[8080]: request received for /jsonrpc?Player.GetActivePlayers
22:10:58.947 T:545574551776 DEBUG: Previous line repeats 3 times.
22:10:58.947 T:545574551776 DEBUG: CWebServer[8080]: request received for /jsonrpc?Base
22:10:59.227 T:545338257632 DEBUG: Previous line repeats 3 times.
22:10:59.227 T:545338257632 DEBUG: CWebServer[8080]: request received for /image/image%3A%2F%2Fmusic%40ftp%253a%252f%252f192.168.1.5%253a21%252f!!Music%252fBon%2520Jovi%2520-%2520Always.m4a%2F
22:11:05.822 T:545380045024 INFO: PAPlayer::ProcessStream - Stream Finished
22:11:05.823 T:545049833696 DEBUG: Thread FileCache 545049833696 terminating
22:11:06.236 T:547524440288 DEBUG: CActiveAE::DiscardStream - audio stream deleted
22:11:06.236 T:547524440288 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted
22:11:06.236 T:545380045024 DEBUG: Previous line repeats 2 times.
22:11:06.236 T:545380045024 DEBUG: PAPlayer::ProcessStreams - Stream Freed
22:11:18.669 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:11:18.716 T:545363267808 DEBUG: DoWork - took 121 ms to load special://masterprofile/Thumbnails/c/cd544a12.jpg
22:11:28.160 T:547620995072 INFO: CheckIdle - Closing session to ftp://192.168.1.5 (easy=0x7f381897d0, multi=(nil))
22:11:28.693 T:547620995072 INFO: CheckIdle - Closing session to ftp://192.168.1.5 (easy=0x7f6803ce90, multi=0x7f6800bb60)
22:11:36.127 T:547620995072 INFO: CheckIdle - Closing session to ftp://192.168.1.5 (easy=0x7f38032510, multi=0x7f380013b0)
22:11:39.210 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:11:39.257 T:547532828896 DEBUG: DoWork - took 130 ms to load special://masterprofile/Thumbnails/1/1830360d.jpg
22:11:59.745 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:11:59.790 T:546686058720 DEBUG: DoWork - took 163 ms to load special://masterprofile/Thumbnails/b/b1370b16.jpg
22:12:20.216 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:12:20.263 T:545363267808 DEBUG: DoWork - took 136 ms to load special://masterprofile/Thumbnails/1/1623b035.jpg
22:12:40.754 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:12:40.801 T:547532828896 DEBUG: Caching image '/storage/pictures/backgrounds/Kelly Butte, Washington 1920x1080.jpg' to '3/381ec85d.jpg':
22:12:40.801 T:547532828896 DEBUG: cached image 'special://masterprofile/Thumbnails/3/381ec85d.jpg' size 1920x1080
22:13:01.451 T:546686058720 DEBUG: Caching image '/storage/pictures/backgrounds/211498599505316590evergreen_85534627_500kb_1920x1080.jpg' to 'd/d12f4420.jpg':
22:13:01.452 T:546686058720 DEBUG: cached image 'special://masterprofile/Thumbnails/d/d12f4420.jpg' size 1920x1080
22:13:21.776 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:13:21.824 T:545363267808 DEBUG: DoWork - took 188 ms to load special://masterprofile/Thumbnails/e/eba63e30.jpg
22:13:42.261 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:13:42.307 T:546694447328 DEBUG: DoWork - took 169 ms to load special://masterprofile/Thumbnails/4/448c43f6.jpg
22:14:03.260 T:546686058720 DEBUG: Caching image '/storage/pictures/backgrounds/00000000-3648-67ff-0000-0000249b1cba.0.jpg' to '9/976301f8.jpg':
22:14:03.941 T:546686058720 DEBUG: cached image 'special://masterprofile/Thumbnails/9/976301f8.jpg' size 1920x1080
22:14:23.250 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:14:23.296 T:545363267808 DEBUG: DoWork - took 154 ms to load special://masterprofile/Thumbnails/a/a4044877.jpg
22:14:28.821 T:545380045024 DEBUG: OnQueueNextItem: play state was 2, starting 0
22:14:28.881 T:547532828896 DEBUG: CFileCache::Open - opening using cache
22:14:28.881 T:547532828896 DEBUG: CurlFile::Open(0x7f6802a740) ftp://192.168.1.5:21/!!Music/Queen%20-%20You%27re%20My%20Best%20Friend%20(Remastered%202011).flac
22:14:28.882 T:547532828896 INFO: easy_aquire - Created session to ftp://192.168.1.5
22:14:29.111 T:545049833696 DEBUG: Thread FileCache start, auto delete: false
22:14:29.113 T:547532828896 DEBUG: Open - probing detected format [flac]
22:14:29.369 T:547532828896 DEBUG: Open - avformat_find_stream_info starting
22:14:29.381 T:547532828896 DEBUG: Open - av_find_stream_info finished
22:14:29.382 T:547532828896 DEBUG: CDVDDemuxFFmpeg::AddStream ID: 0
22:14:29.382 T:547532828896 DEBUG: CDVDDemuxFFmpeg::AddStream ID: 1
22:14:29.383 T:547532828896 DEBUG: FactoryCodec - Audio: passthrough - Opening
22:14:29.383 T:547532828896 DEBUG: FactoryCodec - Audio: passthrough - Failed
22:14:29.383 T:547532828896 DEBUG: FactoryCodec - Audio: FFmpeg - Opening
22:14:29.383 T:547532828896 DEBUG: FactoryCodec - Audio: FFmpeg - Opened
22:14:29.448 T:547532828896 DEBUG: CFileCache::Open - opening using cache
22:14:29.449 T:547532828896 DEBUG: CurlFile::Open(0x7f68167bc0) ftp://192.168.1.5:21/!!Music/Queen%20-%20You%27re%20My%20Best%20Friend%20(Remastered%202011).flac
22:14:29.449 T:547532828896 INFO: easy_aquire - Created session to ftp://192.168.1.5
22:14:29.461 T:545804775648 DEBUG: Thread FileCache start, auto delete: false
22:14:29.461 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 67467850
22:14:29.489 T:547532828896 DEBUG: Seek - waiting for position 67533258.
22:14:29.504 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 67467850
22:14:29.520 T:547532828896 DEBUG: Seek - waiting for position 67533261.
22:14:29.522 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 4
22:14:29.547 T:545804775648 DEBUG: Thread FileCache 545804775648 terminating
22:14:29.551 T:545049833696 DEBUG: CurlFile::CReadState::Connect - Resume from position 67467850
22:14:29.563 T:547532828896 DEBUG: Seek - waiting for position 67532361.
22:14:29.566 T:545049833696 INFO: CFileCache::Process - Source read didn't return any data! Hit eof(?)
22:14:29.616 T:545049833696 DEBUG: CurlFile::CReadState::Connect - Resume from position 390939
22:14:29.640 T:545049833696 DEBUG: CurlFile::CReadState::Connect - Resume from position 390552
22:14:29.660 T:545049833696 DEBUG: CurlFile::CReadState::Connect - Resume from position 390551
22:14:29.672 T:547532828896 DEBUG: SeekTime - seek ended up on time 0
22:14:29.855 T:547532828896 DEBUG: Previous line repeats 1 times.
22:14:29.855 T:547532828896 INFO: AudioDecoder: File is queued
22:14:29.856 T:547532828896 DEBUG: AudioDecoder::GetReplayGain - Final Replaygain applied: 1.000000, Track/Album Gain 89.000000, Peak 1.000000
22:14:29.970 T:547524440288 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted
22:14:29.988 T:547532828896 INFO: PAPlayer::PrepareStream - Ready
22:14:33.833 T:545380045024 DEBUG: OnPlayBackStarted: play state was 2, starting 0
22:14:33.843 T:546686058720 DEBUG: CGUIInfoManager::SetCurrentSong(musicdb://songs/215.flac)
22:14:33.848 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnPlay from xbmc
22:14:33.848 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 1, from xbmc, message OnPlay
22:14:33.865 T:546686058720 DEBUG: This query part contains a like, we will double backslash in the next field: select idArtist from artist where artist.strArtist like '
22:14:33.907 T:546686058720 DEBUG: Loading additional tag info for file ftp://192.168.1.5:21/!!Music/Queen - You're My Best Friend (Remastered 2011).flac
22:14:33.910 T:546686058720 DEBUG: CFileCache::Open - opening using cache
22:14:33.911 T:546686058720 DEBUG: CurlFile::Open(0x7f38031940) ftp://192.168.1.5:21/!!Music/Queen%20-%20You%27re%20My%20Best%20Friend%20(Remastered%202011).flac
22:14:33.925 T:545804775648 DEBUG: Thread FileCache start, auto delete: false
22:14:33.926 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 67467850
22:14:33.930 T:547620995072 DEBUG: This query part contains a like, we will double backslash in the next field: select idArtist from artist where artist.strArtist like '
22:14:33.952 T:546686058720 DEBUG: Previous line repeats 1 times.
22:14:33.952 T:546686058720 DEBUG: Seek - waiting for position 67533258.
22:14:33.968 T:546694447328 DEBUG: DoWork - Saving file state for audio item musicdb://songs/22.m4a
22:14:33.969 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 67467850
22:14:33.983 T:546686058720 DEBUG: Seek - waiting for position 67533261.
22:14:33.986 T:545804775648 DEBUG: CurlFile::CReadState::Connect - Resume from position 4
22:14:33.987 T:546694447328 DEBUG: DoWork - Marking audio item musicdb://songs/22.m4a as listened
22:14:33.987 T:546694447328 DEBUG: Mysql execute: UPDATE song SET iTimesPlayed=iTimesPlayed+1, lastplayed=CURRENT_TIMESTAMP where idSong=22
22:14:33.987 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:14:34.017 T:545804775648 DEBUG: Thread FileCache 545804775648 terminating
22:14:34.043 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnUpdate from xbmc
22:14:34.044 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 32, from xbmc, message OnUpdate
22:14:34.076 T:546686058720 ERROR: CCurlFile::Stat - Failed: FTP: couldn't retrieve (RETR failed) the specified file(19) for ftp://192.168.1.5:21/!!Music/cdart.png
22:14:34.076 T:546686058720 DEBUG: GetImageHash - unable to stat url ftp://192.168.1.5:21/!!Music/cdart.png
22:14:34.082 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:14:34.284 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:14:34.336 T:545363267808 DEBUG: DoWork - took 207 ms to load special://masterprofile/Thumbnails/5/516cdc14.jpg
22:14:34.872 T:545804775648 DEBUG: CWebServer[8080]: request received for /jsonrpc?Application.GetProperties
22:14:34.880 T:545804775648 DEBUG: Previous line repeats 3 times.
22:14:34.880 T:545804775648 DEBUG: CWebServer[8080]: request received for /jsonrpc?Player.GetActivePlayers
22:14:34.891 T:545021653216 DEBUG: Previous line repeats 3 times.
22:14:34.891 T:545021653216 DEBUG: CWebServer[8080]: request received for /jsonrpc?Base
22:14:35.082 T:545574551776 DEBUG: Previous line repeats 3 times.
22:14:35.082 T:545574551776 DEBUG: CWebServer[8080]: request received for /image/image%3A%2F%2Fmusic%40ftp%253a%252f%252f192.168.1.5%253a21%252f!!Music%252fQueen%2520-%2520Another%2520One%2520Bites%2520the%2520Dust%2520(Remastered%25202011).flac%2F
22:14:41.821 T:545380045024 INFO: PAPlayer::ProcessStream - Stream Finished
22:14:41.822 T:545032007904 DEBUG: Thread FileCache 545032007904 terminating
22:14:42.238 T:547524440288 DEBUG: CActiveAE::DiscardStream - audio stream deleted
22:14:42.238 T:547524440288 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted
22:14:42.238 T:545380045024 DEBUG: Previous line repeats 2 times.
22:14:42.238 T:545380045024 DEBUG: PAPlayer::ProcessStreams - Stream Freed
22:14:54.763 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:14:54.814 T:546694447328 DEBUG: DoWork - took 169 ms to load special://masterprofile/Thumbnails/6/61f64e4c.jpg
22:15:01.645 T:547620995072 DEBUG: LIRC: Update - NEW at 1182059:69 0 KEY_LEFT devinput (KEY_LEFT)
22:15:01.645 T:547620995072 DEBUG: OnKey: 169 (0xa9, obc86) pressed, action is Left
22:15:04.545 T:547620995072 INFO: CheckIdle - Closing session to ftp://192.168.1.5 (easy=0x7f682cb730, multi=0x7f682d45a0)
22:15:12.012 T:547620995072 INFO: CheckIdle - Closing session to ftp://192.168.1.5 (easy=0x7f68188ac0, multi=0x7f68071cc0)
22:15:15.244 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:15:15.291 T:547532828896 DEBUG: DoWork - took 143 ms to load special://masterprofile/Thumbnails/8/8ddeb424.jpg
22:15:35.830 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:15:35.878 T:545363267808 DEBUG: DoWork - took 229 ms to load special://masterprofile/Thumbnails/0/01f4225e.jpg
22:15:40.140 T:546722762976 DEBUG: RunQuery took 167 ms for 592 items query: select * from movie_view WHERE ((movie_view.playCount IS NULL OR movie_view.playCount < 1))
22:15:41.493 T:546722762976 DEBUG: RunQuery took 823 ms for 8250 items query: select * from episode_view WHERE ((episode_view.playCount IS NULL OR episode_view.playCount < 1))
22:15:42.319 T:546722762976 DEBUG: GetSongsFullByWhere query = SELECT sv.*, songartistview.* FROM (SELECT songview.* FROM songview WHERE ((CAST(songview.iTimesPlayed as DECIMAL(5,1)) < 1)) ORDER BY RAND() LIMIT 20) AS sv JOIN songartistview ON songartistview.idsong = sv.idsong ORDER BY songartistview.idsong, songartistview.idRole, songartistview.iOrder
22:15:42.349 T:546722762976 DEBUG: GetSongsFullByWhere() - took 46 ms
22:15:42.632 T:546722762976 DEBUG: GetAlbumsByWhere query: SELECT albumview.*, albumartistview.* FROM albumview JOIN albumartistview ON albumartistview.idalbum = albumview.idalbum WHERE albumview.strReleaseType = 'album'
22:15:42.675 T:546722762976 DEBUG: GetAlbumsByWhere - query took 43 ms
22:15:42.947 T:546722762976 DEBUG: RunQuery took 3 ms for 0 items query: select * from musicvideo_view WHERE ((musicvideo_view.playCount IS NULL OR musicvideo_view.playCount < 1))
22:15:56.589 T:546694447328 DEBUG: Caching image '/storage/pictures/backgrounds/262317760996784502image_fullscreen_001_landscape.jpg' to '0/0d7199bc.jpg':
22:15:56.590 T:546694447328 DEBUG: cached image 'special://masterprofile/Thumbnails/0/0d7199bc.jpg' size 1920x1080
22:16:16.727 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:16:37.374 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:16:37.424 T:546686058720 DEBUG: DoWork - took 222 ms to load special://masterprofile/Thumbnails/c/cb4616c0.jpg
22:16:41.716 T:545049833696 INFO: CFileCache::Process - Source read didn't return any data! Hit eof(?)
22:16:58.279 T:546694447328 DEBUG: Caching image '/storage/pictures/backgrounds/ffffffff-e68c-0a8e-ffff-ffffd4debf49.0.jpg' to 'b/b54d4f40.jpg':
22:16:59.027 T:546694447328 DEBUG: cached image 'special://masterprofile/Thumbnails/b/b54d4f40.jpg' size 1920x1080
22:17:13.366 T:545380045024 DEBUG: OnQueueNextItem: play state was 2, starting 0
22:17:13.440 T:547532828896 DEBUG: CFileCache::Open - opening using cache
22:17:13.440 T:547532828896 DEBUG: CurlFile::Open(0x7f68014470) ftp://192.168.1.5:21/!!Music/Carly%20Simon%20-%20You%27re%20So%20Vain.mp3
22:17:13.441 T:547532828896 INFO: easy_aquire - Created session to ftp://192.168.1.5
22:17:13.683 T:546677670112 DEBUG: Thread FileCache start, auto delete: false
22:17:13.690 T:547532828896 DEBUG: Open - probing detected format [mp3]
22:17:13.690 T:547532828896 DEBUG: Open - setting usetoc to 0 for accurate VBR MP3 seek
22:17:13.691 T:547532828896 DEBUG: Open - avformat_find_stream_info starting
22:17:13.894 T:547532828896 DEBUG: Open - av_find_stream_info finished
22:17:13.895 T:547532828896 DEBUG: CDVDDemuxFFmpeg::AddStream ID: 0
22:17:13.895 T:547532828896 DEBUG: FactoryCodec - Audio: passthrough - Opening
22:17:13.895 T:547532828896 DEBUG: FactoryCodec - Audio: passthrough - Failed
22:17:13.895 T:547532828896 DEBUG: FactoryCodec - Audio: FFmpeg - Opening
22:17:13.895 T:547532828896 DEBUG: FactoryCodec - Audio: FFmpeg - Opened
22:17:13.969 T:547532828896 DEBUG: CFileCache::Open - opening using cache
22:17:13.970 T:547532828896 DEBUG: CurlFile::Open(0x7f6827dc10) ftp://192.168.1.5:21/!!Music/Carly%20Simon%20-%20You%27re%20So%20Vain.mp3
22:17:13.971 T:547532828896 INFO: easy_aquire - Created session to ftp://192.168.1.5
22:17:13.994 T:545032007904 DEBUG: Thread FileCache start, auto delete: false
22:17:13.995 T:545032007904 DEBUG: CurlFile::CReadState::Connect - Resume from position 10356371
22:17:14.033 T:547532828896 DEBUG: Seek - waiting for position 10421779.
22:17:14.036 T:545032007904 DEBUG: CurlFile::CReadState::Connect - Resume from position 2058
22:17:14.059 T:545032007904 DEBUG: Thread FileCache 545032007904 terminating
22:17:14.060 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [mp3] Could not update timestamps for skipped samples.
22:17:14.060 T:547532828896 DEBUG: SeekTime - seek ended up on time 0
22:17:14.061 T:547532828896 DEBUG: Previous line repeats 1 times.
22:17:14.061 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [mp3] Could not update timestamps for skipped samples.
22:17:14.164 T:547532828896 INFO: AudioDecoder: File is queued
22:17:14.172 T:547532828896 DEBUG: AudioDecoder::GetReplayGain - Final Replaygain applied: 1.000000, Track/Album Gain 89.000000, Peak 1.000000
22:17:14.199 T:547516051680 INFO: CActiveAESink::OpenSink - initialize sink
22:17:14.385 T:547516051680 DEBUG: CActiveAESink::OpenSink - trying to open device ALSA:hdmi:CARD=AMLM8AUDIO,DEV=0
22:17:14.385 T:547516051680 INFO: CAESinkALSA::Initialize - Attempting to open device "default"
22:17:14.391 T:547516051680 INFO: CAESinkALSA::Initialize - Opened device "default"
22:17:14.392 T:547516051680 INFO: CAESinkALSA::InitializeHW - Your hardware does not support AE_FMT_FLOAT, trying other formats
22:17:14.392 T:547516051680 INFO: CAESinkALSA::InitializeHW - Using data format AE_FMT_S32NE
22:17:14.392 T:547516051680 DEBUG: CAESinkALSA::InitializeHW - Request: periodSize 4800, bufferSize 19200
22:17:14.392 T:547516051680 DEBUG: CAESinkALSA::InitializeHW - Got: periodSize 256, bufferSize 19200
22:17:14.392 T:547516051680 DEBUG: CAESinkALSA::InitializeHW - Setting timeout to 200 ms
22:17:14.392 T:547516051680 DEBUG: CAESinkALSA::GetChannelLayout - Input Channel Count: 2 Output Channel Count: 2
22:17:14.392 T:547516051680 DEBUG: CAESinkALSA::GetChannelLayout - Requested Layout: FL,FR
22:17:14.392 T:547516051680 DEBUG: CAESinkALSA::GetChannelLayout - Got Layout: FL,FR (ALSA: none)
22:17:14.393 T:547516051680 DEBUG: CActiveAESink::OpenSink - ALSA Initialized:
22:17:14.393 T:547516051680 DEBUG: Output Device : AML-M8AUDIO
22:17:14.393 T:547516051680 DEBUG: Sample Rate : 96000
22:17:14.393 T:547516051680 DEBUG: Sample Format : AE_FMT_S32NE
22:17:14.393 T:547516051680 DEBUG: Channel Count : 2
22:17:14.393 T:547516051680 DEBUG: Channel Layout: FL,FR
22:17:14.393 T:547516051680 DEBUG: Frames : 256
22:17:14.393 T:547516051680 DEBUG: Frame Size : 8
22:17:14.546 T:547524440288 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted
22:17:14.777 T:547532828896 DEBUG: Previous line repeats 3 times.
22:17:14.777 T:547532828896 INFO: PAPlayer::PrepareStream - Ready
22:17:18.186 T:545380045024 DEBUG: OnPlayBackStarted: play state was 2, starting 0
22:17:18.189 T:546686058720 DEBUG: CGUIInfoManager::SetCurrentSong(musicdb://songs/30.mp3)
22:17:18.194 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnPlay from xbmc
22:17:18.194 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 1, from xbmc, message OnPlay
22:17:18.211 T:546686058720 DEBUG: This query part contains a like, we will double backslash in the next field: select idArtist from artist where artist.strArtist like '
22:17:18.236 T:546686058720 DEBUG: Previous line repeats 1 times.
22:17:18.236 T:546686058720 DEBUG: Loading additional tag info for file ftp://192.168.1.5:21/!!Music/Carly Simon - You're So Vain.mp3
22:17:18.239 T:546686058720 DEBUG: CFileCache::Open - opening using cache
22:17:18.240 T:546686058720 DEBUG: CurlFile::Open(0x7f38032290) ftp://192.168.1.5:21/!!Music/Carly%20Simon%20-%20You%27re%20So%20Vain.mp3
22:17:18.246 T:547620995072 DEBUG: This query part contains a like, we will double backslash in the next field: select idArtist from artist where artist.strArtist like '
22:17:18.260 T:545032007904 DEBUG: Previous line repeats 1 times.
22:17:18.260 T:545032007904 DEBUG: Thread FileCache start, auto delete: false
22:17:18.266 T:545032007904 DEBUG: CurlFile::CReadState::Connect - Resume from position 10356371
22:17:18.281 T:546686058720 DEBUG: Seek - waiting for position 10421779.
22:17:18.285 T:545032007904 DEBUG: CurlFile::CReadState::Connect - Resume from position 2058
22:17:18.300 T:546694447328 DEBUG: DoWork - Saving file state for audio item musicdb://songs/215.flac
22:17:18.312 T:545032007904 DEBUG: Thread FileCache 545032007904 terminating
22:17:18.317 T:546694447328 DEBUG: DoWork - Marking audio item musicdb://songs/215.flac as listened
22:17:18.317 T:546694447328 DEBUG: Mysql execute: UPDATE song SET iTimesPlayed=iTimesPlayed+1, lastplayed=CURRENT_TIMESTAMP where idSong=215
22:17:18.370 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:17:18.379 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnUpdate from xbmc
22:17:18.379 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 32, from xbmc, message OnUpdate
22:17:18.502 T:545363267808 DEBUG: DoWork - took 233 ms to load special://masterprofile/Thumbnails/1/19722234.jpg
22:17:18.504 T:546686058720 ERROR: CCurlFile::Stat - Failed: FTP: couldn't retrieve (RETR failed) the specified file(19) for ftp://192.168.1.5:21/!!Music/cdart.png
22:17:18.504 T:546686058720 DEBUG: GetImageHash - unable to stat url ftp://192.168.1.5:21/!!Music/cdart.png
22:17:18.646 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:17:18.761 T:546694447328 DEBUG: DoWork - took 342 ms to load special://masterprofile/Thumbnails/1/19722234.jpg
22:17:19.174 T:547532828896 DEBUG: Caching image '/storage/pictures/backgrounds/ffffffff-a518-3180-ffff-ffff936ae63b.0.jpg' to '4/4c7c4fcc.jpg':
22:17:19.214 T:545032007904 DEBUG: CWebServer[8080]: request received for /jsonrpc?Application.GetProperties
22:17:19.229 T:545032007904 DEBUG: Previous line repeats 3 times.
22:17:19.229 T:545032007904 DEBUG: CWebServer[8080]: request received for /jsonrpc?Player.GetActivePlayers
22:17:19.239 T:545804775648 DEBUG: Previous line repeats 2 times.
22:17:19.239 T:545804775648 DEBUG: CWebServer[8080]: request received for /jsonrpc?Base
22:17:19.241 T:545338257632 DEBUG: CWebServer[8080]: request received for /jsonrpc?Player.GetActivePlayers
22:17:19.241 T:545021653216 DEBUG: CWebServer[8080]: request received for /jsonrpc?Base
22:17:19.481 T:545338257632 DEBUG: Previous line repeats 2 times.
22:17:19.482 T:545338257632 DEBUG: CWebServer[8080]: request received for /image/image%3A%2F%2FDefaultAlbumCover.png%2F
22:17:20.088 T:547532828896 DEBUG: Previous line repeats 1 times.
22:17:20.088 T:547532828896 DEBUG: cached image 'special://masterprofile/Thumbnails/4/4c7c4fcc.jpg' size 1920x1080
22:17:26.193 T:545049833696 DEBUG: Thread FileCache 545049833696 terminating
22:17:26.665 T:547524440288 DEBUG: CActiveAE::DiscardStream - audio stream deleted
22:17:26.665 T:547524440288 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted
22:17:26.666 T:545380045024 DEBUG: Previous line repeats 2 times.
22:17:26.666 T:545380045024 DEBUG: PAPlayer::ProcessStreams - Stream Freed
22:17:39.126 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:17:39.175 T:546686058720 DEBUG: DoWork - took 151 ms to load special://masterprofile/Thumbnails/0/046bf683.jpg
22:17:48.857 T:547620995072 INFO: CheckIdle - Closing session to ftp://192.168.1.5 (easy=0x7f68153b90, multi=0x7f68280fa0)
22:17:56.290 T:547620995072 INFO: CheckIdle - Closing session to ftp://192.168.1.5 (easy=0x7f6803ce90, multi=0x7f68180a00)
22:18:00.117 T:546694447328 DEBUG: Caching image '/storage/pictures/backgrounds/00000000-432c-a01e-0000-0000317f54d9.0.jpg' to 'a/aeaa9479.jpg':
22:18:00.935 T:546694447328 DEBUG: cached image 'special://masterprofile/Thumbnails/a/aeaa9479.jpg' size 1920x1080
22:18:20.352 T:547532828896 DEBUG: Caching image '/storage/pictures/backgrounds/211498556793023908evergreen_46301424_500kb_1920x1080.jpg' to '8/8d84d5a8.jpg':
22:18:20.352 T:547532828896 DEBUG: cached image 'special://masterprofile/Thumbnails/8/8d84d5a8.jpg' size 1920x1080
22:18:20.497 T:546677670112 INFO: CFileCache::Process - Source read didn't return any data! Hit eof(?)
22:18:40.654 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:18:40.705 T:546686058720 DEBUG: DoWork - took 179 ms to load special://masterprofile/Thumbnails/e/e3768801.jpg
22:19:01.506 T:546694447328 DEBUG: Caching image '/storage/pictures/backgrounds/ffffffff-e0b0-75a0-ffff-ffffcf032a5b.0.jpg' to '4/49aed0b4.jpg':
22:19:02.287 T:546694447328 DEBUG: cached image 'special://masterprofile/Thumbnails/4/49aed0b4.jpg' size 1920x1080
22:19:21.757 T:547532828896 DEBUG: ffmpeg[7F7B7FF0E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:19:21.808 T:547532828896 DEBUG: DoWork - took 190 ms to load special://masterprofile/Thumbnails/1/1ecf5bb1.jpg
22:19:42.265 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:19:42.317 T:546686058720 DEBUG: DoWork - took 187 ms to load special://masterprofile/Thumbnails/3/31d478ef.jpg
22:20:02.721 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:20:02.790 T:545363267808 DEBUG: DoWork - took 160 ms to load special://masterprofile/Thumbnails/a/a0e22668.jpg
22:20:23.250 T:546694447328 DEBUG: ffmpeg[7F498740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:20:23.296 T:546694447328 DEBUG: DoWork - took 158 ms to load special://masterprofile/Thumbnails/d/d463064b.jpg
22:20:43.791 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:20:43.837 T:546686058720 DEBUG: DoWork - took 172 ms to load special://masterprofile/Thumbnails/0/0374a96a.jpg
22:21:04.321 T:545363267808 DEBUG: ffmpeg[7EFA2F10E0]: [swscaler] No accelerated colorspace conversion found from yuv420p to bgra.
22:21:04.371 T:545363267808 DEBUG: DoWork - took 206 ms to load special://masterprofile/Thumbnails/4/4b067fa0.jpg
22:21:25.116 T:547532828896 DEBUG: Caching image '/storage/pictures/backgrounds/240066424703324053image_fullscreen_001_landscape.jpg' to '8/854931a9.jpg':
22:21:25.116 T:547532828896 DEBUG: cached image 'special://masterprofile/Thumbnails/8/854931a9.jpg' size 1920x1080
22:21:25.244 T:545380045024 DEBUG: OnQueueNextItem: play state was 2, starting 0
22:21:25.324 T:546686058720 DEBUG: CFileCache::Open - opening using cache
22:21:25.324 T:546686058720 DEBUG: CurlFile::Open(0x7f38164c30) ftp://192.168.1.5:21/!!Music/Chicago%20-%20You%27re%20the%20Inspiration.mp3
22:21:25.325 T:546686058720 INFO: easy_aquire - Created session to ftp://192.168.1.5
22:21:25.561 T:545049833696 DEBUG: Thread FileCache start, auto delete: false
22:21:25.570 T:546686058720 DEBUG: Open - probing detected format [mp3]
22:21:25.570 T:546686058720 DEBUG: Open - setting usetoc to 0 for accurate VBR MP3 seek
22:21:25.571 T:546686058720 DEBUG: Open - avformat_find_stream_info starting
22:21:25.800 T:546686058720 DEBUG: Open - av_find_stream_info finished
22:21:25.801 T:546686058720 DEBUG: CDVDDemuxFFmpeg::AddStream ID: 0
22:21:25.801 T:546686058720 DEBUG: FactoryCodec - Audio: passthrough - Opening
22:21:25.801 T:546686058720 DEBUG: FactoryCodec - Audio: passthrough - Failed
22:21:25.801 T:546686058720 DEBUG: FactoryCodec - Audio: FFmpeg - Opening
22:21:25.801 T:546686058720 DEBUG: FactoryCodec - Audio: FFmpeg - Opened
22:21:25.870 T:546686058720 DEBUG: CFileCache::Open - opening using cache
22:21:25.871 T:546686058720 DEBUG: CurlFile::Open(0x7f381234a0) ftp://192.168.1.5:21/!!Music/Chicago%20-%20You%27re%20the%20Inspiration.mp3
22:21:25.871 T:546686058720 INFO: easy_aquire - Created session to ftp://192.168.1.5
22:21:25.898 T:545574551776 DEBUG: Thread FileCache start, auto delete: false
22:21:25.901 T:545574551776 DEBUG: CurlFile::CReadState::Connect - Resume from position 9056518
22:21:25.926 T:546686058720 DEBUG: Seek - waiting for position 9121926.
22:21:25.932 T:545574551776 INFO: CFileCache::Process - Source read didn't return any data! Hit eof(?)
22:21:25.933 T:545574551776 DEBUG: CurlFile::CReadState::Connect - Resume from position 2058
22:21:25.963 T:545574551776 DEBUG: Thread FileCache 545574551776 terminating
22:21:25.964 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [mp3] Could not update timestamps for skipped samples.
22:21:25.965 T:546686058720 DEBUG: SeekTime - seek ended up on time 0
22:21:25.965 T:546686058720 DEBUG: Previous line repeats 1 times.
22:21:25.965 T:546686058720 DEBUG: ffmpeg[7F490740E0]: [mp3] Could not update timestamps for skipped samples.
22:21:26.073 T:546686058720 INFO: AudioDecoder: File is queued
22:21:26.076 T:546686058720 DEBUG: AudioDecoder::GetReplayGain - Final Replaygain applied: 1.000000, Track/Album Gain 89.000000, Peak 1.000000
22:21:26.078 T:547516051680 INFO: CActiveAESink::OpenSink - initialize sink
22:21:26.278 T:547516051680 DEBUG: CActiveAESink::OpenSink - trying to open device ALSA:hdmi:CARD=AMLM8AUDIO,DEV=0
22:21:26.278 T:547516051680 INFO: CAESinkALSA::Initialize - Attempting to open device "default"
22:21:26.282 T:547516051680 INFO: CAESinkALSA::Initialize - Opened device "default"
22:21:26.283 T:547516051680 INFO: CAESinkALSA::InitializeHW - Your hardware does not support AE_FMT_FLOAT, trying other formats
22:21:26.283 T:547516051680 INFO: CAESinkALSA::InitializeHW - Using data format AE_FMT_S32NE
22:21:26.283 T:547516051680 DEBUG: CAESinkALSA::InitializeHW - Request: periodSize 2205, bufferSize 8820
22:21:26.283 T:547516051680 DEBUG: CAESinkALSA::InitializeHW - Got: periodSize 2048, bufferSize 8192
22:21:26.283 T:547516051680 DEBUG: CAESinkALSA::InitializeHW - Setting timeout to 186 ms
22:21:26.284 T:547516051680 DEBUG: CAESinkALSA::GetChannelLayout - Input Channel Count: 2 Output Channel Count: 2
22:21:26.284 T:547516051680 DEBUG: CAESinkALSA::GetChannelLayout - Requested Layout: FL,FR
22:21:26.284 T:547516051680 DEBUG: CAESinkALSA::GetChannelLayout - Got Layout: FL,FR (ALSA: none)
22:21:26.284 T:547516051680 DEBUG: CActiveAESink::OpenSink - ALSA Initialized:
22:21:26.284 T:547516051680 DEBUG: Output Device : AML-M8AUDIO
22:21:26.284 T:547516051680 DEBUG: Sample Rate : 44100
22:21:26.284 T:547516051680 DEBUG: Sample Format : AE_FMT_S32NE
22:21:26.284 T:547516051680 DEBUG: Channel Count : 2
22:21:26.284 T:547516051680 DEBUG: Channel Layout: FL,FR
22:21:26.284 T:547516051680 DEBUG: Frames : 2048
22:21:26.284 T:547516051680 DEBUG: Frame Size : 8
22:21:26.320 T:547524440288 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted
22:21:26.394 T:546686058720 DEBUG: Previous line repeats 3 times.
22:21:26.394 T:546686058720 INFO: PAPlayer::PrepareStream - Ready
22:21:29.964 T:545380045024 DEBUG: OnPlayBackStarted: play state was 2, starting 0
22:21:29.966 T:545363267808 DEBUG: CGUIInfoManager::SetCurrentSong(musicdb://songs/39.mp3)
22:21:29.968 T:547620983008 DEBUG: CAnnouncementManager - Announcement: OnPlay from xbmc
22:21:29.968 T:547620983008 DEBUG: GOT ANNOUNCEMENT, type: 1, from xbmc, message OnPlay
22:21:29.982 T:545574551776 DEBUG: CWebServer[8080]: request received for /image/image%3A%2F%2FDefaultAlbumCover.png%2F
22:21:29.989 T:545363267808 DEBUG: This query part contains a like, we will double backslash in the next field: select idArtist from artist where artist.strArtist like '