2018-11-27 11:52:37,992 (2614) :  INFO (core:349) - Starting framework core - Version: 2.6.3, Build: ecd6004 (Tue Oct 30 09:36:00 UTC 2018)
2018-11-27 11:52:37,993 (2614) :  DEBUG (core:361) - Using the elevated policy
2018-11-27 11:52:37,993 (2614) :  DEBUG (core:450) - Starting runtime component.
2018-11-27 11:52:37,996 (2614) :  DEBUG (core:450) - Starting caching component.
2018-11-27 11:52:37,996 (2614) :  DEBUG (core:450) - Starting data component.
2018-11-27 11:52:37,996 (2614) :  DEBUG (core:450) - Starting networking component.
2018-11-27 11:52:38,000 (2614) :  DEBUG (networking:284) - Loaded HTTP cookies
2018-11-27 11:52:38,013 (2614) :  DEBUG (networking:452) - Setting the default network timeout to 20.0
2018-11-27 11:52:38,015 (2614) :  DEBUG (core:450) - Starting localization component.
2018-11-27 11:52:38,015 (2614) :  INFO (localization:409) - Setting the default locale to en-us
2018-11-27 11:52:38,015 (2614) :  DEBUG (core:450) - Starting messaging component.
2018-11-27 11:52:38,016 (2614) :  DEBUG (core:450) - Starting debugging component.
2018-11-27 11:52:38,016 (2614) :  DEBUG (core:450) - Starting services component.
2018-11-27 11:52:38,016 (2614) :  DEBUG (core:450) - Starting myplex component.
2018-11-27 11:52:38,016 (2614) :  DEBUG (core:450) - Starting notifications component.
2018-11-27 11:52:38,016 (1b40) :  DEBUG (networking:166) - Requesting 'http://127.0.0.1:32400/system/messaging/clear_events/com.plexapp.agents.imdb'
2018-11-27 11:52:38,163 (2614) :  DEBUG (accessor:68) - Creating a new model access point for provider com.plexapp.agents.imdb in namespace 'metadata'
2018-11-27 11:52:38,174 (2614) :  DEBUG (networking:166) - Requesting 'http://127.0.0.1:32400/:/plugins/com.plexapp.system/resourceHashes'
2018-11-27 11:52:38,362 (2614) :  DEBUG (runtime:1117) - Created a thread named 'load_all_services'
2018-11-27 11:52:38,362 (2098) :  DEBUG (services:265) - Plug-in is not daemonized - loading services from system
2018-11-27 11:52:38,364 (2614) :  DEBUG (runtime:1117) - Created a thread named 'get_server_info'
2018-11-27 11:52:38,365 (2614) :  DEBUG (core:150) - Finished starting framework core
2018-11-27 11:52:38,365 (2614) :  DEBUG (core:560) - Loading plug-in code
2018-11-27 11:52:38,365 (2098) :  DEBUG (networking:166) - Requesting 'http://127.0.0.1:32400/:/plugins/com.plexapp.system/messaging/function/X0J1bmRsZVNlcnZpY2U6QWxsU2VydmljZXM_/Y2VyZWFsMQoxCmxpc3QKMApyMAo_/Y2VyZWFsMQoxCmRpY3QKMApyMAo_'
2018-11-27 11:52:38,367 (26e4) :  DEBUG (networking:166) - Requesting 'http://127.0.0.1:32400'
2018-11-27 11:52:38,372 (26e4) :  DEBUG (core:538) - Machine identifier is ee3e9fb2d0c1ed21eb7168bdfb2ae59f0714adc3
2018-11-27 11:52:38,395 (26e4) :  DEBUG (core:539) - Server version is 1.13.9.5456-ecd600442
2018-11-27 11:52:38,575 (2098) :  DEBUG (services:362) - Loaded services
2018-11-27 11:52:38,584 (2720) :  DEBUG (services:438) - No shared code to load
2018-11-27 11:52:38,877 (2614) :  DEBUG (core:566) - Finished loading plug-in code
2018-11-27 11:52:39,000 (2614) :  DEBUG (agentkit:1115) - Creating new agent class called PlexMovieAgent
2018-11-27 11:52:39,002 (2614) :  DEBUG (agentkit:933) - Updating agent information: [{'media_types': ['Movie'], 'accepts_from': ['com.plexapp.agents.localmedia'], 'fallback_agent': None, 'contributes_to': ['com.plexapp.agents.themoviedb'], 'languages': ['en', 'sv', 'fr', 'es', 'nl', 'de', 'it', 'da', 'ar', 'ca', 'zh', 'cs', 'et', 'fi', 'el', 'he', 'hi', 'hu', 'id', 'ja', 'ko', 'lv', 'no', 'fa', 'pl', 'pt', 'ro', 'ru', 'sk', 'th', 'tr', 'uk', 'vi'], 'persist_stored_files': True, 'version': 0, 'primary_provider': True, 'prefs': True, 'name': 'Plex Movie'}]
2018-11-27 11:52:39,003 (2614) :  DEBUG (networking:166) - Requesting 'http://127.0.0.1:32400/:/plugins/com.plexapp.system/messaging/function/X0FnZW50U2VydmljZTpVcGRhdGVJbmZv/Y2VyZWFsMQoxCmxpc3QKMApyMAo_/Y2VyZWFsMQo3CmRpY3QKbGlzdApkaWN0Cmxpc3QKbGlzdApsaXN0Cmxpc3QKMgpzMjMKY29tLnBsZXhhcHAuYWdlbnRzLmltZGJzMTAKaWRlbnRpZmllcnIxCnMxMAphZ2VudF9pbmZvMQpyMgoxMApyMwpzMTEKbWVkaWFfdHlwZXNyNApzMTIKYWNjZXB0c19mcm9tbnMxNApmYWxsYmFja19hZ2VudHI1CnMxNApjb250cmlidXRlc190b3I2CnM5Cmxhbmd1YWdlc2IxczIwCnBlcnNpc3Rfc3RvcmVkX2ZpbGVzaTAKczcKdmVyc2lvbmIxczE2CnByaW1hcnlfcHJvdmlkZXJiMXM1CnByZWZzczEwClBsZXggTW92aWVzNApuYW1lMQpzNQpNb3ZpZTEKczI5CmNvbS5wbGV4YXBwLmFnZW50cy5sb2NhbG1lZGlhMQpzMjkKY29tLnBsZXhhcHAuYWdlbnRzLnRoZW1vdmllZGIzMwpzMgplbnMyCnN2czIKZnJzMgplc3MyCm5sczIKZGVzMgppdHMyCmRhczIKYXJzMgpjYXMyCnpoczIKY3NzMgpldHMyCmZpczIKZWxzMgpoZXMyCmhpczIKaHVzMgppZHMyCmphczIKa29zMgpsdnMyCm5vczIKZmFzMgpwbHMyCnB0czIKcm9zMgpydXMyCnNrczIKdGhzMgp0cnMyCnVrczIKdmlyMAo_'
2018-11-27 11:52:39,016 (2614) :  INFO (core:611) - Started plug-in
2018-11-27 11:52:39,016 (2614) :  DEBUG (socketinterface:160) - Starting socket server
2018-11-27 11:52:39,016 (2614) :  DEBUG (runtime:1117) - Created a thread named 'start'
2018-11-27 11:52:39,016 (2614) :  INFO (socketinterface:184) - Socket server started on port 51155
2018-11-27 11:52:39,017 (2614) :  INFO (pipeinterface:25) - Entering run loop
2018-11-27 11:52:39,017 (2614) :  DEBUG (runtime:717) - Handling request GET /:/prefixes
2018-11-27 11:52:39,019 (2614) :  DEBUG (runtime:814) - Found route matching /:/prefixes
2018-11-27 11:52:39,019 (2614) :  DEBUG (runtime:924) - Response: [200] MediaContainer, 148 bytes
2018-11-27 11:52:39,040 (1924) :  DEBUG (runtime:717) - Handling request GET /:/plugins/com.plexapp.agents.imdb/messaging/function/X0FnZW50S2l0OlNlYXJjaA__/Y2VyZWFsMQoxCmxpc3QKMApyMAo_/Y2VyZWFsMQoyCmRpY3QKZGljdAo2CnMyCmVuczQKbGFuZ2IwczYKbWFudWFsYjFzNwpwcmltYXJ5aTAKczcKdmVyc2lvbnIxCnM2Cmt3YXJnc3M1Ck1vdmllczEwCm1lZGlhX3R5cGU4CnMxNgpiNTgxMmI2MDJhNTc1OTJiczE3Cm9wZW5TdWJ0aXRsZXNIYXNoczE5ClRoZSBEaXNhc3RlciBBcnRpc3RzNApuYW1lczQwCmYwNTU0Mzg1NjJlYzRkNDAwOTM3YzRmMmE5ZDUyNDEwZmY0OWIwMDRzOApwbGV4SGFzaHMxNDMKRCUzQSU1Q01vdmllcyU1Q1RoZSUyMERpc2FzdGVyJTIwQXJ0aXN0JTIwKDIwMTcpJTVDVGhlJTJFRGlzYXN0ZXIlMkVBcnRpc3QlMkUyMDE3JTJFNzIwcCUyRUJsdVJheSUyRURENSUyRTElMkV4MjY0JTJFMS1TcGFjZUhELU9iZnVzY2F0ZWQlMkVta3ZzOApmaWxlbmFtZXM2CmJsdXJheXM2CnNvdXJjZXM0CjIwMTdzNAp5ZWFyczIKLTFzOApkdXJhdGlvbnMzCjMwMHMyCmlkcjAK
2018-11-27 11:52:39,052 (1924) :  DEBUG (runtime:814) - Found route matching /:/plugins/com.plexapp.agents.imdb/messaging/function/X0FnZW50S2l0OlNlYXJjaA__/Y2VyZWFsMQoxCmxpc3QKMApyMAo_/Y2VyZWFsMQoyCmRpY3QKZGljdAo2CnMyCmVuczQKbGFuZ2IwczYKbWFudWFsYjFzNwpwcmltYXJ5aTAKczcKdmVyc2lvbnIxCnM2Cmt3YXJnc3M1Ck1vdmllczEwCm1lZGlhX3R5cGU4CnMxNgpiNTgxMmI2MDJhNTc1OTJiczE3Cm9wZW5TdWJ0aXRsZXNIYXNoczE5ClRoZSBEaXNhc3RlciBBcnRpc3RzNApuYW1lczQwCmYwNTU0Mzg1NjJlYzRkNDAwOTM3YzRmMmE5ZDUyNDEwZmY0OWIwMDRzOApwbGV4SGFzaHMxNDMKRCUzQSU1Q01vdmllcyU1Q1RoZSUyMERpc2FzdGVyJTIwQXJ0aXN0JTIwKDIwMTcpJTVDVGhlJTJFRGlzYXN0ZXIlMkVBcnRpc3QlMkUyMDE3JTJFNzIwcCUyRUJsdVJheSUyRURENSUyRTElMkV4MjY0JTJFMS1TcGFjZUhELU9iZnVzY2F0ZWQlMkVta3ZzOApmaWxlbmFtZXM2CmJsdXJheXM2CnNvdXJjZXM0CjIwMTdzNAp5ZWFyczIKLTFzOApkdXJhdGlvbnMzCjMwMHMyCmlkcjAK
2018-11-27 11:52:39,052 (1924) :  INFO (agentkit:957) - Searching for matches for {'openSubtitlesHash': 'b5812b602a57592b', 'name': 'The Disaster Artist', 'plexHash': 'f055438562ec4d400937c4f2a9d52410ff49b004', 'filename': 'D%3A%5CMovies%5CThe%20Disaster%20Artist%20(2017)%5CThe%2EDisaster%2EArtist%2E2017%2E720p%2EBluRay%2EDD5%2E1%2Ex264%2E1-SpaceHD-Obfuscated%2Emkv', 'source': 'bluray', 'year': '2017', 'duration': '-1', 'id': '300'}
2018-11-27 11:52:39,052 (1924) :  DEBUG (networking:166) - Requesting 'http://127.0.0.1:32400/library/metadata/300/tree'
2018-11-27 11:52:39,062 (1924) :  INFO (logkit:16) - checking hash search vector: https://meta.plex.tv/movie/hash/f0/f055438562ec4d400937c4f2a9d52410ff49b004.xml
2018-11-27 11:52:39,078 (1924) :  DEBUG (networking:166) - Requesting 'https://meta.plex.tv/movie/hash/f0/f055438562ec4d400937c4f2a9d52410ff49b004.xml'
2018-11-27 11:52:40,378 (1924) :  ERROR (networking:219) - Error opening URL 'https://meta.plex.tv/movie/hash/f0/f055438562ec4d400937c4f2a9d52410ff49b004.xml'
2018-11-27 11:52:40,378 (1924) :  INFO (logkit:16) - freebase/proxy hash lookup failed: HTTP Error 404: Not Found
2018-11-27 11:52:40,378 (1924) :  INFO (logkit:16) - Scoring {}
2018-11-27 11:52:40,378 (1924) :  INFO (logkit:16) - ---- HASH RESULTS MAP ----
2018-11-27 11:52:40,378 (1924) :  INFO (logkit:16) - {}
2018-11-27 11:52:40,380 (1924) :  INFO (logkit:16) - checking title/year search vector: https://meta.plex.tv/movie/guid/ab/ab3976a695e0fbfa0e3bdb4708b382ea10cf6fe2.xml
2018-11-27 11:52:40,394 (1924) :  DEBUG (networking:166) - Requesting 'https://meta.plex.tv/movie/guid/ab/ab3976a695e0fbfa0e3bdb4708b382ea10cf6fe2.xml'
2018-11-27 11:52:40,528 (1924) :  INFO (logkit:16) - Scoring {'tt3521126': [0, u'The Disaster Artist', u'2017', 100, 2731, 0]}
2018-11-27 11:52:40,528 (1924) :  INFO (logkit:16) - ---- TITLE_YEAR RESULTS MAP ----
2018-11-27 11:52:40,528 (1924) :  INFO (logkit:16) - {'tt3521126': [0, u'The Disaster Artist', u'2017', 100, 2731, 100]}
2018-11-27 11:52:40,535 (1924) :  DEBUG (preferences:258) - Loaded preferences from DefaultPrefs.json
2018-11-27 11:52:40,538 (1924) :  DEBUG (preferences:178) - Loaded the user preferences for com.plexapp.agents.imdb
2018-11-27 11:52:40,552 (1924) :  DEBUG (networking:166) - Requesting 'http://127.0.0.1:32400/services/tmdb?uri=%2Fmovie%2Ftt3521126%3Fappend_to_response%3Dreleases%2Ccredits%26language%3D'
2018-11-27 11:52:42,927 (1924) :  INFO (logkit:16) - Adding title_year match: The Disaster Artist (2017) score=100, key=tt3521126
2018-11-27 11:52:42,928 (1924) :  INFO (logkit:16) - Found perfect match with title/year query.
2018-11-27 11:52:42,930 (1924) :  DEBUG (runtime:88) - Sending packed state data (580 bytes)
2018-11-27 11:52:42,930 (1924) :  DEBUG (runtime:924) - Response: [200] str, 652 bytes
2018-11-27 11:52:43,032 (2680) :  DEBUG (runtime:717) - Handling request GET /:/plugins/com.plexapp.agents.imdb/messaging/function/X0FnZW50S2l0OlVwZGF0ZU1ldGFkYXRh/Y2VyZWFsMQoxCmxpc3QKMApyMAo_/Y2VyZWFsMQoxCmRpY3QKMTAKczIKZW5zNApsYW5nYjFzNQpmb3JjZWIwczgKcGVyaW9kaWNzMwozMDBzNApkYmlkaTAKczcKdmVyc2lvbm5zMTAKcGFyZW50R1VJRG5zOApwYXJlbnRJRHM1Ck1vdmllczEwCm1lZGlhX3R5cGVzNDMKY29tLnBsZXhhcHAuYWdlbnRzLmltZGI6Ly90dDM1MjExMjY%40bGFuZz1lbnM0Cmd1aWRzOQp0dDM1MjExMjZzMgppZHIwCg__
2018-11-27 11:52:43,032 (2680) :  DEBUG (runtime:814) - Found route matching /:/plugins/com.plexapp.agents.imdb/messaging/function/X0FnZW50S2l0OlVwZGF0ZU1ldGFkYXRh/Y2VyZWFsMQoxCmxpc3QKMApyMAo_/Y2VyZWFsMQoxCmRpY3QKMTAKczIKZW5zNApsYW5nYjFzNQpmb3JjZWIwczgKcGVyaW9kaWNzMwozMDBzNApkYmlkaTAKczcKdmVyc2lvbm5zMTAKcGFyZW50R1VJRG5zOApwYXJlbnRJRHM1Ck1vdmllczEwCm1lZGlhX3R5cGVzNDMKY29tLnBsZXhhcHAuYWdlbnRzLmltZGI6Ly90dDM1MjExMjY@bGFuZz1lbnM0Cmd1aWRzOQp0dDM1MjExMjZzMgppZHIwCg__
2018-11-27 11:52:43,032 (2680) :  DEBUG (model:32) - Loading model with GUID com.plexapp.agents.imdb://tt3521126?lang=en
2018-11-27 11:52:43,033 (2680) :  ERROR (model:205) - Cannot read model from C:\Users\Mega\AppData\Local\Plex Media Server\Metadata\Movies\b\90194b6a95b772ffe1ae4b9a1486cbe2e266858.bundle\Contents\com.plexapp.agents.imdb
2018-11-27 11:52:43,035 (2680) :  DEBUG (networking:166) - Requesting 'http://127.0.0.1:32400/library/metadata/300/tree'
2018-11-27 11:52:43,068 (2680) :  DEBUG (networking:161) - Fetching 'http://127.0.0.1:32400/services/tmdb?uri=%2Fconfiguration' from the HTTP cache
2018-11-27 11:52:43,115 (2680) :  DEBUG (networking:166) - Requesting 'http://127.0.0.1:32400/services/tmdb?uri=%2Fmovie%2Ftt3521126%3Fappend_to_response%3Dreleases%2Ccredits%26language%3Den'
2018-11-27 11:52:45,283 (2680) :  DEBUG (networking:166) - Requesting 'http://127.0.0.1:32400/services/tmdb?uri=%2Fmovie%2Ftt3521126%2Fimages'
2018-11-27 11:52:47,453 (2680) :  DEBUG (networking:166) - Requesting 'http://127.0.0.1:32400/services/tmdb?uri=%2Fmovie%2F371638%2Frecommendations'
2018-11-27 11:52:49,628 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w300/uuoHuUsIZXdcH3IT9u2Ei55LGsE.jpg'
2018-11-27 11:52:49,795 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w300/uuoHuUsIZXdcH3IT9u2Ei55LGsE.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:49,811 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w300/orF6ZgjWMjSJxKTPftCuP6lH14b.jpg'
2018-11-27 11:52:49,859 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w300/orF6ZgjWMjSJxKTPftCuP6lH14b.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:49,878 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w300/qviKEoUd4Mx2x3lkHpgSMhKX57i.jpg'
2018-11-27 11:52:49,940 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w300/qviKEoUd4Mx2x3lkHpgSMhKX57i.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:49,957 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w300/7vwHn5mmfWMoRMvKYjZfXbfxEgH.jpg'
2018-11-27 11:52:50,006 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w300/7vwHn5mmfWMoRMvKYjZfXbfxEgH.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:50,020 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w300/y85k6vZMe3dxs7EqOPXBe0jHnhT.jpg'
2018-11-27 11:52:50,066 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w300/y85k6vZMe3dxs7EqOPXBe0jHnhT.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:50,082 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w300/bAI7aPHQcvSZXvt7L11kMJdS0Gm.jpg'
2018-11-27 11:52:50,130 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w300/bAI7aPHQcvSZXvt7L11kMJdS0Gm.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:50,148 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w300/cCIWU5b4izIpLeGQnQNW7iTtIDN.jpg'
2018-11-27 11:52:50,203 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w300/cCIWU5b4izIpLeGQnQNW7iTtIDN.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:50,220 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w154/uCH6FOFsDW6pfvbbmIIswuvuNtM.jpg'
2018-11-27 11:52:50,263 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w154/uCH6FOFsDW6pfvbbmIIswuvuNtM.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:50,279 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w154/2HuLGiyH0TPYxnCvYHAxc8K738o.jpg'
2018-11-27 11:52:50,325 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w154/2HuLGiyH0TPYxnCvYHAxc8K738o.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:50,342 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w154/m1cZJSvk1uTSRBGjsVcF6Xmkp94.jpg'
2018-11-27 11:52:50,390 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w154/m1cZJSvk1uTSRBGjsVcF6Xmkp94.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:50,405 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w154/z3fB5sXne2ez8YAqCCEq1nPQ6LK.jpg'
2018-11-27 11:52:50,463 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w154/z3fB5sXne2ez8YAqCCEq1nPQ6LK.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:50,480 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w154/gIA9GE5ewJwxqJgAy8Sr6CcbHbn.jpg'
2018-11-27 11:52:50,553 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w154/gIA9GE5ewJwxqJgAy8Sr6CcbHbn.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:50,569 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w154/zOw14WU42SwoFBO2rBpToLhD6bC.jpg'
2018-11-27 11:52:50,621 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w154/zOw14WU42SwoFBO2rBpToLhD6bC.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:50,637 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w154/tZZESBzZU5SkE6wPIfzd15GMGqv.jpg'
2018-11-27 11:52:50,687 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w154/tZZESBzZU5SkE6wPIfzd15GMGqv.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:50,703 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w154/pQX6iUZOhh2CWyZ9tfEVe88ajL2.jpg'
2018-11-27 11:52:50,747 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w154/pQX6iUZOhh2CWyZ9tfEVe88ajL2.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:50,765 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w154/2rWG973pYPhD3vVTiB8ElE3llzg.jpg'
2018-11-27 11:52:50,815 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w154/2rWG973pYPhD3vVTiB8ElE3llzg.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:50,831 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w154/it17plQKTYY03JZV6m7VqtfReMm.jpg'
2018-11-27 11:52:50,878 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w154/it17plQKTYY03JZV6m7VqtfReMm.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:50,894 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w154/tqAHnFLaPVKXgtEfVXE7jPEJSMF.jpg'
2018-11-27 11:52:50,946 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w154/tqAHnFLaPVKXgtEfVXE7jPEJSMF.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:50,963 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w154/9rH9R7z10k1baSH8cvko2e9jiEH.jpg'
2018-11-27 11:52:51,007 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w154/9rH9R7z10k1baSH8cvko2e9jiEH.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:51,023 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w154/pUAiTAtUQliI6ofT0uidgtBISXv.jpg'
2018-11-27 11:52:51,069 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w154/pUAiTAtUQliI6ofT0uidgtBISXv.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:51,085 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w154/jj84nF5vYRD0HUTowBKcrKk8hZP.jpg'
2018-11-27 11:52:51,140 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w154/jj84nF5vYRD0HUTowBKcrKk8hZP.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:51,157 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w154/mIu3lfpxwt5YprslsSjnU0nZj8y.jpg'
2018-11-27 11:52:51,207 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w154/mIu3lfpxwt5YprslsSjnU0nZj8y.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:51,221 (2680) :  DEBUG (networking:166) - Requesting 'http://image.tmdb.org/t/p/w154/1htrNldlPGx2ZIyKvsoWbRkjGBQ.jpg'
2018-11-27 11:52:51,266 (2680) :  DEBUG (networking:198) - Not caching 'http://image.tmdb.org/t/p/w154/1htrNldlPGx2ZIyKvsoWbRkjGBQ.jpg' (content type 'image/jpeg' not cacheable in Agent plug-ins)
2018-11-27 11:52:51,286 (2680) :  DEBUG (networking:166) - Requesting 'https://meta.plex.tv/m/3521126?lang=en&ratings=1&reviews=1&extras=1'
2018-11-27 11:52:51,418 (2680) :  DEBUG (networking:161) - Fetching 'http://127.0.0.1:32400/services/tmdb?uri=%2Fmovie%2Ftt3521126%3Fappend_to_response%3Dreleases%2Ccredits%26language%3D' from the HTTP cache
2018-11-27 11:52:51,467 (2680) :  INFO (logkit:16) - Added 1 of 10 extras.
2018-11-27 11:52:51,486 (2680) :  DEBUG (networking:166) - Requesting 'https://chapterdb.plex.tv/chapters/search?title=The%20Disaster%20Artist'
2018-11-27 11:52:52,467 (2680) :  ERROR (networking:219) - Error opening URL 'https://chapterdb.plex.tv/chapters/search?title=The%20Disaster%20Artist'
2018-11-27 11:52:52,467 (2680) :  INFO (logkit:16) - Error obtaining Plex movie Chapter data for 3521126: HTTP Error 401: Unauthorized
2018-11-27 11:52:52,638 (2680) :  DEBUG (services:616) - Found a service matching 'iva://api.internetvideoarchive.com/2.0/DataService/VideoAssets(713858)?lang=en&bitrates=80,212,450,750,1500,2500,5000,8000&duration=137&adaptive=1&dts=0' - IVA (com.plexapp.agents.imdb)
2018-11-27 11:52:52,638 (2680) :  DEBUG (services:41) - Loading service code for IVA (URLServiceRecord)
2018-11-27 11:52:52,674 (2680) :  DEBUG (services:41) - Loading service code for Fallback (URLServiceRecord)
2018-11-27 11:52:52,769 (2680) :  DEBUG (services:616) - Found a service matching 'iva://api.internetvideoarchive.com/2.0/DataService/VideoAssets(713858)?lang=en&bitrates=80,212,450,750,1500,2500,5000,8000&duration=137&adaptive=1&dts=0' - IVA (com.plexapp.agents.imdb)
2018-11-27 11:52:52,772 (2680) :  DEBUG (services:616) - Found a service matching 'iva://api.internetvideoarchive.com/2.0/DataService/VideoAssets(713858)?lang=en&bitrates=80,212,450,750,1500,2500,5000,8000&duration=137&adaptive=1&dts=0' - IVA (com.plexapp.agents.imdb)
2018-11-27 11:52:52,776 (2680) :  DEBUG (model:229) - Serializing to C:\Users\Mega\AppData\Local\Plex Media Server\Metadata\Movies\b\90194b6a95b772ffe1ae4b9a1486cbe2e266858.bundle\Contents\com.plexapp.agents.imdb\Info.xml
2018-11-27 11:52:52,779 (2680) :  DEBUG (runtime:88) - Sending packed state data (1056 bytes)
2018-11-27 11:52:52,779 (2680) :  DEBUG (runtime:924) - Response: [200] str, 16 bytes
