DSM 6.2.4 - Plex oes not find metadata for TV

Plex Media Server NAS & Devices
,
1

Server Version#: 1.24.1.4931
Player Version#:n/a

Plex is not finding any images or metadata for all TV shows. This is true regardless of the scanner and agent chosen (I’ve cycled through them 1 by 1). If I enable “use local assets” it will find the files stored with the video files, but the local data is incomplete, so it would be better if Plex loaded this data.

The Plex dance hasn’t changed anything, and neither has deleting the images and everything in the /config directory and reinstalling.

This is running on a Synology 918+ using DSM 6.2.4, and using the official Plex docker image.

The docker logs are clean.

Plex Media Center Matcher log is showing:

> Aug 30, 2021 23:25:37.747 [0x7f5912525b38] INFO - Plex Media Scanner v1.24.1.4931-1a38e63c6 - Docker Docker Container x86_64 - build: linux-x86_64 - GMT -04:00
> Aug 30, 2021 23:25:37.748 [0x7f5912525b38] INFO - Linux version: 4.4.59+, language: en-US
> Aug 30, 2021 23:25:37.748 [0x7f5912525b38] INFO - Processor Intel(R) Celeron(R) CPU J3455 @ 1.50GHz
> Aug 30, 2021 23:25:37.748 [0x7f5912525b38] INFO - /usr/lib/plexmediaserver/Plex Media Scanner --match --type 2 --log-file-suffix  Matcher --item 172
> Aug 30, 2021 23:25:37.748 [0x7f59153e3848] DEBUG - Opening 20 database sessions to library (com.plexapp.plugins.library), SQLite 3.35.5, threadsafe=1
> Aug 30, 2021 23:25:37.944 [0x7f59153e3848] DEBUG - Matcher: found 20 auxiliary files for Season 3
> Aug 30, 2021 23:25:37.948 [0x7f59153e3848] DEBUG - [MI] Opening input file: "/tv/American Gods (2017)/Season 3/American Gods - S03E01 - A Winters Tale.mp4"
> Aug 30, 2021 23:25:37.948 [0x7f59153e3848] DEBUG - [FFMPEG] - Opening '/tv/American Gods (2017)/Season 3/American Gods - S03E01 - A Winters Tale.mp4' for reading
> Aug 30, 2021 23:25:37.948 [0x7f59153e3848] DEBUG - [FFMPEG] - Setting default whitelist 'file,crypto'
> Aug 30, 2021 23:25:37.949 [0x7f59153e3848] DEBUG - [FFMPEG] - Format mov,mp4,m4a,3gp,3g2,mj2 probed with size=2048 and score=100
> Aug 30, 2021 23:25:37.949 [0x7f59153e3848] DEBUG - [FFMPEG] - ISO: File Type Major Brand: isom
> Aug 30, 2021 23:25:37.949 [0x7f59153e3848] DEBUG - [FFMPEG] - Unknown dref type 0x206c7275 size 12
> Aug 30, 2021 23:25:37.962 [0x7f59153e3848] DEBUG - [FFMPEG] - Processing st: 0, edit list 0 - media time: 2002, duration: 80335272
> Aug 30, 2021 23:25:37.969 [0x7f59153e3848] DEBUG - [FFMPEG] - Offset DTS by 2002 to make first pts zero.
> Aug 30, 2021 23:25:37.971 [0x7f59153e3848] DEBUG - [FFMPEG] - Setting codecpar->delay to 2 for stream st: 0
> Aug 30, 2021 23:25:37.971 [0x7f59153e3848] DEBUG - [FFMPEG] - Unknown dref type 0x206c7275 size 12
> Aug 30, 2021 23:25:37.983 [0x7f59153e3848] DEBUG - [FFMPEG] - Processing st: 1, edit list 0 - media time: 256, duration: 160671456
> Aug 30, 2021 23:25:37.983 [0x7f59153e3848] DEBUG - [FFMPEG] - skip 256 audio samples from curr_cts: 0
> Aug 30, 2021 23:25:37.988 [0x7f59153e3848] DEBUG - [FFMPEG] - Unknown dref type 0x206c7275 size 12
> Aug 30, 2021 23:25:37.988 [0x7f59153e3848] DEBUG - [FFMPEG] - Processing st: 2, edit list 0 - media time: 0, duration: 3316008000
> Aug 30, 2021 23:25:37.988 [0x7f59153e3848] DEBUG - [FFMPEG] - Unknown dref type 0x206c7275 size 12
> Aug 30, 2021 23:25:37.988 [0x7f59153e3848] DEBUG - [FFMPEG] - Processing st: 3, edit list 0 - media time: 0, duration: 3347328
> Aug 30, 2021 23:25:37.989 [0x7f59153e3848] INFO - CodecManager: obtaining decoder 'h264'
> Aug 30, 2021 23:25:37.989 [0x7f59153e3848] DEBUG - HTTP requesting GET https://plex.tv/api/codecs/h264_decoder?build=linux-x86_64-standard&deviceId=3f6305b1-c525-47a7-948c-7e2edb81d539&oldestPreviousVersion=legacy&version=be22e26-3998
> Aug 30, 2021 23:25:51.119 [0x7f59153e3848] ERROR - Error issuing curl_easy_perform(handle): 28
> Aug 30, 2021 23:25:51.119 [0x7f59153e3848] DEBUG - HTTP simulating 408 after curl timeout
> Aug 30, 2021 23:25:51.120 [0x7f59153e3848] ERROR - Codecs: Failed to download XML for codec 'h264_decoder'
> Aug 30, 2021 23:25:51.120 [0x7f59153e3848] ERROR - CodecManager: failed to install codec for h264
> Aug 30, 2021 23:25:51.120 [0x7f59153e3848] ERROR - [MI] Failed to install codec h264
> Aug 30, 2021 23:25:51.120 [0x7f59153e3848] DEBUG - [FFMPEG] - Before avformat_find_stream_info() pos: 1742071199 bytes read:2185653 seeks:3 nb_streams:4
> Aug 30, 2021 23:25:51.120 [0x7f59153e3848] DEBUG - [FFMPEG] - demuxer injecting skip 256 / discard 0
> Aug 30, 2021 23:25:51.120 [0x7f59153e3848] DEBUG - [FFMPEG] - All info found
> Aug 30, 2021 23:25:51.120 [0x7f59153e3848] DEBUG - [FFMPEG] - After avformat_find_stream_info() pos: 5200 bytes read:2218421 seeks:4 frames:5
> Aug 30, 2021 23:25:51.120 [0x7f59153e3848] INFO - CodecManager: obtaining decoder 'h264'
> Aug 30, 2021 23:25:51.120 [0x7f59153e3848] DEBUG - HTTP requesting GET https://plex.tv/api/codecs/h264_decoder?build=linux-x86_64-standard&deviceId=3f6305b1-c525-47a7-948c-7e2edb81d539&oldestPreviousVersion=legacy&version=be22e26-3998
> Aug 30, 2021 23:26:04.247 [0x7f59153e3848] ERROR - Error issuing curl_easy_perform(handle): 28
> Aug 30, 2021 23:26:04.247 [0x7f59153e3848] DEBUG - HTTP simulating 408 after curl timeout
> Aug 30, 2021 23:26:04.247 [0x7f59153e3848] ERROR - Codecs: Failed to download XML for codec 'h264_decoder'
> Aug 30, 2021 23:26:04.247 [0x7f59153e3848] ERROR - CodecManager: failed to install codec for h264
> Aug 30, 2021 23:26:04.247 [0x7f59153e3848] ERROR - [MI] Failed to install codec h264
> Aug 30, 2021 23:26:04.247 [0x7f59153e3848] DEBUG - [MI] Closing input file: "/tv/American Gods (2017)/Season 3/American Gods - S03E01 - A Winters Tale.mp4"
> Aug 30, 2021 23:26:04.248 [0x7f59153e3848] DEBUG - Matcher: no sidecar subtitle files found for /tv/American Gods (2017)/Season 3/American Gods - S03E01 - A Winters Tale.mp4
> Aug 30, 2021 23:26:04.248 [0x7f59153e3848] DEBUG - Matcher: no valid subtitles found, removing any existing media bundle file
> Aug 30, 2021 23:26:04.248 [0x7f59153e3848] DEBUG - Scanner: found local media asset "/tv/American Gods (2017)/Season 3/American Gods - S03E01 - A Winters Tale-thumb.jpg"
> Aug 30, 2021 23:26:04.249 [0x7f59153e3848] DEBUG - [MI] Opening input file: "/tv/American Gods (2017)/Season 3/American Gods - S03E02 - Serious Moonlight.mp4"

PlexAppAgentsIMDB shows:

2021-08-30 23:13:08,412 (7fcb923d3848) :  DEBUG (core:450) - Starting notifications component.
2021-08-30 23:13:08,707 (7fcb923d3848) :  DEBUG (accessor:68) - Creating a new model access point for provider com.plexapp.agents.imdb in namespace 'metadata'
2021-08-30 23:13:08,718 (7fcb923d3848) :  DEBUG (networking:143) - Requesting 'http://127.0.0.1:32400/:/plugins/com.plexapp.system/resourceHashes'
2021-08-30 23:13:08,797 (7fcb923d3848) :  ERROR (networking:196) - Error opening URL 'http://127.0.0.1:32400/:/plugins/com.plexapp.system/resourceHashes'
2021-08-30 23:13:08,801 (7fcb923d3848) :  CRITICAL (runtime:1299) - Exception getting hosted resource hashes (most recent call last):
  File "/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/Framework.bundle/Contents/Resources/Versions/2/Python/Framework/components/runtime.py", line 1293, in get_resource_hashes
    json = self._core.networking.http_request("http://127.0.0.1:32400/:/plugins/com.plexapp.system/resourceHashes", timeout=10).content
  File "/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/Framework.bundle/Contents/Resources/Versions/2/Python/Framework/components/networking.py", line 242, in content
    return self.__str__()
  File "/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/Framework.bundle/Contents/Resources/Versions/2/Python/Framework/components/networking.py", line 220, in __str__
    self.load()
  File "/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/Framework.bundle/Contents/Resources/Versions/2/Python/Framework/components/networking.py", line 158, in load
    f = self._opener.open(req, timeout=self._timeout)
  File "/usr/lib/plexmediaserver/Resources/Python/python27.zip/urllib2.py", line 435, in open
    response = meth(req, response)
  File "/usr/lib/plexmediaserver/Resources/Python/python27.zip/urllib2.py", line 548, in http_response
    'http', request, response, code, msg, hdrs)
  File "/usr/lib/plexmediaserver/Resources/Python/python27.zip/urllib2.py", line 473, in error
    return self._call_chain(*args)
  File "/usr/lib/plexmediaserver/Resources/Python/python27.zip/urllib2.py", line 407, in _call_chain
    result = func(*args)
  File "/usr/lib/plexmediaserver/Resources/Python/python27.zip/urllib2.py", line 556, in http_error_default
    raise HTTPError(req.get_full_url(), code, msg, hdrs, fp)
HTTPError: HTTP Error 404: Not Found

com.plexapp.system.log shows:

 CRITICAL (storage:60) - Exception reading file /usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/WebClient.bundle/Contents/Info.plist (most recent call last):
  File "/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/Framework.bundle/Contents/Resources/Versions/2/Python/Framework/components/storage.py", line 55, in load
    f = open(filename, mode)
IOError: [Errno 2] No such file or directory: '/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/WebClient.bundle/Contents/Info.plist'

2021-08-30 23:58:27,997 (7f82c839bb38) :  CRITICAL (bundleservice:137) - Exception adding bundle: WebClient.bundle (most recent call last):
  File "/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/System.bundle/Contents/Code/bundleservice.py", line 124, in update_bundles
    bundle = BundleInfo(self.system, path, plugin)
  File "/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/System.bundle/Contents/Code/bundleservice.py", line 18, in __init__
    self.load_plist()
  File "/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/System.bundle/Contents/Code/bundleservice.py", line 22, in load_plist
    plist = Plist.ObjectFromString(Core.storage.load(Core.storage.join_path(self.path, "Contents", "Info.plist")))
  File "/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/Framework.bundle/Contents/Resources/Versions/2/Python/Framework/api/parsekit.py", line 32, in ObjectFromString
    check_size(string, max_size)
  File "/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/Framework.bundle/Contents/Resources/Versions/2/Python/Framework/api/parsekit.py", line 22, in check_size
    if len(data) > max_size:
TypeError: object of type 'NoneType' has no len()

2021-08-30 23:58:28,026 (7f82c8df5b38) :  DEBUG (services:362) - Loaded services
2021-08-30 23:58:28,037 (7f82c839bb38) :  DEBUG (runtime:924) - Response: [200] MediaContainer, 11288 bytes
2021-08-30 23:58:28,041 (7f82c8ae4b38) :  CRITICAL (storage:60) - Exception reading file /usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/WebClient.bundle/Contents/Info.plist (most recent call last):
  File "/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/Framework.bundle/Contents/Resources/Versions/2/Python/Framework/components/storage.py", line 55, in load
    f = open(filename, mode)
IOError: [Errno 2] No such file or directory: '/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/WebClient.bundle/Contents/Info.plist'

2021-08-30 23:58:28,046 (7f82c8dd2b38) :  DEBUG (services:438) - No shared code to load
2021-08-30 23:58:28,052 (7f82c8ae4b38) :  CRITICAL (bundleservice:137) - Exception adding bundle: WebClient.bundle (most recent call last):
  File "/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/System.bundle/Contents/Code/bundleservice.py", line 124, in update_bundles
    bundle = BundleInfo(self.system, path, plugin)
  File "/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/System.bundle/Contents/Code/bundleservice.py", line 18, in __init__
    self.load_plist()
  File "/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/System.bundle/Contents/Code/bundleservice.py", line 22, in load_plist
    plist = Plist.ObjectFromString(Core.storage.load(Core.storage.join_path(self.path, "Contents", "Info.plist")))
  File "/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/Framework.bundle/Contents/Resources/Versions/2/Python/Framework/api/parsekit.py", line 32, in ObjectFromString
    check_size(string, max_size)
  File "/usr/lib/plexmediaserver/Resources/Plug-ins-1a38e63c6/Framework.bundle/Contents/Resources/Versions/2/Python/Framework/api/parsekit.py", line 22, in check_size
    if len(data) > max_size:
TypeError: object of type 'NoneType' has no len()
3

Plex Logs are below:
Plex Media Server Logs_2021-08-31_00-03-06.zip (262.2 KB)

5

Deleting preferences did not address the issue.

I can access the webUI at the xxx.yyy.zz.aaa:32400, as I could before.

This definitely appears to be a networking issue. The NAS can access the Internet as evidenced by it’s ability to send email notifications and check for updates. Other docker images are able to access the Internet. Like the other docker images, Plex is configured in bridge networking mode and there appears to be some additional configuration in Plex for this to work. What confounds me is that this was working 3-4 weeks ago and with no updates to server or docker image, it stopped.

ADVERTISE_IP is set to http://xxx.yyy.zz.aaa:32400/ What else needs to be configured?

As a test, I created a new container, but configured it to use the same network as the host (not an ideal setup), and that container works. It can pull metadata even though it’s using the same configs as the container that does not work.

One other difference of note: the failed container is configured to map post 1901 to port 1900 in Plex because 1901 is in use with another service. That has been configured that way for about a year.

6

This topic was automatically closed 90 days after the last reply. New replies are no longer allowed.