14:16:04 T:140001377232960 NOTICE: special://profile/ is mapped to: special://masterprofile/ 14:16:04 T:140001377232960 NOTICE: ----------------------------------------------------------------------- 14:16:04 T:140001377232960 NOTICE: Starting Kodi (16.1 Git:c327c53). Platform: Linux x86 64-bit 14:16:04 T:140001377232960 NOTICE: Using Release Kodi x64 build 14:16:04 T:140001377232960 NOTICE: Kodi compiled Jun 22 2016 by GCC 5.3.0 for Linux x86 64-bit version 4.4.13 (263181) 14:16:04 T:140001377232960 NOTICE: Running on LibreELEC (official) - Version: 7.0.2, kernel: Linux x86 64-bit version 4.4.13 14:16:04 T:140001377232960 NOTICE: FFmpeg version: 2.8.6 14:16:04 T:140001377232960 NOTICE: WARNING: unsupported ffmpeg version detected 14:16:04 T:140001377232960 NOTICE: Host CPU: AMD A4-3400 APU with Radeon(tm) HD Graphics, 2 cores available 14:16:04 T:140001377232960 NOTICE: special://xbmc/ is mapped to: /usr/share/kodi 14:16:04 T:140001377232960 NOTICE: special://xbmcbin/ is mapped to: /usr/lib/kodi 14:16:04 T:140001377232960 NOTICE: special://masterprofile/ is mapped to: /storage/.kodi/userdata 14:16:04 T:140001377232960 NOTICE: special://home/ is mapped to: /storage/.kodi 14:16:04 T:140001377232960 NOTICE: special://temp/ is mapped to: /storage/.kodi/temp 14:16:04 T:140001377232960 NOTICE: The executable running is: /usr/lib/kodi/kodi.bin 14:16:04 T:140001377232960 NOTICE: Local hostname: htpc 14:16:04 T:140001377232960 NOTICE: Log File is located: /storage/.kodi/temp/kodi.log 14:16:04 T:140001377232960 NOTICE: ----------------------------------------------------------------------- 14:16:04 T:140001377232960 ERROR: DBus: Error org.freedesktop.DBus.Error.ServiceUnknown - The name org.freedesktop.UPower was not provided by any .service files 14:16:04 T:140001377232960 NOTICE: load settings... 14:16:04 T:140001377232960 NOTICE: Found 2 Lists of Devices 14:16:04 T:140001377232960 NOTICE: Enumerated ALSA devices: 14:16:04 T:140001377232960 NOTICE: Device 1 14:16:04 T:140001377232960 NOTICE: m_deviceName : @ 14:16:04 T:140001377232960 NOTICE: m_displayName : Default (HD-Audio Generic ALC889 Analog) 14:16:04 T:140001377232960 NOTICE: m_displayNameExtra: 14:16:04 T:140001377232960 NOTICE: m_deviceType : AE_DEVTYPE_PCM 14:16:04 T:140001377232960 NOTICE: m_channels : FL,FR,BL,BR,FC,LFE,SL,SR 14:16:04 T:140001377232960 NOTICE: m_sampleRates : 48000 14:16:04 T:140001377232960 NOTICE: m_dataFormats : AE_FMT_S32NE 14:16:04 T:140001377232960 NOTICE: Device 2 14:16:04 T:140001377232960 NOTICE: m_deviceName : @:CARD=Generic,DEV=0 14:16:04 T:140001377232960 NOTICE: m_displayName : HD-Audio Generic (@:CARD=Generic,DEV=0) 14:16:04 T:140001377232960 NOTICE: m_displayNameExtra: ALC889 Analog 14:16:04 T:140001377232960 NOTICE: m_deviceType : AE_DEVTYPE_PCM 14:16:04 T:140001377232960 NOTICE: m_channels : FL,FR,BL,BR,FC,LFE,SL,SR 14:16:04 T:140001377232960 NOTICE: m_sampleRates : 48000 14:16:04 T:140001377232960 NOTICE: m_dataFormats : AE_FMT_S32NE 14:16:04 T:140001377232960 NOTICE: Device 3 14:16:04 T:140001377232960 NOTICE: m_deviceName : surround21:CARD=Generic,DEV=0 14:16:04 T:140001377232960 NOTICE: m_displayName : HD-Audio Generic (surround21:CARD=Generic,DEV=0) 14:16:04 T:140001377232960 NOTICE: m_displayNameExtra: ALC889 Analog 14:16:04 T:140001377232960 NOTICE: m_deviceType : AE_DEVTYPE_PCM 14:16:04 T:140001377232960 NOTICE: m_channels : FL,FR,BL,BR,FC,LFE,SL,SR,UNKNOWN1,UNKNOWN2,UNKNOWN3,UNKNOWN4,UNKNOWN5,UNKNOWN6,UNKNOWN7,UNKNOWN8 14:16:04 T:140001377232960 NOTICE: m_sampleRates : 44100,48000,88200,96000,192000 14:16:04 T:140001377232960 NOTICE: m_dataFormats : AE_FMT_S32NE,AE_FMT_S16NE,AE_FMT_S16LE 14:16:04 T:140001377232960 NOTICE: Device 4 14:16:04 T:140001377232960 NOTICE: m_deviceName : iec958:CARD=Generic,DEV=0 14:16:04 T:140001377232960 NOTICE: m_displayName : HD-Audio Generic 14:16:04 T:140001377232960 NOTICE: m_displayNameExtra: ALC889 Digital S/PDIF 14:16:04 T:140001377232960 NOTICE: m_deviceType : AE_DEVTYPE_IEC958 14:16:04 T:140001377232960 NOTICE: m_channels : FL,FR 14:16:04 T:140001377232960 NOTICE: m_sampleRates : 32000,44100,48000,88200,96000,192000 14:16:04 T:140001377232960 NOTICE: m_dataFormats : AE_FMT_AC3,AE_FMT_DTS,AE_FMT_S32NE,AE_FMT_S16NE,AE_FMT_S16LE 14:16:04 T:140001377232960 NOTICE: Device 5 14:16:04 T:140001377232960 NOTICE: m_deviceName : hdmi:CARD=HDMI,DEV=0 14:16:04 T:140001377232960 NOTICE: m_displayName : HDA ATI 14:16:04 T:140001377232960 NOTICE: m_displayNameExtra: @@@ 14:16:04 T:140001377232960 NOTICE: m_deviceType : AE_DEVTYPE_HDMI 14:16:04 T:140001377232960 NOTICE: m_channels : FL,FR,LFE,FC,BL,BR,BLOC,BROC 14:16:04 T:140001377232960 NOTICE: m_sampleRates : 32000,44100,48000,88200,96000,176400,192000 14:16:04 T:140001377232960 NOTICE: m_dataFormats : AE_FMT_LPCM,AE_FMT_AC3,AE_FMT_DTS,AE_FMT_EAC3,AE_FMT_DTSHD,AE_FMT_TRUEHD,AE_FMT_S32NE,AE_FMT_S16NE,AE_FMT_S16LE,AE_FMT_AAC 14:16:04 T:140001377232960 NOTICE: Enumerated PULSE devices: 14:16:04 T:140001377232960 NOTICE: Device 1 14:16:04 T:140001377232960 NOTICE: m_deviceName : Default 14:16:04 T:140001377232960 NOTICE: m_displayName : Default 14:16:04 T:140001377232960 NOTICE: m_displayNameExtra: Bluetooth Audio (PULSEAUDIO) 14:16:04 T:140001377232960 NOTICE: m_deviceType : AE_DEVTYPE_PCM 14:16:04 T:140001377232960 NOTICE: m_channels : FL,FR 14:16:04 T:140001377232960 NOTICE: m_sampleRates : 5512,8000,11025,16000,22050,32000,44100,48000,64000,88200,96000,176400,192000,384000 14:16:04 T:140001377232960 NOTICE: m_dataFormats : AE_FMT_U8,AE_FMT_S16NE,AE_FMT_S24NE3,AE_FMT_S24NE4,AE_FMT_S32NE,AE_FMT_FLOAT 14:16:04 T:140001377232960 NOTICE: Loaded settings file from special://xbmc/system/advancedsettings.xml 14:16:04 T:140001377232960 NOTICE: Contents of special://xbmc/system/advancedsettings.xml are... false cputemp gputemp 30 4.0 14:16:04 T:140001377232960 NOTICE: Loaded settings file from special://profile/advancedsettings.xml 14:16:04 T:140001377232960 NOTICE: Contents of special://profile/advancedsettings.xml are... mysql 192.168.178.17 3306 kodi kodi mysql 192.168.178.17 3306 kodi kodi special://masterprofile/favourites.xml smb://192.168.178.17/data/kodi/path/favourites.xml special://masterprofile/sources.xml smb://192.168.178.17/data/kodi/path/sources.xml special://masterprofile/playlists smb://192.168.178.17/data/kodi/path/playlists 80 true 0 true 80 14:16:04 T:140001377232960 WARNING: VIDEO database configuration is experimental. 14:16:04 T:140001377232960 NOTICE: Default DVD Player: dvdplayer 14:16:04 T:140001377232960 NOTICE: Default Video Player: dvdplayer 14:16:04 T:140001377232960 NOTICE: Default Audio Player: paplayer 14:16:04 T:140001377232960 NOTICE: Disabled debug logging due to GUI setting. Level 0. 14:16:04 T:140001377232960 NOTICE: Log level changed to "LOG_LEVEL_NORMAL" 14:16:08 T:140001377232960 NOTICE: CMediaSourceSettings: loading media sources from special://masterprofile/sources.xml 14:16:08 T:140001377232960 NOTICE: Loading player core factory settings from special://xbmc/system/playercorefactory.xml. 14:16:08 T:140001377232960 NOTICE: Loaded playercorefactory configuration 14:16:08 T:140001377232960 NOTICE: Loading player core factory settings from special://masterprofile/playercorefactory.xml. 14:16:08 T:140001377232960 NOTICE: special://masterprofile/playercorefactory.xml does not exist. Skipping. 14:16:09 T:140001377232960 NOTICE: Running database version Addons20 14:16:09 T:140001377232960 NOTICE: ADDONS: Using repository repository.xbmc.org 14:16:09 T:140001377232960 NOTICE: ADDONS: Using repository repository.xbmcadult 14:16:09 T:140001377232960 NOTICE: ADDONS: Using repository repository.xxxadultxbmc 14:16:09 T:140001377232960 NOTICE: ADDONS: Using repository repository.kodinerds 14:16:09 T:140001377232960 NOTICE: ADDONS: Using repository repository.libreelec.tv 14:16:09 T:140001377232960 NOTICE: ADDONS: Using repository repository.lost-and-found 14:16:09 T:140001377232960 NOTICE: ADDONS: Using repository repository.whitecream 14:16:09 T:140001377232960 NOTICE: Setup SDL 14:16:09 T:140001377232960 NOTICE: Checking resolution 16 14:16:09 T:140001377232960 NOTICE: Using visual 0x2ea 14:16:09 T:140001377232960 NOTICE: GL_VENDOR = X.Org 14:16:09 T:140001377232960 NOTICE: GL_RENDERER = Gallium 0.4 on AMD CEDAR (DRM 2.43.0, LLVM 3.8.0) 14:16:09 T:140001377232960 NOTICE: GL_VERSION = 3.0 Mesa 11.2.0 14:16:09 T:140001377232960 NOTICE: GL_SHADING_LANGUAGE_VERSION = 1.30 14:16:09 T:140001377232960 NOTICE: GL_GPU_MEMORY_INFO_TOTAL_AVAILABLE_MEMORY_NVX = 2094968 14:16:09 T:140001377232960 NOTICE: GL_GPU_MEMORY_INFO_DEDICATED_VIDMEM_NVX = 1048576 14:16:09 T:140001377232960 NOTICE: GL_EXTENSIONS = GL_ARB_multisample GL_EXT_abgr GL_EXT_bgra GL_EXT_blend_color GL_EXT_blend_minmax GL_EXT_blend_subtract GL_EXT_copy_texture GL_EXT_polygon_offset GL_EXT_subtexture GL_EXT_texture_object GL_EXT_vertex_array GL_EXT_compiled_vertex_array GL_EXT_texture GL_EXT_texture3D GL_IBM_rasterpos_clip GL_ARB_point_parameters GL_EXT_draw_range_elements GL_EXT_packed_pixels GL_EXT_point_parameters GL_EXT_rescale_normal GL_EXT_separate_specular_color GL_EXT_texture_edge_clamp GL_SGIS_generate_mipmap GL_SGIS_texture_border_clamp GL_SGIS_texture_edge_clamp GL_SGIS_texture_lod GL_ARB_framebuffer_sRGB GL_ARB_multitexture GL_EXT_framebuffer_sRGB GL_IBM_multimode_draw_arrays GL_IBM_texture_mirrored_repeat GL_ARB_texture_cube_map GL_ARB_texture_env_add GL_ARB_transpose_matrix GL_EXT_blend_func_separate GL_EXT_fog_coord GL_EXT_multi_draw_arrays GL_EXT_secondary_color GL_EXT_texture_env_add GL_EXT_texture_filter_anisotropic GL_EXT_texture_lod_bias GL_INGR_blend_func_separate GL_NV_blend_square GL_NV_light_max_exponent GL_NV_texgen_reflection GL_NV_texture_env_combine4 GL_SUN_multi_draw_arrays GL_ARB_texture_border_clamp GL_ARB_texture_compression GL_EXT_framebuffer_object GL_EXT_texture_env_combine GL_EXT_texture_env_dot3 GL_MESA_window_pos GL_NV_packed_depth_stencil GL_NV_texture_rectangle GL_ARB_depth_texture GL_ARB_occlusion_query GL_ARB_shadow GL_ARB_texture_env_combine GL_ARB_texture_env_crossbar GL_ARB_texture_env_dot3 GL_ARB_texture_mirrored_repeat GL_ARB_window_pos GL_EXT_stencil_two_side GL_EXT_texture_cube_map GL_NV_depth_clamp GL_NV_fog_distance GL_APPLE_packed_pixels GL_APPLE_vertex_array_object GL_ARB_draw_buffers GL_ARB_fragment_program GL_ARB_fragment_shader GL_ARB_shader_objects GL_ARB_vertex_program GL_ARB_vertex_shader GL_ATI_draw_buffers GL_ATI_texture_env_combine3 GL_ATI_texture_float GL_EXT_shadow_funcs GL_EXT_stencil_wrap GL_MESA_pack_invert GL_NV_primitive_restart GL_ARB_depth_clamp GL_ARB_fragment_program_shadow GL_ARB_half_float_pixel GL_ARB_occlusion_query2 GL_ARB_point_sprite GL_ARB_shading_language_100 GL_ARB_sync GL_ARB_texture_non_power_of_two GL_ARB_vertex_buffer_object GL_ATI_blend_equation_separate GL_EXT_blend_equation_separate GL_OES_read_format GL_ARB_color_buffer_float GL_ARB_pixel_buffer_object GL_ARB_texture_compression_rgtc GL_ARB_texture_float GL_ARB_texture_rectangle GL_ATI_texture_compression_3dc GL_EXT_packed_float GL_EXT_pixel_buffer_object GL_EXT_texture_compression_rgtc GL_EXT_texture_mirror_clamp GL_EXT_texture_rectangle GL_EXT_texture_sRGB GL_EXT_texture_shared_exponent GL_ARB_framebuffer_object GL_EXT_framebuffer_blit GL_EXT_framebuffer_multisample GL_EXT_packed_depth_stencil GL_ARB_vertex_array_object GL_ATI_separate_stencil GL_ATI_texture_mirror_once GL_EXT_draw_buffers2 GL_EXT_draw_instanced GL_EXT_gpu_program_parameters GL_EXT_texture_array GL_EXT_texture_compression_latc GL_EXT_texture_integer GL_EXT_texture_sRGB_decode GL_EXT_timer_query GL_OES_EGL_image GL_AMD_performance_monitor GL_ARB_copy_buffer GL_ARB_depth_buffer_float GL_ARB_draw_instanced GL_ARB_half_float_vertex GL_ARB_instanced_arrays GL_ARB_map_buffer_range GL_ARB_texture_rg GL_ARB_texture_swizzle GL_ARB_vertex_array_bgra GL_EXT_texture_swizzle GL_EXT_vertex_array_bgra GL_NV_conditional_render GL_AMD_conservative_depth GL_AMD_draw_buffers_blend GL_AMD_seamless_cubemap_per_texture GL_AMD_shader_stencil_export GL_ARB_ES2_compatibility GL_ARB_blend_func_extended GL_ARB_debug_output GL_ARB_draw_buffers_blend GL_ARB_draw_elements_base_vertex GL_ARB_explicit_attrib_location GL_ARB_fragment_coord_conventions GL_ARB_provoking_vertex GL_ARB_sample_shading GL_ARB_sampler_objects GL_ARB_seamless_cube_map GL_ARB_shader_stencil_export GL_ARB_shader_texture_lod GL_ARB_texture_cube_map_array GL_ARB_texture_gather GL_ARB_texture_multisample GL_ARB_texture_query_lod GL_ARB_texture_rgb10_a2ui GL_ARB_uniform_buffer_object GL_ARB_vertex_type_2_10_10_10_rev GL_ATI_meminfo GL_EXT_provoking_vertex GL_EXT_texture_snorm GL_MESA_texture_signed_rgba GL_NV_texture_barrier GL_ARB_get_program_binary GL_ARB_robustness GL_ARB_separate_shader_objects GL_ARB_shader_bit_encoding GL_ARB_shader_precision GL_ARB_texture_compression_bptc GL_ARB_timer_query GL_ARB_transform_feedback2 GL_ARB_transform_feedback3 GL_NV_vdpau_interop GL_ARB_base_instance GL_ARB_compressed_texture_pixel_storage GL_ARB_conservative_depth GL_ARB_internalformat_query GL_ARB_map_buffer_alignment GL_ARB_shading_language_420pack GL_ARB_shading_language_packing GL_ARB_texture_storage GL_ARB_transform_feedback_instanced GL_EXT_framebuffer_multisample_blit_scaled GL_EXT_transform_feedback GL_AMD_shader_trinary_minmax GL_ARB_ES3_compatibility GL_ARB_arrays_of_arrays GL_ARB_clear_buffer_object GL_ARB_copy_image GL_ARB_explicit_uniform_location GL_ARB_invalidate_subdata GL_ARB_program_interface_query GL_ARB_stencil_texturing GL_ARB_texture_query_levels GL_ARB_texture_storage_multisample GL_ARB_texture_view GL_ARB_vertex_attrib_binding GL_KHR_debug GL_AMD_pinned_memory GL_ARB_buffer_storage GL_ARB_multi_bind GL_ARB_seamless_cubemap_per_texture GL_ARB_texture_mirror_clamp_to_edge GL_ARB_texture_stencil8 GL_ARB_vertex_type_10f_11f_11f_rev GL_EXT_shader_integer_mix GL_NVX_gpu_memory_info GL_ARB_clip_control GL_ARB_conditional_render_inverted GL_ARB_derivative_control GL_ARB_get_texture_sub_image GL_ARB_pipeline_statistics_query GL_ARB_shader_texture_image_samples GL_ARB_texture_barrier GL_EXT_polygon_offset_clamp GL_KHR_context_flush_control 14:16:09 T:140001377232960 NOTICE: Running database version Addons20 14:16:09 T:140001377232960 NOTICE: Running database version ViewModes6 14:16:09 T:140001377232960 NOTICE: Running database version Textures13 14:16:09 T:140001377232960 NOTICE: Running database version MyMusic56 14:16:09 T:140001377232960 NOTICE: Running database version MyVideos99 14:16:09 T:140001377232960 NOTICE: Running database version TV29 14:16:09 T:140001377232960 NOTICE: Running database version Epg11 14:16:09 T:140001377232960 NOTICE: start dvd mediatype detection 14:16:10 T:140001377232960 WARNING: JSONRPC: Could not parse type "Setting.Details.SettingList" 14:16:11 T:140001377232960 NOTICE: ActiveAE DSP - starting 14:16:11 T:140001377232960 NOTICE: initialize done 14:16:11 T:140001377232960 NOTICE: Running the application... 14:16:11 T:140001377232960 NOTICE: starting zeroconf publishing 14:16:11 T:140001377232960 NOTICE: WebServer: Started the webserver 14:16:11 T:140001377232960 NOTICE: starting upnp client 14:16:11 T:140001377232960 NOTICE: starting upnp server 14:16:11 T:140001377232960 NOTICE: starting upnp renderer 14:16:11 T:139999961872128 NOTICE: ES: Starting UDP Event server on 0.0.0.0:9777 14:16:11 T:139999961872128 NOTICE: UDP: Listening on port 9777 14:16:11 T:140000851105536 NOTICE: ## LibreELEC Addon ## 0.7.3 14:16:11 T:140000851105536 WARNING: CSkinInfo: failed to load skin settings 14:16:11 T:140000867890944 NOTICE: screensaver.plugin.slideshow - XBMC Start : Version: 0.0.17 14:16:11 T:140000867890944 NOTICE: screensaver.plugin.slideshow - XBMC Start : CHECK 14:16:11 T:140000867890944 NOTICE: screensaver.plugin.slideshow - XBMC Start : DISABLED 14:16:11 T:140000867890944 NOTICE: screensaver.plugin.slideshow - XBMC Start : DONE 14:16:11 T:140000884676352 NOTICE: Skin Helper Service --> skin helper service version 1.0.100 started 14:16:11 T:140000884676352 NOTICE: Skin Helper Service --> WebService - start helper webservice on port 52307 14:16:12 T:139999861159680 WARNING: CPythonInvoker(9): Script invoked without an addon. Adding all addon modules installed to python path as fallback. This behaviour will be removed in future version. 14:16:19 T:139999903123200 ERROR: GetDirectory - Error getting pvr://channels/tv/all channel/;reload= 14:16:23 T:139999903123200 ERROR: GetDirectory - Error getting 14:16:48 T:139999827588864 ERROR: Previous line repeats 1 times. 14:16:48 T:139999827588864 ERROR: GetDirectory - Error getting pvr://channels/tv/all channel/;reload=20170114131624 14:16:52 T:140001377232960 NOTICE: Log level changed to "LOG_LEVEL_DEBUG_FREEMEM" 14:16:52 T:140001377232960 NOTICE: Enabled debug logging due to GUI setting. Level 2. 14:16:52 T:140001377232960 NOTICE: Log level changed to "LOG_LEVEL_DEBUG_FREEMEM" 14:16:52 T:140001377232960 NOTICE: Enabled debug logging due to GUI setting. Level 2. 14:16:52 T:140001377232960 DEBUG: ------ Window Init () ------ 14:16:52 T:139999911515904 DEBUG: RunQuery took 308 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=276 ORDER BY sets.idSet 14:16:52 T:139999911515904 DEBUG: RunQuery took 323 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 276 14:16:53 T:139999911515904 DEBUG: RunQuery took 393 ms for 4 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=277 ORDER BY sets.idSet 14:16:53 T:140001377232960 DEBUG: Keyboard: scancode: 0x72, sym: 0x0113, unicode: 0x0000, modifier: 0x0 14:16:53 T:140001377232960 DEBUG: OnKey: right (0xf083) pressed, action is Right 14:16:53 T:139999911515904 DEBUG: RunQuery took 328 ms for 4 items query: select * from movie_view WHERE movie_view.idSet = 277 14:16:54 T:140001377232960 DEBUG: Keyboard: scancode: 0x71, sym: 0x0114, unicode: 0x0000, modifier: 0x0 14:16:54 T:140001377232960 DEBUG: OnKey: left (0xf082) pressed, action is Left 14:16:54 T:139999911515904 DEBUG: RunQuery took 301 ms for 4 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=278 ORDER BY sets.idSet 14:16:54 T:140001377232960 INFO: CheckIdle - Closing session to https://libreelec.tv (easy=0x7f54959172b0, multi=0x7f54946055c0) 14:16:54 T:139999911515904 DEBUG: RunQuery took 426 ms for 4 items query: select * from movie_view WHERE movie_view.idSet = 278 14:16:55 T:139999911515904 DEBUG: RunQuery took 414 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=279 ORDER BY sets.idSet 14:16:55 T:139999911515904 DEBUG: RunQuery took 363 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 279 14:16:55 T:139999911515904 DEBUG: RunQuery took 442 ms for 5 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=280 ORDER BY sets.idSet 14:16:56 T:139999911515904 DEBUG: RunQuery took 411 ms for 5 items query: select * from movie_view WHERE movie_view.idSet = 280 14:16:56 T:140001377232960 DEBUG: Keyboard: scancode: 0x60, sym: 0x0125, unicode: 0x0000, modifier: 0x0 14:16:56 T:140001377232960 DEBUG: OnKey: f12 (0xf09b) pressed, action is suspend 14:16:56 T:140000893069056 DEBUG: GetAlbumsByWhere query: SELECT albumview.*, albumartistview.* FROM albumview LEFT JOIN albumartistview on albumartistview.idalbum = albumview.idalbum WHERE albumview.strReleaseType = 'album' 14:16:56 T:140001377232960 DEBUG: LogindUPowerSyscall: Received PrepareForSleep with arg 1 14:16:56 T:140001377232960 DEBUG: CAnnouncementManager - Announcement: OnSleep from xbmc 14:16:56 T:140001377232960 DEBUG: GOT ANNOUNCEMENT, type: 8, from xbmc, message OnSleep 14:16:56 T:140001377232960 DEBUG: ------ Window Init (DialogBusy.xml) ------ 14:16:56 T:140001377232960 NOTICE: OnSleep: Running sleep jobs 14:16:56 T:140001377232960 NOTICE: OnSleep: Stopping lirc 14:16:56 T:140001377232960 INFO: LIRC SetEnabled: disabled 14:16:56 T:140001377232960 DEBUG: CApplication::CloseNetworkShares: Closing all network shares 14:16:56 T:140001377232960 DEBUG: LogindUPowerSyscall - delay lock released 14:16:56 T:139999911515904 DEBUG: RunQuery took 453 ms for 8 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=281 ORDER BY sets.idSet 14:16:56 T:140001377232960 ERROR: Keymapping error: no such action 'lirc.stop' defined 14:17:05 T:140001377224448 DEBUG: CALSAHControlMonitor - Monitored ALSA hctl value changed 14:17:05 T:140001366689536 ERROR: ActiveAE::UnconfigureSink - failed to unconfigure 14:17:05 T:140001377232960 ERROR: Keymapping error: no such action 'lirc.start' defined 14:17:05 T:140001377232960 DEBUG: LogindUPowerSyscall: Received PrepareForSleep with arg 0 14:17:05 T:140001377232960 NOTICE: OnWake: Running resume jobs 14:17:05 T:140001377232960 NOTICE: OnWake: Restarting lirc 14:17:05 T:139999501940480 DEBUG: Thread RemoteControl start, auto delete: false 14:17:05 T:139999501940480 INFO: LIRC Process: using: /run/lirc/lircd 14:17:05 T:139999501940480 INFO: LIRC Connect: successfully started 14:17:05 T:139999501940480 DEBUG: Thread RemoteControl 139999501940480 terminating 14:17:05 T:140001366689536 DEBUG: CAESinkALSA - HDMI device "hdmi:CARD=HDMI,DEV=0" may be unconnected (no ELD data) 14:17:05 T:140001366689536 DEBUG: PulseAudio: Context authorizing 14:17:05 T:140001366689536 DEBUG: PulseAudio: Context setting name 14:17:05 T:140001366689536 DEBUG: PulseAudio: Context ready 14:17:05 T:140001366689536 NOTICE: Found 2 Lists of Devices 14:17:05 T:140001366689536 NOTICE: Enumerated ALSA devices: 14:17:05 T:140001366689536 NOTICE: Device 1 14:17:05 T:140001366689536 NOTICE: m_deviceName : @ 14:17:05 T:140001366689536 NOTICE: m_displayName : Default (HD-Audio Generic ALC889 Analog) 14:17:05 T:140001366689536 NOTICE: m_displayNameExtra: 14:17:05 T:140001366689536 NOTICE: m_deviceType : AE_DEVTYPE_PCM 14:17:05 T:140001366689536 NOTICE: m_channels : FL,FR,BL,BR,FC,LFE,SL,SR 14:17:05 T:140001366689536 NOTICE: m_sampleRates : 48000 14:17:05 T:140001366689536 NOTICE: m_dataFormats : AE_FMT_S32NE 14:17:05 T:140001366689536 NOTICE: Device 2 14:17:05 T:140001366689536 NOTICE: m_deviceName : @:CARD=Generic,DEV=0 14:17:05 T:140001366689536 NOTICE: m_displayName : HD-Audio Generic (@:CARD=Generic,DEV=0) 14:17:05 T:140001366689536 NOTICE: m_displayNameExtra: ALC889 Analog 14:17:05 T:140001366689536 NOTICE: m_deviceType : AE_DEVTYPE_PCM 14:17:05 T:140001366689536 NOTICE: m_channels : FL,FR,BL,BR,FC,LFE,SL,SR 14:17:05 T:140001366689536 NOTICE: m_sampleRates : 48000 14:17:05 T:140001366689536 NOTICE: m_dataFormats : AE_FMT_S32NE 14:17:05 T:140001366689536 NOTICE: Device 3 14:17:05 T:140001366689536 NOTICE: m_deviceName : surround21:CARD=Generic,DEV=0 14:17:05 T:140001366689536 NOTICE: m_displayName : HD-Audio Generic (surround21:CARD=Generic,DEV=0) 14:17:05 T:140001366689536 NOTICE: m_displayNameExtra: ALC889 Analog 14:17:05 T:140001366689536 NOTICE: m_deviceType : AE_DEVTYPE_PCM 14:17:05 T:140001366689536 NOTICE: m_channels : FL,FR,BL,BR,FC,LFE,SL,SR,UNKNOWN1,UNKNOWN2,UNKNOWN3,UNKNOWN4,UNKNOWN5,UNKNOWN6,UNKNOWN7,UNKNOWN8 14:17:05 T:140001366689536 NOTICE: m_sampleRates : 44100,48000,88200,96000,192000 14:17:05 T:140001366689536 NOTICE: m_dataFormats : AE_FMT_S32NE,AE_FMT_S16NE,AE_FMT_S16LE 14:17:05 T:140001366689536 NOTICE: Device 4 14:17:05 T:140001366689536 NOTICE: m_deviceName : iec958:CARD=Generic,DEV=0 14:17:05 T:140001366689536 NOTICE: m_displayName : HD-Audio Generic 14:17:05 T:140001366689536 NOTICE: m_displayNameExtra: ALC889 Digital S/PDIF 14:17:05 T:140001366689536 NOTICE: m_deviceType : AE_DEVTYPE_IEC958 14:17:05 T:140001366689536 NOTICE: m_channels : FL,FR 14:17:05 T:140001366689536 NOTICE: m_sampleRates : 32000,44100,48000,88200,96000,192000 14:17:05 T:140001366689536 NOTICE: m_dataFormats : AE_FMT_AC3,AE_FMT_DTS,AE_FMT_S32NE,AE_FMT_S16NE,AE_FMT_S16LE 14:17:05 T:140001366689536 NOTICE: Device 5 14:17:05 T:140001366689536 NOTICE: m_deviceName : hdmi:CARD=HDMI,DEV=0 14:17:05 T:140001366689536 NOTICE: m_displayName : HDA ATI 14:17:05 T:140001366689536 NOTICE: m_displayNameExtra: HDMI 14:17:05 T:140001366689536 NOTICE: m_deviceType : AE_DEVTYPE_HDMI 14:17:05 T:140001366689536 NOTICE: m_channels : FL,FR,UNKNOWN1,LFE,FC,BL,BR,BC,FLOC,FROC,BLOC,BROC,TFL,TFR,TFC,TC 14:17:05 T:140001366689536 NOTICE: m_sampleRates : 32000,44100,48000,88200,96000,176400,192000 14:17:05 T:140001366689536 NOTICE: m_dataFormats : AE_FMT_S32NE,AE_FMT_S16NE,AE_FMT_S16LE,AE_FMT_LPCM,AE_FMT_DTSHD,AE_FMT_TRUEHD,AE_FMT_EAC3,AE_FMT_DTS,AE_FMT_AC3,AE_FMT_AAC 14:17:05 T:140001366689536 NOTICE: Enumerated PULSE devices: 14:17:05 T:140001366689536 NOTICE: Device 1 14:17:05 T:140001366689536 NOTICE: m_deviceName : Default 14:17:05 T:140001366689536 NOTICE: m_displayName : Default 14:17:05 T:140001366689536 NOTICE: m_displayNameExtra: Bluetooth Audio (PULSEAUDIO) 14:17:05 T:140001366689536 NOTICE: m_deviceType : AE_DEVTYPE_PCM 14:17:05 T:140001366689536 NOTICE: m_channels : FL,FR 14:17:05 T:140001366689536 NOTICE: m_sampleRates : 5512,8000,11025,16000,22050,32000,44100,48000,64000,88200,96000,176400,192000,384000 14:17:05 T:140001366689536 NOTICE: m_dataFormats : AE_FMT_U8,AE_FMT_S16NE,AE_FMT_S24NE3,AE_FMT_S24NE4,AE_FMT_S32NE,AE_FMT_FLOAT 14:17:05 T:140001353152256 INFO: CActiveAESink::OpenSink - initialize sink 14:17:05 T:140001353152256 DEBUG: CActiveAESink::OpenSink - trying to open device ALSA:hdmi:CARD=HDMI,DEV=0 14:17:05 T:140001353152256 INFO: CAESinkALSA::Initialize - Attempting to open device "hdmi:CARD=HDMI,DEV=0" 14:17:05 T:140001353152256 INFO: CAESinkALSA::Initialize - Opened device "hdmi:CARD=HDMI,DEV=0,AES0=0x04,AES1=0x82,AES2=0x00,AES3=0x00" 14:17:05 T:140001353152256 INFO: CAESinkALSA::InitializeHW - Your hardware does not support AE_FMT_FLOAT, trying other formats 14:17:05 T:140001353152256 INFO: CAESinkALSA::InitializeHW - Using data format AE_FMT_S32NE 14:17:05 T:140001353152256 DEBUG: CAESinkALSA::InitializeHW - Request: periodSize 2205, bufferSize 8820 14:17:05 T:140001353152256 DEBUG: CAESinkALSA::InitializeHW - Got: periodSize 464, bufferSize 8816 14:17:05 T:140001353152256 DEBUG: CAESinkALSA::InitializeHW - Setting timeout to 200 ms 14:17:05 T:140001353152256 DEBUG: CAESinkALSA::GetChannelLayout - Input Channel Count: 2 Output Channel Count: 2 14:17:05 T:140001353152256 DEBUG: CAESinkALSA::GetChannelLayout - Requested Layout: FL,FR 14:17:05 T:140001353152256 DEBUG: CAESinkALSA::GetChannelLayout - Got Layout: FL,FR (ALSA: FL FR) 14:17:05 T:140001353152256 DEBUG: CActiveAESink::OpenSink - ALSA Initialized: 14:17:05 T:140001353152256 DEBUG: Output Device : HDA ATI 14:17:05 T:140001353152256 DEBUG: Sample Rate : 44100 14:17:05 T:140001353152256 DEBUG: Sample Format : AE_FMT_S32NE 14:17:05 T:140001353152256 DEBUG: Channel Count : 2 14:17:05 T:140001353152256 DEBUG: Channel Layout: FL,FR 14:17:05 T:140001353152256 DEBUG: Frames : 464 14:17:05 T:140001353152256 DEBUG: Frame Samples : 928 14:17:05 T:140001353152256 DEBUG: Frame Size : 8 14:17:05 T:140001366689536 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted 14:17:05 T:140001377232960 DEBUG: CAnnouncementManager - Announcement: OnWake from xbmc 14:17:05 T:140001377232960 DEBUG: GOT ANNOUNCEMENT, type: 8, from xbmc, message OnWake 14:17:05 T:140001377232960 DEBUG: LogindUPowerSyscall - inhibit lock taken, fd 210 14:17:05 T:140001377232960 DEBUG: ------ Window Deinit (DialogBusy.xml) ------ 14:17:08 T:140000893069056 DEBUG: GetAlbumsByWhere - query took 6696 ms 14:17:09 T:140000893069056 DEBUG: RunQuery took 90 ms for 0 items query: select * from musicvideo_view WHERE ((musicvideo_view.playCount IS NULL OR musicvideo_view.playCount < 1)) 14:17:10 T:139999911515904 DEBUG: RunQuery took 8689 ms for 8 items query: select * from movie_view WHERE movie_view.idSet = 281 14:17:10 T:140000893069056 DEBUG: RunQuery took 1410 ms for 695 items query: select * from movie_view WHERE ((movie_view.playCount IS NULL OR movie_view.playCount < 1)) 14:17:10 T:139999987050240 DEBUG: GetSongsFullByWhere query = SELECT songview.*, song_artist.idArtist AS idArtist, artist.strArtist AS strArtist, artist.strMusicBrainzArtistID AS strMusicBrainzArtistID FROM songview LEFT JOIN song_artist on song_artist.idsong = songview.idsong LEFT JOIN artist ON song_artist.idArtist = artist.idArtist 14:17:10 T:139999911515904 DEBUG: RunQuery took 298 ms for 6 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=282 ORDER BY sets.idSet 14:17:11 T:139999911515904 DEBUG: RunQuery took 399 ms for 6 items query: select * from movie_view WHERE movie_view.idSet = 282 14:17:11 T:139999911515904 DEBUG: RunQuery took 431 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=283 ORDER BY sets.idSet 14:17:12 T:139999911515904 DEBUG: RunQuery took 374 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 283 14:17:12 T:139999911515904 DEBUG: RunQuery took 440 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=284 ORDER BY sets.idSet 14:17:13 T:139999911515904 DEBUG: RunQuery took 345 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 284 14:17:13 T:139999911515904 DEBUG: RunQuery took 388 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=285 ORDER BY sets.idSet 14:17:14 T:139999911515904 DEBUG: RunQuery took 348 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 285 14:17:14 T:139999911515904 DEBUG: RunQuery took 401 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=286 ORDER BY sets.idSet 14:17:14 T:139999911515904 DEBUG: RunQuery took 344 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 286 14:17:15 T:139999911515904 DEBUG: RunQuery took 410 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=287 ORDER BY sets.idSet 14:17:15 T:139999911515904 DEBUG: RunQuery took 336 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 287 14:17:16 T:139999911515904 DEBUG: RunQuery took 361 ms for 5 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=288 ORDER BY sets.idSet 14:17:16 T:139999903123200 DEBUG: CRecentlyAddedJob::UpdateMusic() - Running RecentlyAdded home screen update 14:17:16 T:139999903123200 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.itrack, songartistview.iOrder 14:17:16 T:139999911515904 DEBUG: RunQuery took 397 ms for 5 items query: select * from movie_view WHERE movie_view.idSet = 288 14:17:17 T:139999911515904 DEBUG: RunQuery took 357 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=289 ORDER BY sets.idSet 14:17:17 T:139999903123200 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 LEFT JOIN albumartistview ON albumview.idAlbum = albumartistview.idAlbum ORDER BY albumview.idAlbum desc, albumartistview.iOrder 14:17:17 T:139999911515904 DEBUG: RunQuery took 412 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 289 14:17:17 T:139999911515904 DEBUG: RunQuery took 378 ms for 4 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=290 ORDER BY sets.idSet 14:17:18 T:139999911515904 DEBUG: RunQuery took 374 ms for 4 items query: select * from movie_view WHERE movie_view.idSet = 290 14:17:18 T:139999911515904 DEBUG: RunQuery took 413 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=291 ORDER BY sets.idSet 14:17:19 T:139999911515904 DEBUG: RunQuery took 369 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 291 14:17:19 T:140000893069056 DEBUG: RunQuery took 4572 ms for 1736 items query: select * from episode_view WHERE ((episode_view.playCount IS NULL OR episode_view.playCount < 1)) 14:17:19 T:139999911515904 DEBUG: RunQuery took 506 ms for 6 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=292 ORDER BY sets.idSet 14:17:20 T:139999911515904 DEBUG: RunQuery took 281 ms for 6 items query: select * from movie_view WHERE movie_view.idSet = 292 14:17:20 T:139999911515904 DEBUG: RunQuery took 430 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=293 ORDER BY sets.idSet 14:17:21 T:139999911515904 DEBUG: RunQuery took 341 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 293 14:17:21 T:139999911515904 DEBUG: RunQuery took 407 ms for 7 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=294 ORDER BY sets.idSet 14:17:21 T:139999911515904 DEBUG: RunQuery took 355 ms for 7 items query: select * from movie_view WHERE movie_view.idSet = 294 14:17:22 T:139999911515904 DEBUG: RunQuery took 379 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=295 ORDER BY sets.idSet 14:17:22 T:139999911515904 DEBUG: RunQuery took 326 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 295 14:17:23 T:139999911515904 DEBUG: RunQuery took 440 ms for 6 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=296 ORDER BY sets.idSet 14:17:23 T:139999911515904 DEBUG: RunQuery took 393 ms for 6 items query: select * from movie_view WHERE movie_view.idSet = 296 14:17:24 T:139999911515904 DEBUG: RunQuery took 395 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=297 ORDER BY sets.idSet 14:17:24 T:139999911515904 DEBUG: RunQuery took 377 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 297 14:17:25 T:139999911515904 DEBUG: RunQuery took 401 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=298 ORDER BY sets.idSet 14:17:25 T:139999987050240 DEBUG: GetSongsFullByWhere() - took 26133 ms 14:17:25 T:139999911515904 DEBUG: RunQuery took 274 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 298 14:17:25 T:139999911515904 DEBUG: RunQuery took 361 ms for 5 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=300 ORDER BY sets.idSet 14:17:26 T:139999911515904 DEBUG: RunQuery took 372 ms for 5 items query: select * from movie_view WHERE movie_view.idSet = 300 14:17:26 T:139999911515904 DEBUG: RunQuery took 314 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=301 ORDER BY sets.idSet 14:17:26 T:139999911515904 DEBUG: RunQuery took 401 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 301 14:17:27 T:139999911515904 DEBUG: RunQuery took 371 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=302 ORDER BY sets.idSet 14:17:27 T:139999911515904 DEBUG: RunQuery took 395 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 302 14:17:28 T:139999903123200 DEBUG: CRecentlyAddedJob::UpdateVideos() - Running RecentlyAdded home screen update 14:17:28 T:139999911515904 DEBUG: RunQuery took 548 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=303 ORDER BY sets.idSet 14:17:28 T:139999911515904 DEBUG: RunQuery took 326 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 303 14:17:29 T:139999911515904 DEBUG: RunQuery took 414 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=304 ORDER BY sets.idSet 14:17:29 T:139999911515904 DEBUG: RunQuery took 441 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 304 14:17:30 T:139999911515904 DEBUG: RunQuery took 446 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=305 ORDER BY sets.idSet 14:17:30 T:139999911515904 DEBUG: RunQuery took 355 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 305 14:17:31 T:139999911515904 DEBUG: RunQuery took 399 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=306 ORDER BY sets.idSet 14:17:31 T:139999903123200 DEBUG: RunQuery took 3206 ms for 10 items query: select * from movie_view ORDER BY dateAdded desc, idMovie desc LIMIT 10 14:17:31 T:139999911515904 DEBUG: RunQuery took 546 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 306 14:17:31 T:140001377232960 DEBUG: SECTION:UnloadDelayed(DLL: special://xbmcbin/system/ImageLib-x86_64-linux.so) 14:17:31 T:139999911515904 DEBUG: RunQuery took 282 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=307 ORDER BY sets.idSet 14:17:32 T:139999911515904 DEBUG: RunQuery took 403 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 307 14:17:33 T:139999911515904 DEBUG: RunQuery took 469 ms for 4 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=308 ORDER BY sets.idSet 14:17:33 T:139999911515904 DEBUG: RunQuery took 430 ms for 4 items query: select * from movie_view WHERE movie_view.idSet = 308 14:17:33 T:140000893069056 DEBUG: GetAlbumsByWhere query: SELECT albumview.*, albumartistview.* FROM albumview LEFT JOIN albumartistview on albumartistview.idalbum = albumview.idalbum WHERE albumview.strReleaseType = 'album' 14:17:34 T:139999911515904 DEBUG: RunQuery took 519 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=309 ORDER BY sets.idSet 14:17:34 T:139999911515904 DEBUG: RunQuery took 393 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 309 14:17:34 T:139999911515904 DEBUG: RunQuery took 289 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=310 ORDER BY sets.idSet 14:17:35 T:139999911515904 DEBUG: RunQuery took 421 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 310 14:17:35 T:139999911515904 DEBUG: RunQuery took 431 ms for 4 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=311 ORDER BY sets.idSet 14:17:36 T:139999911515904 DEBUG: RunQuery took 378 ms for 4 items query: select * from movie_view WHERE movie_view.idSet = 311 14:17:36 T:139999911515904 DEBUG: RunQuery took 397 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=312 ORDER BY sets.idSet 14:17:37 T:139999911515904 DEBUG: RunQuery took 346 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 312 14:17:37 T:139999911515904 DEBUG: RunQuery took 444 ms for 5 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=313 ORDER BY sets.idSet 14:17:38 T:139999911515904 DEBUG: RunQuery took 462 ms for 5 items query: select * from movie_view WHERE movie_view.idSet = 313 14:17:38 T:139999903123200 DEBUG: RunQuery took 6381 ms for 10 items query: select * from episode_view ORDER BY dateAdded desc, idEpisode desc LIMIT 10 14:17:38 T:139999911515904 DEBUG: RunQuery took 456 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=314 ORDER BY sets.idSet 14:17:38 T:139999903123200 DEBUG: RunQuery took 177 ms for 0 items query: select * from musicvideo_view ORDER BY dateAdded desc, idMVideo desc LIMIT 10 14:17:38 T:139999903123200 DEBUG: CRecentlyAddedJob::UpdateTotal() - Running RecentlyAdded home screen update 14:17:38 T:139999911515904 DEBUG: RunQuery took 368 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 314 14:17:39 T:139999911515904 DEBUG: RunQuery took 491 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=315 ORDER BY sets.idSet 14:17:39 T:139999911515904 DEBUG: RunQuery took 274 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 315 14:17:40 T:139999911515904 DEBUG: RunQuery took 367 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=316 ORDER BY sets.idSet 14:17:40 T:139999911515904 DEBUG: RunQuery took 339 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 316 14:17:40 T:139999911515904 DEBUG: RunQuery took 288 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=317 ORDER BY sets.idSet 14:17:41 T:139999911515904 DEBUG: RunQuery took 353 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 317 14:17:41 T:139999911515904 DEBUG: RunQuery took 303 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=318 ORDER BY sets.idSet 14:17:41 T:139999911515904 DEBUG: RunQuery took 303 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 318 14:17:42 T:139999911515904 DEBUG: RunQuery took 326 ms for 4 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=319 ORDER BY sets.idSet 14:17:42 T:139999911515904 DEBUG: RunQuery took 247 ms for 4 items query: select * from movie_view WHERE movie_view.idSet = 319 14:17:43 T:139999911515904 DEBUG: RunQuery took 289 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=320 ORDER BY sets.idSet 14:17:43 T:139999911515904 DEBUG: RunQuery took 316 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 320 14:17:43 T:139999911515904 DEBUG: RunQuery took 243 ms for 4 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=321 ORDER BY sets.idSet 14:17:43 T:139999911515904 DEBUG: RunQuery took 286 ms for 4 items query: select * from movie_view WHERE movie_view.idSet = 321 14:17:44 T:140000893069056 DEBUG: GetAlbumsByWhere - query took 10276 ms 14:17:44 T:139999911515904 DEBUG: RunQuery took 274 ms for 24 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=322 ORDER BY sets.idSet 14:17:44 T:140000893069056 DEBUG: RunQuery took 35 ms for 0 items query: select * from musicvideo_view WHERE ((musicvideo_view.playCount IS NULL OR musicvideo_view.playCount < 1)) 14:17:44 T:139999911515904 DEBUG: RunQuery took 316 ms for 24 items query: select * from movie_view WHERE movie_view.idSet = 322 14:17:44 T:140000893069056 DEBUG: RunQuery took 81 ms for 6 items query: select * from movie_view WHERE (movie_view.idFile IN (SELECT DISTINCT idFile FROM bookmark WHERE type = 1)) 14:17:44 T:139999911515904 DEBUG: RunQuery took 240 ms for 4 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=323 ORDER BY sets.idSet 14:17:45 T:139999911515904 DEBUG: RunQuery took 297 ms for 4 items query: select * from movie_view WHERE movie_view.idSet = 323 14:17:45 T:139999911515904 DEBUG: RunQuery took 324 ms for 29 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=324 ORDER BY sets.idSet 14:17:46 T:139999911515904 DEBUG: RunQuery took 308 ms for 29 items query: select * from movie_view WHERE movie_view.idSet = 324 14:17:46 T:139999911515904 DEBUG: RunQuery took 347 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=325 ORDER BY sets.idSet 14:17:46 T:140000742065920 DEBUG: Thread JobWorker 140000742065920 terminating (autodelete) 14:17:46 T:139999802410752 DEBUG: Thread JobWorker 139999802410752 terminating (autodelete) 14:17:46 T:139999827588864 DEBUG: Thread JobWorker 139999827588864 terminating (autodelete) 14:17:46 T:139999911515904 DEBUG: RunQuery took 307 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 325 14:17:47 T:139999911515904 DEBUG: RunQuery took 318 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=326 ORDER BY sets.idSet 14:17:47 T:139999911515904 DEBUG: RunQuery took 283 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 326 14:17:47 T:140001377232960 DEBUG: Keyboard: scancode: 0x71, sym: 0x0114, unicode: 0x0000, modifier: 0x0 14:17:47 T:140001377232960 DEBUG: OnKey: left (0xf082) pressed, action is Left 14:17:47 T:139999827588864 DEBUG: Thread JobWorker start, auto delete: true 14:17:47 T:139999911515904 DEBUG: RunQuery took 403 ms for 5 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=327 ORDER BY sets.idSet 14:17:47 T:140000893069056 DEBUG: RunQuery took 2089 ms for 4 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)))) 14:17:48 T:139999911515904 DEBUG: RunQuery took 365 ms for 5 items query: select * from movie_view WHERE movie_view.idSet = 327 14:17:48 T:140000893069056 DEBUG: RunQuery took 92 ms for 7 items query: select * from episode_view WHERE (episode_view.idShow = 97) AND (((episode_view.playCount IS NULL OR episode_view.playCount < 1))) 14:17:48 T:140000893069056 DEBUG: DatabaseUtils::GetSortFieldList: unknown field 25 14:17:48 T:140001377232960 DEBUG: Keyboard: scancode: 0x71, sym: 0x0114, unicode: 0x0000, modifier: 0x0 14:17:48 T:140001377232960 DEBUG: OnKey: left (0xf082) pressed, action is Left 14:17:48 T:140001377232960 DEBUG: Keyboard: scancode: 0x71, sym: 0x0114, unicode: 0x0000, modifier: 0x0 14:17:48 T:140001377232960 DEBUG: OnKey: left (0xf082) pressed, action is Left 14:17:48 T:139999911515904 DEBUG: RunQuery took 434 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=328 ORDER BY sets.idSet 14:17:48 T:140000893069056 DEBUG: RunQuery took 150 ms for 88 items query: select * from episode_view WHERE (episode_view.idShow = 106) AND (((episode_view.playCount IS NULL OR episode_view.playCount < 1))) 14:17:48 T:140000893069056 DEBUG: DatabaseUtils::GetSortFieldList: unknown field 25 14:17:48 T:140001377232960 DEBUG: Keyboard: scancode: 0x71, sym: 0x0114, unicode: 0x0000, modifier: 0x0 14:17:48 T:140001377232960 DEBUG: OnKey: left (0xf082) pressed, action is Left 14:17:49 T:139999911515904 DEBUG: RunQuery took 349 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 328 14:17:49 T:140001377232960 DEBUG: Keyboard: scancode: 0x71, sym: 0x0114, unicode: 0x0000, modifier: 0x0 14:17:49 T:140001377232960 DEBUG: OnKey: left (0xf082) pressed, action is Left 14:17:49 T:139999827588864 DEBUG: StartScript - calling plugin Library Data Provider('plugin://service.library.data.provider/','9','?type=playliststats&id=ActivateWindow(Videos,root)') 14:17:49 T:139999827588864 DEBUG: WaitOnScriptResult - waiting on the Library Data Provider (id=20) plugin... 14:17:49 T:139999802410752 DEBUG: Thread LanguageInvoker start, auto delete: false 14:17:49 T:139999802410752 INFO: initializing python engine. 14:17:49 T:139999802410752 DEBUG: CPythonInvoker(20, /storage/.kodi/addons/service.library.data.provider/default.py): start processing 14:17:49 T:139999802410752 DEBUG: -->Python Interpreter Initialized<-- 14:17:49 T:139999802410752 DEBUG: CPythonInvoker(20, /storage/.kodi/addons/service.library.data.provider/default.py): the source file to load is "/storage/.kodi/addons/service.library.data.provider/default.py" 14:17:49 T:139999802410752 DEBUG: CPythonInvoker(20, /storage/.kodi/addons/service.library.data.provider/default.py): setting the Python path to /storage/.kodi/addons/service.library.data.provider:/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 14:17:49 T:139999802410752 DEBUG: CPythonInvoker(20, /storage/.kodi/addons/service.library.data.provider/default.py): entering source directory /storage/.kodi/addons/service.library.data.provider 14:17:49 T:139999802410752 DEBUG: CPythonInvoker(20, /storage/.kodi/addons/service.library.data.provider/default.py): instantiating addon using automatically obtained id of "service.library.data.provider" dependent on version 2.1.0 of the xbmc.python api 14:17:49 T:139999802410752 DEBUG: Library Data Provider: script version 0.1.5 started 14:17:49 T:139999802410752 DEBUG: Library Data Provider: script version 0.1.5 stopped 14:17:49 T:139999802410752 INFO: CPythonInvoker(20, /storage/.kodi/addons/service.library.data.provider/default.py): script successfully run 14:17:49 T:139999827588864 DEBUG: WaitOnScriptResult- plugin returned successfully 14:17:49 T:139999802410752 INFO: Python script stopped 14:17:49 T:139999802410752 DEBUG: Thread LanguageInvoker 139999802410752 terminating 14:17:49 T:139999911515904 DEBUG: RunQuery took 346 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=329 ORDER BY sets.idSet 14:17:49 T:140000893069056 DEBUG: RunQuery took 141 ms for 5 items query: select * from episode_view WHERE (episode_view.idShow = 101) AND (((episode_view.playCount IS NULL OR episode_view.playCount < 1))) 14:17:49 T:140000893069056 DEBUG: DatabaseUtils::GetSortFieldList: unknown field 25 14:17:49 T:140001377232960 DEBUG: Keyboard: scancode: 0x71, sym: 0x0114, unicode: 0x0000, modifier: 0x0 14:17:49 T:140001377232960 DEBUG: OnKey: left (0xf082) pressed, action is Left 14:17:49 T:139999724910336 DEBUG: Thread JobWorker start, auto delete: true 14:17:49 T:140001377232960 DEBUG: SECTION:LoadDLL(special://xbmcbin/system/ImageLib-x86_64-linux.so) 14:17:49 T:140001377232960 DEBUG: Loading: /usr/lib/kodi/system/ImageLib-x86_64-linux.so 14:17:49 T:140000901461760 DEBUG: Thread JobWorker start, auto delete: true 14:17:49 T:140001377232960 DEBUG: Keyboard: scancode: 0x71, sym: 0x0114, unicode: 0x0000, modifier: 0x0 14:17:49 T:140001377232960 DEBUG: OnKey: left (0xf082) pressed, action is Left 14:17:49 T:140000901461760 DEBUG: StartScript - calling plugin Library Data Provider('plugin://service.library.data.provider/','10','?type=recentmovies&reload=20170114131715') 14:17:49 T:140000901461760 DEBUG: WaitOnScriptResult - waiting on the Library Data Provider (id=21) plugin... 14:17:49 T:139999978657536 DEBUG: Thread LanguageInvoker start, auto delete: false 14:17:49 T:139999978657536 INFO: initializing python engine. 14:17:49 T:139999978657536 DEBUG: CPythonInvoker(21, /storage/.kodi/addons/service.library.data.provider/default.py): start processing 14:17:49 T:139999911515904 DEBUG: RunQuery took 381 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 329 14:17:49 T:139999978657536 DEBUG: -->Python Interpreter Initialized<-- 14:17:49 T:139999978657536 DEBUG: CPythonInvoker(21, /storage/.kodi/addons/service.library.data.provider/default.py): the source file to load is "/storage/.kodi/addons/service.library.data.provider/default.py" 14:17:49 T:139999978657536 DEBUG: CPythonInvoker(21, /storage/.kodi/addons/service.library.data.provider/default.py): setting the Python path to /storage/.kodi/addons/service.library.data.provider:/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 14:17:49 T:139999978657536 DEBUG: CPythonInvoker(21, /storage/.kodi/addons/service.library.data.provider/default.py): entering source directory /storage/.kodi/addons/service.library.data.provider 14:17:49 T:139999978657536 DEBUG: CPythonInvoker(21, /storage/.kodi/addons/service.library.data.provider/default.py): instantiating addon using automatically obtained id of "service.library.data.provider" dependent on version 2.1.0 of the xbmc.python api 14:17:49 T:139999978657536 DEBUG: Library Data Provider: script version 0.1.5 started 14:17:50 T:139999978657536 DEBUG: LocalizeStrings: no translation available in currently set gui language, at path /storage/.kodi/addons/service.library.data.provider/resources/language/German 14:17:50 T:139999978657536 DEBUG: POParser: loaded 24 strings from file /storage/.kodi/addons/service.library.data.provider/resources/language/English/strings.po 14:17:50 T:140000893069056 DEBUG: RunQuery took 215 ms for 45 items query: select * from episode_view WHERE (episode_view.idShow = 111) AND (((episode_view.playCount IS NULL OR episode_view.playCount < 1))) 14:17:50 T:140000893069056 DEBUG: DatabaseUtils::GetSortFieldList: unknown field 25 14:17:50 T:140001377232960 DEBUG: Keyboard: scancode: 0x71, sym: 0x0114, unicode: 0x0000, modifier: 0x0 14:17:50 T:140001377232960 DEBUG: OnKey: left (0xf082) pressed, action is Left 14:17:50 T:139999911515904 DEBUG: RunQuery took 412 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=330 ORDER BY sets.idSet 14:17:50 T:139999911515904 DEBUG: RunQuery took 325 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 330 14:17:50 T:140000901461760 DEBUG: WaitOnScriptResult- plugin returned successfully 14:17:50 T:139999978657536 DEBUG: Library Data Provider: script version 0.1.5 stopped 14:17:50 T:139999978657536 INFO: CPythonInvoker(21, /storage/.kodi/addons/service.library.data.provider/default.py): script successfully run 14:17:50 T:139999978657536 INFO: Python script stopped 14:17:50 T:139999978657536 DEBUG: Thread LanguageInvoker 139999978657536 terminating 14:17:51 T:139999911515904 DEBUG: RunQuery took 452 ms for 8 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=331 ORDER BY sets.idSet 14:17:51 T:139999911515904 DEBUG: RunQuery took 427 ms for 8 items query: select * from movie_view WHERE movie_view.idSet = 331 14:17:51 T:140001377232960 DEBUG: Keyboard: scancode: 0x24, sym: 0x000d, unicode: 0x000d, modifier: 0x0 14:17:52 T:140001377232960 DEBUG: OnKey: return (0xf00d) pressed, action is Select 14:17:52 T:140001377232960 DEBUG: Activating window ID: 10016 14:17:52 T:139999911515904 DEBUG: RunQuery took 380 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=332 ORDER BY sets.idSet 14:17:52 T:140001377232960 DEBUG: ------ Window Deinit (Home.xml) ------ 14:17:52 T:140001377232960 DEBUG: ------ Window Init (SettingsCategory.xml) ------ 14:17:52 T:140001377224448 DEBUG: CALSAHControlMonitor - Monitored ALSA hctl value changed 14:17:52 T:140001366689536 DEBUG: CActiveAE - device change event 14:17:52 T:139999911515904 DEBUG: RunQuery took 375 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 332 14:17:52 T:140001366689536 DEBUG: PulseAudio: Context authorizing 14:17:52 T:140001366689536 DEBUG: PulseAudio: Context setting name 14:17:52 T:140001366689536 DEBUG: PulseAudio: Context ready 14:17:52 T:140001366689536 NOTICE: Found 2 Lists of Devices 14:17:52 T:140001366689536 NOTICE: Enumerated ALSA devices: 14:17:52 T:140001366689536 NOTICE: Device 1 14:17:52 T:140001366689536 NOTICE: m_deviceName : @ 14:17:52 T:140001366689536 NOTICE: m_displayName : Default (HD-Audio Generic ALC889 Analog) 14:17:52 T:140001366689536 NOTICE: m_displayNameExtra: 14:17:52 T:140001366689536 NOTICE: m_deviceType : AE_DEVTYPE_PCM 14:17:52 T:140001366689536 NOTICE: m_channels : FL,FR,BL,BR,FC,LFE,SL,SR 14:17:52 T:140001366689536 NOTICE: m_sampleRates : 48000 14:17:52 T:140001366689536 NOTICE: m_dataFormats : AE_FMT_S32NE 14:17:52 T:140001366689536 NOTICE: Device 2 14:17:52 T:140001366689536 NOTICE: m_deviceName : @:CARD=Generic,DEV=0 14:17:52 T:140001366689536 NOTICE: m_displayName : HD-Audio Generic (@:CARD=Generic,DEV=0) 14:17:52 T:140001366689536 NOTICE: m_displayNameExtra: ALC889 Analog 14:17:52 T:140001366689536 NOTICE: m_deviceType : AE_DEVTYPE_PCM 14:17:52 T:140001366689536 NOTICE: m_channels : FL,FR,BL,BR,FC,LFE,SL,SR 14:17:52 T:140001366689536 NOTICE: m_sampleRates : 48000 14:17:52 T:140001366689536 NOTICE: m_dataFormats : AE_FMT_S32NE 14:17:52 T:140001366689536 NOTICE: Device 3 14:17:52 T:140001366689536 NOTICE: m_deviceName : surround21:CARD=Generic,DEV=0 14:17:52 T:140001366689536 NOTICE: m_displayName : HD-Audio Generic (surround21:CARD=Generic,DEV=0) 14:17:52 T:140001366689536 NOTICE: m_displayNameExtra: ALC889 Analog 14:17:52 T:140001366689536 NOTICE: m_deviceType : AE_DEVTYPE_PCM 14:17:52 T:140001366689536 NOTICE: m_channels : FL,FR,BL,BR,FC,LFE,SL,SR,UNKNOWN1,UNKNOWN2,UNKNOWN3,UNKNOWN4,UNKNOWN5,UNKNOWN6,UNKNOWN7,UNKNOWN8 14:17:52 T:140001366689536 NOTICE: m_sampleRates : 44100,48000,88200,96000,192000 14:17:52 T:140001366689536 NOTICE: m_dataFormats : AE_FMT_S32NE,AE_FMT_S16NE,AE_FMT_S16LE 14:17:52 T:140001366689536 NOTICE: Device 4 14:17:52 T:140001366689536 NOTICE: m_deviceName : iec958:CARD=Generic,DEV=0 14:17:52 T:140001366689536 NOTICE: m_displayName : HD-Audio Generic 14:17:52 T:140001366689536 NOTICE: m_displayNameExtra: ALC889 Digital S/PDIF 14:17:52 T:140001366689536 NOTICE: m_deviceType : AE_DEVTYPE_IEC958 14:17:52 T:140001366689536 NOTICE: m_channels : FL,FR 14:17:52 T:140001366689536 NOTICE: m_sampleRates : 32000,44100,48000,88200,96000,192000 14:17:52 T:140001366689536 NOTICE: m_dataFormats : AE_FMT_AC3,AE_FMT_DTS,AE_FMT_S32NE,AE_FMT_S16NE,AE_FMT_S16LE 14:17:52 T:140001366689536 NOTICE: Device 5 14:17:52 T:140001366689536 NOTICE: m_deviceName : hdmi:CARD=HDMI,DEV=0 14:17:52 T:140001366689536 NOTICE: m_displayName : HDA ATI 14:17:52 T:140001366689536 NOTICE: m_displayNameExtra: @@@ 14:17:52 T:140001366689536 NOTICE: m_deviceType : AE_DEVTYPE_HDMI 14:17:52 T:140001366689536 NOTICE: m_channels : FL,FR,LFE,FC,BL,BR,BLOC,BROC 14:17:52 T:140001366689536 NOTICE: m_sampleRates : 32000,44100,48000,88200,96000,176400,192000 14:17:52 T:140001366689536 NOTICE: m_dataFormats : AE_FMT_LPCM,AE_FMT_AC3,AE_FMT_DTS,AE_FMT_EAC3,AE_FMT_DTSHD,AE_FMT_TRUEHD,AE_FMT_S32NE,AE_FMT_S16NE,AE_FMT_S16LE,AE_FMT_AAC 14:17:52 T:140001366689536 NOTICE: Enumerated PULSE devices: 14:17:52 T:140001366689536 NOTICE: Device 1 14:17:52 T:140001366689536 NOTICE: m_deviceName : Default 14:17:52 T:140001366689536 NOTICE: m_displayName : Default 14:17:52 T:140001366689536 NOTICE: m_displayNameExtra: Bluetooth Audio (PULSEAUDIO) 14:17:52 T:140001366689536 NOTICE: m_deviceType : AE_DEVTYPE_PCM 14:17:52 T:140001366689536 NOTICE: m_channels : FL,FR 14:17:52 T:140001366689536 NOTICE: m_sampleRates : 5512,8000,11025,16000,22050,32000,44100,48000,64000,88200,96000,176400,192000,384000 14:17:52 T:140001366689536 NOTICE: m_dataFormats : AE_FMT_U8,AE_FMT_S16NE,AE_FMT_S24NE3,AE_FMT_S24NE4,AE_FMT_S32NE,AE_FMT_FLOAT 14:17:52 T:140001353152256 INFO: CActiveAESink::OpenSink - initialize sink 14:17:52 T:140001353152256 DEBUG: CActiveAESink::OpenSink - trying to open device ALSA:hdmi:CARD=HDMI,DEV=0 14:17:52 T:140001353152256 INFO: CAESinkALSA::Initialize - Attempting to open device "hdmi:CARD=HDMI,DEV=0" 14:17:52 T:140001353152256 INFO: CAESinkALSA::Initialize - Opened device "hdmi:CARD=HDMI,DEV=0,AES0=0x04,AES1=0x82,AES2=0x00,AES3=0x00" 14:17:52 T:140001353152256 INFO: CAESinkALSA::InitializeHW - Your hardware does not support AE_FMT_FLOAT, trying other formats 14:17:52 T:140001353152256 INFO: CAESinkALSA::InitializeHW - Using data format AE_FMT_S32NE 14:17:52 T:140001353152256 DEBUG: CAESinkALSA::InitializeHW - Request: periodSize 2205, bufferSize 8820 14:17:52 T:140001353152256 DEBUG: CAESinkALSA::InitializeHW - Got: periodSize 464, bufferSize 8816 14:17:52 T:140001353152256 DEBUG: CAESinkALSA::InitializeHW - Setting timeout to 200 ms 14:17:52 T:140001353152256 DEBUG: CAESinkALSA::GetChannelLayout - Input Channel Count: 2 Output Channel Count: 2 14:17:52 T:140001353152256 DEBUG: CAESinkALSA::GetChannelLayout - Requested Layout: FL,FR 14:17:52 T:140001353152256 DEBUG: CAESinkALSA::GetChannelLayout - Got Layout: FL,FR (ALSA: FL FR) 14:17:52 T:140001353152256 DEBUG: CActiveAESink::OpenSink - ALSA Initialized: 14:17:52 T:140001353152256 DEBUG: Output Device : HDA ATI 14:17:52 T:140001353152256 DEBUG: Sample Rate : 44100 14:17:52 T:140001353152256 DEBUG: Sample Format : AE_FMT_S32NE 14:17:52 T:140001353152256 DEBUG: Channel Count : 2 14:17:52 T:140001353152256 DEBUG: Channel Layout: FL,FR 14:17:52 T:140001353152256 DEBUG: Frames : 464 14:17:52 T:140001353152256 DEBUG: Frame Samples : 928 14:17:52 T:140001353152256 DEBUG: Frame Size : 8 14:17:52 T:140001366689536 DEBUG: CActiveAE::ClearDiscardedBuffers - buffer pool deleted 14:17:53 T:139999911515904 DEBUG: RunQuery took 294 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=333 ORDER BY sets.idSet 14:17:53 T:139999911515904 DEBUG: RunQuery took 248 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 333 14:17:53 T:139999987050240 DEBUG: GetRecentlyAddedAlbums query: SELECT albumview.*, albumartistview.* FROM (SELECT idAlbum FROM album WHERE strAlbum != '' ORDER BY idAlbum DESC LIMIT 80) AS recentalbums JOIN albumview ON albumview.idAlbum = recentalbums.idAlbum LEFT JOIN albumartistview ON albumview.idAlbum = albumartistview.idAlbum ORDER BY albumview.idAlbum desc, albumartistview.iOrder 14:17:53 T:139999911515904 DEBUG: RunQuery took 368 ms for 9 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=334 ORDER BY sets.idSet 14:17:54 T:139999911515904 DEBUG: RunQuery took 464 ms for 9 items query: select * from movie_view WHERE movie_view.idSet = 334 14:17:54 T:139999911515904 DEBUG: RunQuery took 439 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=335 ORDER BY sets.idSet 14:17:54 T:140001377232960 DEBUG: Keyboard: scancode: 0x74, sym: 0x0112, unicode: 0x0000, modifier: 0x0 14:17:54 T:140001377232960 DEBUG: OnKey: down (0xf081) pressed, action is Down 14:17:55 T:139999911515904 DEBUG: RunQuery took 405 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 335 14:17:55 T:140001377232960 DEBUG: Keyboard: scancode: 0x72, sym: 0x0113, unicode: 0x0000, modifier: 0x0 14:17:55 T:140001377232960 DEBUG: OnKey: right (0xf083) pressed, action is Right 14:17:55 T:139999911515904 DEBUG: RunQuery took 403 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=336 ORDER BY sets.idSet 14:17:56 T:139999911515904 DEBUG: RunQuery took 419 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 336 14:17:56 T:140001377232960 DEBUG: Keyboard: scancode: 0x74, sym: 0x0112, unicode: 0x0000, modifier: 0x0 14:17:56 T:140001377232960 DEBUG: OnKey: down (0xf081) pressed, action is Down 14:17:56 T:139999911515904 DEBUG: RunQuery took 613 ms for 8 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=337 ORDER BY sets.idSet 14:17:57 T:140001377232960 DEBUG: Keyboard: scancode: 0x74, sym: 0x0112, unicode: 0x0000, modifier: 0x0 14:17:57 T:140001377232960 DEBUG: OnKey: down (0xf081) pressed, action is Down 14:17:57 T:139999911515904 DEBUG: RunQuery took 395 ms for 8 items query: select * from movie_view WHERE movie_view.idSet = 337 14:17:57 T:140001377232960 DEBUG: Keyboard: scancode: 0x74, sym: 0x0112, unicode: 0x0000, modifier: 0x0 14:17:57 T:140001377232960 DEBUG: OnKey: down (0xf081) pressed, action is Down 14:17:57 T:139999961872128 NOTICE: ES: Client from 127.0.0.1 timed out 14:17:57 T:140001377232960 DEBUG: Keyboard: scancode: 0x74, sym: 0x0112, unicode: 0x0000, modifier: 0x0 14:17:57 T:140001377232960 DEBUG: OnKey: down (0xf081) pressed, action is Down 14:17:58 T:139999911515904 DEBUG: RunQuery took 596 ms for 4 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=339 ORDER BY sets.idSet 14:17:58 T:139999911515904 DEBUG: RunQuery took 375 ms for 4 items query: select * from movie_view WHERE movie_view.idSet = 339 14:17:58 T:140001377232960 DEBUG: Keyboard: scancode: 0x74, sym: 0x0112, unicode: 0x0000, modifier: 0x0 14:17:58 T:140001377232960 DEBUG: OnKey: down (0xf081) pressed, action is Down 14:17:59 T:139999911515904 DEBUG: RunQuery took 568 ms for 5 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=340 ORDER BY sets.idSet 14:17:59 T:140001377232960 DEBUG: Keyboard: scancode: 0x74, sym: 0x0112, unicode: 0x0000, modifier: 0x0 14:17:59 T:140001377232960 DEBUG: OnKey: down (0xf081) pressed, action is Down 14:17:59 T:140001377232960 DEBUG: Keyboard: scancode: 0x74, sym: 0x0112, unicode: 0x0000, modifier: 0x0 14:17:59 T:140001377232960 DEBUG: OnKey: down (0xf081) pressed, action is Down 14:17:59 T:139999911515904 DEBUG: RunQuery took 444 ms for 5 items query: select * from movie_view WHERE movie_view.idSet = 340 14:17:59 T:140001377232960 DEBUG: Keyboard: scancode: 0x74, sym: 0x0112, unicode: 0x0000, modifier: 0x0 14:17:59 T:140001377232960 DEBUG: OnKey: down (0xf081) pressed, action is Down 14:17:59 T:140001377232960 DEBUG: Keyboard: scancode: 0x74, sym: 0x0112, unicode: 0x0000, modifier: 0x0 14:17:59 T:140001377232960 DEBUG: OnKey: down (0xf081) pressed, action is Down 14:18:00 T:139999911515904 DEBUG: RunQuery took 362 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=341 ORDER BY sets.idSet 14:18:00 T:140001377232960 DEBUG: Keyboard: scancode: 0x74, sym: 0x0112, unicode: 0x0000, modifier: 0x0 14:18:00 T:140001377232960 DEBUG: OnKey: down (0xf081) pressed, action is Down 14:18:00 T:139999911515904 DEBUG: RunQuery took 462 ms for 2 items query: select * from movie_view WHERE movie_view.idSet = 341 14:18:00 T:140001377232960 DEBUG: Keyboard: scancode: 0x74, sym: 0x0112, unicode: 0x0000, modifier: 0x0 14:18:00 T:140001377232960 DEBUG: OnKey: down (0xf081) pressed, action is Down 14:18:01 T:139999911515904 DEBUG: RunQuery took 550 ms for 4 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=342 ORDER BY sets.idSet 14:18:01 T:140001377232960 DEBUG: Keyboard: scancode: 0x16, sym: 0x0008, unicode: 0x0008, modifier: 0x0 14:18:01 T:140001377232960 DEBUG: OnKey: backspace (0xf008) pressed, action is Back 14:18:01 T:140001377232960 DEBUG: CGUIWindowManager::PreviousWindow: Deactivate 14:18:01 T:139999911515904 DEBUG: RunQuery took 466 ms for 4 items query: select * from movie_view WHERE movie_view.idSet = 342 14:18:01 T:140001377232960 DEBUG: ------ Window Deinit (SettingsCategory.xml) ------ 14:18:01 T:140001377232960 DEBUG: CGUIWindowManager::PreviousWindow: Activate new 14:18:01 T:140001377232960 DEBUG: ------ Window Init (Home.xml) ------ 14:18:01 T:139999827588864 ERROR: GetDirectory - Error getting 14:18:01 T:139999724910336 DEBUG: StartScript - calling plugin Library Data Provider('plugin://service.library.data.provider/','11','?type=recommendedepisodes&reload=20170114131750') 14:18:01 T:139999724910336 DEBUG: WaitOnScriptResult - waiting on the Library Data Provider (id=22) plugin... 14:18:01 T:139999978657536 DEBUG: Thread LanguageInvoker start, auto delete: false 14:18:01 T:139999978657536 INFO: initializing python engine. 14:18:01 T:139999978657536 DEBUG: CPythonInvoker(22, /storage/.kodi/addons/service.library.data.provider/default.py): start processing 14:18:01 T:139999802410752 DEBUG: Thread LanguageInvoker start, auto delete: false 14:18:01 T:139999802410752 INFO: initializing python engine. 14:18:01 T:139999802410752 DEBUG: CPythonInvoker(23, /storage/.kodi/addons/script.skinshortcuts/default.py): start processing 14:18:02 T:139999978657536 DEBUG: -->Python Interpreter Initialized<-- 14:18:02 T:139999978657536 DEBUG: CPythonInvoker(22, /storage/.kodi/addons/service.library.data.provider/default.py): the source file to load is "/storage/.kodi/addons/service.library.data.provider/default.py" 14:18:02 T:139999978657536 DEBUG: CPythonInvoker(22, /storage/.kodi/addons/service.library.data.provider/default.py): setting the Python path to /storage/.kodi/addons/service.library.data.provider:/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 14:18:02 T:139999978657536 DEBUG: CPythonInvoker(22, /storage/.kodi/addons/service.library.data.provider/default.py): entering source directory /storage/.kodi/addons/service.library.data.provider 14:18:02 T:139999978657536 DEBUG: CPythonInvoker(22, /storage/.kodi/addons/service.library.data.provider/default.py): instantiating addon using automatically obtained id of "service.library.data.provider" dependent on version 2.1.0 of the xbmc.python api 14:18:02 T:139999802410752 DEBUG: -->Python Interpreter Initialized<-- 14:18:02 T:139999802410752 DEBUG: CPythonInvoker(23, /storage/.kodi/addons/script.skinshortcuts/default.py): the source file to load is "/storage/.kodi/addons/script.skinshortcuts/default.py" 14:18:02 T:139999802410752 DEBUG: CPythonInvoker(23, /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 14:18:02 T:139999802410752 DEBUG: CPythonInvoker(23, /storage/.kodi/addons/script.skinshortcuts/default.py): entering source directory /storage/.kodi/addons/script.skinshortcuts 14:18:02 T:139999802410752 DEBUG: CPythonInvoker(23, /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 14:18:02 T:139999978657536 DEBUG: Library Data Provider: script version 0.1.5 started 14:18:02 T:139999978657536 DEBUG: LocalizeStrings: no translation available in currently set gui language, at path /storage/.kodi/addons/service.library.data.provider/resources/language/German 14:18:02 T:139999978657536 DEBUG: POParser: loaded 24 strings from file /storage/.kodi/addons/service.library.data.provider/resources/language/English/strings.po 14:18:02 T:139999978657536 DEBUG: Library Data Provider: script version 0.1.5 stopped 14:18:02 T:139999978657536 INFO: CPythonInvoker(22, /storage/.kodi/addons/service.library.data.provider/default.py): script successfully run 14:18:02 T:139999724910336 DEBUG: WaitOnScriptResult- plugin returned successfully 14:18:02 T:139999978657536 INFO: Python script stopped 14:18:02 T:139999978657536 DEBUG: Thread LanguageInvoker 139999978657536 terminating 14:18:02 T:140000893069056 DEBUG: GetAlbumsByWhere query: SELECT albumview.*, albumartistview.* FROM albumview LEFT JOIN albumartistview on albumartistview.idalbum = albumview.idalbum WHERE albumview.strReleaseType = 'album' 14:18:02 T:139999802410752 INFO: CPythonInvoker(23, /storage/.kodi/addons/script.skinshortcuts/default.py): script successfully run 14:18:02 T:139999802410752 INFO: Python script stopped 14:18:02 T:139999802410752 DEBUG: Thread LanguageInvoker 139999802410752 terminating 14:18:02 T:139999911515904 DEBUG: RunQuery took 610 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=343 ORDER BY sets.idSet 14:18:03 T:139999911515904 DEBUG: RunQuery took 464 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 343 14:18:03 T:139999911515904 DEBUG: RunQuery took 501 ms for 4 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=344 ORDER BY sets.idSet 14:18:04 T:139999911515904 DEBUG: RunQuery took 509 ms for 4 items query: select * from movie_view WHERE movie_view.idSet = 344 14:18:04 T:139999911515904 DEBUG: RunQuery took 471 ms for 4 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=345 ORDER BY sets.idSet 14:18:05 T:139999911515904 DEBUG: RunQuery took 436 ms for 4 items query: select * from movie_view WHERE movie_view.idSet = 345 14:18:05 T:139999911515904 DEBUG: RunQuery took 383 ms for 3 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=346 ORDER BY sets.idSet 14:18:05 T:139999903123200 DEBUG: CRecentlyAddedJob::UpdateMusic() - Running RecentlyAdded home screen update 14:18:05 T:139999903123200 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.itrack, songartistview.iOrder 14:18:06 T:139999911515904 DEBUG: RunQuery took 304 ms for 3 items query: select * from movie_view WHERE movie_view.idSet = 346 14:18:06 T:139999911515904 DEBUG: RunQuery took 363 ms for 2 items query: select * from movie_view JOIN sets ON movie_view.idSet = sets.idSet WHERE sets.idSet=347 ORDER BY sets.idSet 14:18:06 T:140001377232960 DEBUG: Keyboard: scancode: 0x45, sym: 0x011c, unicode: 0x0000, modifier: 0x0 14:18:06 T:140001377232960 DEBUG: OnKey: f3 (0xf092) pressed, action is toggledebug 14:18:06 T:140001377232960 NOTICE: Disabled debug logging due to GUI setting. Level 0. 14:18:06 T:140001377232960 NOTICE: Log level changed to "LOG_LEVEL_NORMAL" 14:18:06 T:140001377232960 NOTICE: Disabled debug logging due to GUI setting. Level 0. 14:18:06 T:140001377232960 NOTICE: Log level changed to "LOG_LEVEL_NORMAL" 14:18:06 T:139999961872128 NOTICE: ES: Client from 127.0.0.1 timed out 14:18:09 T:140001377232960 NOTICE: Storing total System Uptime 14:18:09 T:140001377232960 NOTICE: Saving settings 14:18:09 T:140001377232960 NOTICE: stop all