Aug 01, 2018 14:47:04 [0x54288400] DEBUG - Auth: We found auth token (xxxxxxxxxxxxxxxxxxxx), enabling token-based authentication.
Aug 01, 2018 14:47:04 [0x54288400] DEBUG - Auth: Came in with a super-token, authorization succeeded.
Aug 01, 2018 14:47:04 [0x54288400] DEBUG - Found session GUID of zly34ucmqn in session start.
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - TranscodeUniversalRequest: using profile Web
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - Downloading document
http://127.0.0.1:32400/library/metadata/51?X-Plex-Token=xxxxxxxxxxxxxxxxxxxx&checkFiles=1
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - HTTP requesting GET
http://127.0.0.1:32400/library/metadata/51?X-Plex-Token=xxxxxxxxxxxxxxxxxxxx&checkFiles=1
Aug 01, 2018 14:47:05 [0x52a88400] DEBUG - Request: [127.0.0.1:30578] GET /library/metadata/51 (5 live) GZIP
Aug 01, 2018 14:47:05 [0x52a88400] DEBUG - Auth: We found auth token (xxxxxxxxxxxxxxxxxxxx), enabling token-based authentication.
Aug 01, 2018 14:47:05 [0x52a88400] DEBUG - Auth: Came in with a super-token, authorization succeeded.
Aug 01, 2018 14:47:05 [0x52a88400] DEBUG - Updating part with ID=46 [/mnt/000/Layer Cake.avi]
Aug 01, 2018 14:47:05 [0x52a88400] DEBUG - We're going to try to auto-select an audio stream for account 1.
Aug 01, 2018 14:47:05 [0x52a88400] DEBUG - Selecting best audio stream for part ID 46 (autoselect: 0 language: ru)
Aug 01, 2018 14:47:05 [0x52a88400] DEBUG - Audio Stream: 126, Subtitle Stream: -1
Aug 01, 2018 14:47:05 [0x52a88400] DEBUG - It took 0.0 sec to serialize a list with 1 elements.
Aug 01, 2018 14:47:05 [0x45b85400] DEBUG - Completed: [127.0.0.1:30578] GET /library/metadata/51 (5 live) GZIP 150ms 2386 bytes 200
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - MDE: analyzing media item 46
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - MDE: Layer Cake (2005): Direct Play is disabled
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - MDE: Layer Cake (2005): no direct play video profile exists for http/avi/mpeg4
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - MDE: Layer Cake (2005): no direct play video profile exists for http/avi/mpeg4/mp3
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - MDE: Layer Cake (2005): no remuxable profile found, so video stream will be transcoded
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - MDE: computed resolution bounding box of 688x288.
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - Scaled up video bitrate to 1276Kbps based on 1.500000x fudge factor.
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - MDE: Layer Cake (2005): selected media 0 / 46
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - Cleaning directory for session zly34ucmqn ()
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - Starting a transcode session zly34ucmqn at offset -1.0 (state=2)
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - [Universal] Using local file path instead of URL: /mnt/000/Layer Cake.avi
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - TranscodeJobManager: [Running] onTranscodeSessionStarted: zly34ucmqn
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - TranscodeJobManager: [Running] -> [Throttled]
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - Job running: XDG_CACHE_HOME='/home/Library/Caches/PlexMediaServer/' XDG_DATA_HOME='/plex/Resources/' '/plex/Resources/Plex New Transcoder' '-i' '/mnt/000/Layer Cake.avi' '-filter_complex' '[0:0]scale=w=min(688\,iw):h=min(288\,ih):force_original_aspect_ratio=decrease[0]' '-map' '[0]' '-codec:0' 'libx264' '-crf:0' '18' '-pix_fmt:0' 'yuv420p' '-maxrate:0' '1276k' '-bufsize:0' '2552k' '-r:0' '23.975999999999999' '-preset:0' 'veryfast' '-x264opts:0' 'cabac=0:8x8dct=1:bframes=0:subme=2:me_range=4:rc_lookahead=10:me=dia:no_chroma_me:8x8dct=0artitions=none' '-map' '0:#0x01' '-codec:1' 'aac' '-strict:1' 'experimental' '-cutoff:1' '15000' '-ar:1' '48000' '-channel_layout:1' 'stereo' '-b:1' '256k' '-f' 'matroska' '-avoid_negative_ts' 'disabled' '-map_metadata' '-1' '-map_chapters' '-1' '-' '-start_at_zero' '-copyts' '-y' '-nostats' '-loglevel' 'quiet' '-loglevel_plex' 'error' '-progressurl' 'http://127.0.0.1:32400/video/:/transcode/session/zly34ucmqn/progress'
Aug 01, 2018 14:47:05 [0x54288400] ERROR - Failed to start session successfully.
Aug 01, 2018 14:47:05 [0x54288400] DEBUG - Cleaning directory for session zly34ucmqn (/home/Library/Caches/PlexMediaServer/Transcode/Sessions/plex-transcode-zly34ucmqn-6c16e98f-1fdc-4c4c-a46b-a9923ccbdcc2)
Aug 01, 2018 14:47:05 [0x45b85400] DEBUG - Completed: [192.168.1.104:49491] GET /video/:/transcode/universal/start?path=http%3A%2F%2F127.0.0.1%3A32400%2Flibrary%2Fmetadata%2F51&mediaIndex=0&partIndex=0&protocol=http&offset=0&fastSeek=1&directPlay=0&directStream=1&subtitleSize=100&audioBoost=100&session=zly34ucmqn&subtitles=burn©ts=1&Accept-Language=en (5 live) 933ms 251 bytes 404