Sun Sep 21, 2014 4:21 pm by Dzigit
Hello,
I have a simillar problem, but with Panasonic Viera ST60 and win7 x64. Transcoding is not working for mp4 files.
FFMpeg run from console give the same error. So it might be a ffmpeg error.
Logs below.
- Code:
2014-09-17 15:25:28,755 DEBUG [ServiioHttpService] Incoming request from /x.x.x.3:49115: GET /resource/354/MEDIA_ITEM/MPEG_PS_PAL-0/ORIGINAL HTTP/1.1, headers = [Host: x.x.x.4:8895,TimeSeekRange.dlna.org: npt=00:00:00.000-,transferMode.dlna.org: Streaming,Connection: keep-alive]]
2014-09-17 15:25:28,755 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:28,757 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:28,758 DEBUG [ResourceDeliveryProcessor] Resource request accepted. Using client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:28,759 DEBUG [ResourceDeliveryProcessor] Request for resource 354 and type 'MEDIA_ITEM' received
2014-09-17 15:25:28,759 DEBUG [MediaResourceRetrievalStrategy] Getting information about media item 354 (local)
2014-09-17 15:25:28,759 DEBUG [MediaItemDAOImpl] Reading a MediaItem (id = 354)
2014-09-17 15:25:28,760 DEBUG [VideoDAOImpl] Reading a Video (id = 354)
2014-09-17 15:25:28,762 DEBUG [VideoDeliveryEngine] Retrieving resource information for item 354, format MPEG_PS_PAL and profile Panasonic Viera (2013)
2014-09-17 15:25:28,762 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:28,765 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:28,765 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:28,768 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:28,768 DEBUG [AbstractTranscodingDeliveryEngine] Getting media info for transcoded version of file XXX.S02E04.HDTV.x264-LOL.mp4
2014-09-17 15:25:28,769 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:28,771 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:28,772 DEBUG [VideoDeliveryEngine] Found Format profile for transcoded file XXX.S02E04.HDTV.x264-LOL.mp4: MPEG_PS_PAL
2014-09-17 15:25:28,772 DEBUG [VideoDeliveryEngine] Found Format profile for transcoded file XXX.S02E04.HDTV.x264-LOL.mp4: MPEG_PS_NTSC
2014-09-17 15:25:28,772 DEBUG [MediaResourceRetrievalStrategy] Getting information about media item 354 (local)
2014-09-17 15:25:28,773 DEBUG [MediaItemDAOImpl] Reading a MediaItem (id = 354)
2014-09-17 15:25:28,774 DEBUG [VideoDAOImpl] Reading a Video (id = 354)
2014-09-17 15:25:28,776 DEBUG [VideoDeliveryEngine] Delivering item '354' for client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:28,776 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:28,779 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:28,779 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:28,782 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:28,782 DEBUG [VideoDeliveryEngine] Delivering file 'XXX.S02E04.HDTV.x264-LOL.mp4' using transcoding
2014-09-17 15:25:28,782 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:28,785 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:28,834 DEBUG [ServiioHttpService] Incoming request from /x.x.x.3:65501: GET /resource/1124/COVER_IMAGE HTTP/1.1, headers = [User-Agent: Panasonic MIL DLNA CP UPnP/1.0 DLNADOC/1.50,Host: x.x.x.4:8895,transferMode.dlna.org: Interactive]]
2014-09-17 15:25:28,835 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:28,836 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:28,838 DEBUG [ResourceDeliveryProcessor] Resource request accepted. Using client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:28,838 DEBUG [ResourceDeliveryProcessor] Request for resource 1124 and type 'COVER_IMAGE' received
2014-09-17 15:25:28,838 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 1124)
2014-09-17 15:25:28,841 DEBUG [CoverImageRetrievalStrategy] Retrieving info of Cover image with id 1124
2014-09-17 15:25:28,841 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 1124)
2014-09-17 15:25:28,843 DEBUG [CoverImageRetrievalStrategy] Retrieving Cover image (HD) with id 1124
2014-09-17 15:25:28,843 DEBUG [GETMethodProcessor] Stream entity has length: 19577
2014-09-17 15:25:28,844 DEBUG [ResourceTransportRequestHandler] HTTP/1.1 200 OK, headers = [[Content-Type: image/jpeg,Content-Length: 19577,Date: Wed, 17 Sep 2014 13:25:28 GMT,Server: Windows 7, UPnP/1.0 DLNADOC/1.50, Serviio/1.4.1.2,Cache-control: no-cache,transferMode.dlna.org: Interactive,realTimeInfo.dlna.org: DLNA.ORG_TLAG=*]]
2014-09-17 15:25:28,867 DEBUG [ServiioHttpService] Incoming request from /x.x.x.3:11925: GET /resource/1062/COVER_IMAGE HTTP/1.1, headers = [User-Agent: Panasonic MIL DLNA CP UPnP/1.0 DLNADOC/1.50,Host: x.x.x.4:8895,transferMode.dlna.org: Interactive]]
2014-09-17 15:25:28,867 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:28,868 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:28,869 DEBUG [ResourceDeliveryProcessor] Resource request accepted. Using client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:28,869 DEBUG [ResourceDeliveryProcessor] Request for resource 1062 and type 'COVER_IMAGE' received
2014-09-17 15:25:28,869 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 1062)
2014-09-17 15:25:28,869 DEBUG [CoverImageRetrievalStrategy] Retrieving info of Cover image with id 1062
2014-09-17 15:25:28,870 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 1062)
2014-09-17 15:25:28,870 DEBUG [CoverImageRetrievalStrategy] Retrieving Cover image (HD) with id 1062
2014-09-17 15:25:28,870 DEBUG [GETMethodProcessor] Stream entity has length: 6873
2014-09-17 15:25:28,871 DEBUG [ResourceTransportRequestHandler] HTTP/1.1 200 OK, headers = [[Content-Type: image/jpeg,Content-Length: 6873,Date: Wed, 17 Sep 2014 13:25:28 GMT,Server: Windows 7, UPnP/1.0 DLNADOC/1.50, Serviio/1.4.1.2,Cache-control: no-cache,transferMode.dlna.org: Interactive,realTimeInfo.dlna.org: DLNA.ORG_TLAG=*]]
2014-09-17 15:25:28,888 DEBUG [ServiioHttpService] Incoming request from /x.x.x.3:10484: GET /resource/653/COVER_IMAGE HTTP/1.1, headers = [User-Agent: Panasonic MIL DLNA CP UPnP/1.0 DLNADOC/1.50,Host: x.x.x.4:8895,transferMode.dlna.org: Interactive]]
2014-09-17 15:25:28,888 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:28,890 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:28,891 DEBUG [ResourceDeliveryProcessor] Resource request accepted. Using client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:28,891 DEBUG [ResourceDeliveryProcessor] Request for resource 653 and type 'COVER_IMAGE' received
2014-09-17 15:25:28,892 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 653)
2014-09-17 15:25:28,893 DEBUG [CoverImageRetrievalStrategy] Retrieving info of Cover image with id 653
2014-09-17 15:25:28,894 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 653)
2014-09-17 15:25:28,896 DEBUG [CoverImageRetrievalStrategy] Retrieving Cover image (HD) with id 653
2014-09-17 15:25:28,896 DEBUG [GETMethodProcessor] Stream entity has length: 8494
2014-09-17 15:25:28,896 DEBUG [ResourceTransportRequestHandler] HTTP/1.1 200 OK, headers = [[Content-Type: image/jpeg,Content-Length: 8494,Date: Wed, 17 Sep 2014 13:25:28 GMT,Server: Windows 7, UPnP/1.0 DLNADOC/1.50, Serviio/1.4.1.2,Cache-control: no-cache,transferMode.dlna.org: Interactive,realTimeInfo.dlna.org: DLNA.ORG_TLAG=*]]
2014-09-17 15:25:28,917 DEBUG [ServiioHttpService] Incoming request from /x.x.x.3:19965: GET /resource/654/COVER_IMAGE HTTP/1.1, headers = [User-Agent: Panasonic MIL DLNA CP UPnP/1.0 DLNADOC/1.50,Host: x.x.x.4:8895,transferMode.dlna.org: Interactive]]
2014-09-17 15:25:28,917 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:28,919 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:28,920 DEBUG [ResourceDeliveryProcessor] Resource request accepted. Using client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:28,920 DEBUG [ResourceDeliveryProcessor] Request for resource 654 and type 'COVER_IMAGE' received
2014-09-17 15:25:28,920 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 654)
2014-09-17 15:25:28,922 DEBUG [CoverImageRetrievalStrategy] Retrieving info of Cover image with id 654
2014-09-17 15:25:28,923 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 654)
2014-09-17 15:25:28,924 DEBUG [CoverImageRetrievalStrategy] Retrieving Cover image (HD) with id 654
2014-09-17 15:25:28,925 DEBUG [GETMethodProcessor] Stream entity has length: 8494
2014-09-17 15:25:28,925 DEBUG [ResourceTransportRequestHandler] HTTP/1.1 200 OK, headers = [[Content-Type: image/jpeg,Content-Length: 8494,Date: Wed, 17 Sep 2014 13:25:28 GMT,Server: Windows 7, UPnP/1.0 DLNADOC/1.50, Serviio/1.4.1.2,Cache-control: no-cache,transferMode.dlna.org: Interactive,realTimeInfo.dlna.org: DLNA.ORG_TLAG=*]]
2014-09-17 15:25:28,946 DEBUG [ServiioHttpService] Incoming request from /x.x.x.3:44601: GET /resource/1058/COVER_IMAGE HTTP/1.1, headers = [User-Agent: Panasonic MIL DLNA CP UPnP/1.0 DLNADOC/1.50,Host: x.x.x.4:8895,transferMode.dlna.org: Interactive]]
2014-09-17 15:25:28,946 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:28,947 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:28,948 DEBUG [ResourceDeliveryProcessor] Resource request accepted. Using client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:28,948 DEBUG [ResourceDeliveryProcessor] Request for resource 1058 and type 'COVER_IMAGE' received
2014-09-17 15:25:28,948 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 1058)
2014-09-17 15:25:28,949 DEBUG [CoverImageRetrievalStrategy] Retrieving info of Cover image with id 1058
2014-09-17 15:25:28,949 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 1058)
2014-09-17 15:25:28,950 DEBUG [CoverImageRetrievalStrategy] Retrieving Cover image (HD) with id 1058
2014-09-17 15:25:28,950 DEBUG [GETMethodProcessor] Stream entity has length: 8494
2014-09-17 15:25:28,950 DEBUG [ResourceTransportRequestHandler] HTTP/1.1 200 OK, headers = [[Content-Type: image/jpeg,Content-Length: 8494,Date: Wed, 17 Sep 2014 13:25:28 GMT,Server: Windows 7, UPnP/1.0 DLNADOC/1.50, Serviio/1.4.1.2,Cache-control: no-cache,transferMode.dlna.org: Interactive,realTimeInfo.dlna.org: DLNA.ORG_TLAG=*]]
2014-09-17 15:25:28,978 DEBUG [ServiioHttpService] Incoming request from /x.x.x.3:11632: GET /resource/663/COVER_IMAGE HTTP/1.1, headers = [User-Agent: Panasonic MIL DLNA CP UPnP/1.0 DLNADOC/1.50,Host: x.x.x.4:8895,transferMode.dlna.org: Interactive]]
2014-09-17 15:25:28,978 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:28,979 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:28,980 DEBUG [ResourceDeliveryProcessor] Resource request accepted. Using client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:28,980 DEBUG [ResourceDeliveryProcessor] Request for resource 663 and type 'COVER_IMAGE' received
2014-09-17 15:25:28,980 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 663)
2014-09-17 15:25:28,980 DEBUG [CoverImageRetrievalStrategy] Retrieving info of Cover image with id 663
2014-09-17 15:25:28,980 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 663)
2014-09-17 15:25:28,981 DEBUG [CoverImageRetrievalStrategy] Retrieving Cover image (HD) with id 663
2014-09-17 15:25:28,981 DEBUG [GETMethodProcessor] Stream entity has length: 8494
2014-09-17 15:25:28,981 DEBUG [ResourceTransportRequestHandler] HTTP/1.1 200 OK, headers = [[Content-Type: image/jpeg,Content-Length: 8494,Date: Wed, 17 Sep 2014 13:25:28 GMT,Server: Windows 7, UPnP/1.0 DLNADOC/1.50, Serviio/1.4.1.2,Cache-control: no-cache,transferMode.dlna.org: Interactive,realTimeInfo.dlna.org: DLNA.ORG_TLAG=*]]
2014-09-17 15:25:29,010 DEBUG [ServiioHttpService] Incoming request from /x.x.x.3:20864: GET /resource/1041/COVER_IMAGE HTTP/1.1, headers = [User-Agent: Panasonic MIL DLNA CP UPnP/1.0 DLNADOC/1.50,Host: x.x.x.4:8895,transferMode.dlna.org: Interactive]]
2014-09-17 15:25:29,010 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:29,011 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:29,013 DEBUG [ResourceDeliveryProcessor] Resource request accepted. Using client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:29,013 DEBUG [ResourceDeliveryProcessor] Request for resource 1041 and type 'COVER_IMAGE' received
2014-09-17 15:25:29,013 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 1041)
2014-09-17 15:25:29,015 DEBUG [CoverImageRetrievalStrategy] Retrieving info of Cover image with id 1041
2014-09-17 15:25:29,015 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 1041)
2014-09-17 15:25:29,017 DEBUG [CoverImageRetrievalStrategy] Retrieving Cover image (HD) with id 1041
2014-09-17 15:25:29,017 DEBUG [GETMethodProcessor] Stream entity has length: 8494
2014-09-17 15:25:29,018 DEBUG [ResourceTransportRequestHandler] HTTP/1.1 200 OK, headers = [[Content-Type: image/jpeg,Content-Length: 8494,Date: Wed, 17 Sep 2014 13:25:29 GMT,Server: Windows 7, UPnP/1.0 DLNADOC/1.50, Serviio/1.4.1.2,Cache-control: no-cache,transferMode.dlna.org: Interactive,realTimeInfo.dlna.org: DLNA.ORG_TLAG=*]]
2014-09-17 15:25:29,045 DEBUG [ServiioHttpService] Incoming request from /x.x.x.3:52118: GET /resource/1208/COVER_IMAGE HTTP/1.1, headers = [User-Agent: Panasonic MIL DLNA CP UPnP/1.0 DLNADOC/1.50,Host: x.x.x.4:8895,transferMode.dlna.org: Interactive]]
2014-09-17 15:25:29,046 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:29,047 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:29,048 DEBUG [ResourceDeliveryProcessor] Resource request accepted. Using client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:29,049 DEBUG [ResourceDeliveryProcessor] Request for resource 1208 and type 'COVER_IMAGE' received
2014-09-17 15:25:29,049 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 1208)
2014-09-17 15:25:29,051 DEBUG [CoverImageRetrievalStrategy] Retrieving info of Cover image with id 1208
2014-09-17 15:25:29,051 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 1208)
2014-09-17 15:25:29,053 DEBUG [CoverImageRetrievalStrategy] Retrieving Cover image (HD) with id 1208
2014-09-17 15:25:29,053 DEBUG [GETMethodProcessor] Stream entity has length: 8494
2014-09-17 15:25:29,053 DEBUG [ResourceTransportRequestHandler] HTTP/1.1 200 OK, headers = [[Content-Type: image/jpeg,Content-Length: 8494,Date: Wed, 17 Sep 2014 13:25:29 GMT,Server: Windows 7, UPnP/1.0 DLNADOC/1.50, Serviio/1.4.1.2,Cache-control: no-cache,transferMode.dlna.org: Interactive,realTimeInfo.dlna.org: DLNA.ORG_TLAG=*]]
2014-09-17 15:25:29,079 DEBUG [ServiioHttpService] Incoming request from /x.x.x.3:24344: GET /resource/1209/COVER_IMAGE HTTP/1.1, headers = [User-Agent: Panasonic MIL DLNA CP UPnP/1.0 DLNADOC/1.50,Host: x.x.x.4:8895,transferMode.dlna.org: Interactive]]
2014-09-17 15:25:29,080 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:29,081 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:29,083 DEBUG [ResourceDeliveryProcessor] Resource request accepted. Using client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:29,083 DEBUG [ResourceDeliveryProcessor] Request for resource 1209 and type 'COVER_IMAGE' received
2014-09-17 15:25:29,083 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 1209)
2014-09-17 15:25:29,085 DEBUG [CoverImageRetrievalStrategy] Retrieving info of Cover image with id 1209
2014-09-17 15:25:29,085 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 1209)
2014-09-17 15:25:29,087 DEBUG [CoverImageRetrievalStrategy] Retrieving Cover image (HD) with id 1209
2014-09-17 15:25:29,087 DEBUG [GETMethodProcessor] Stream entity has length: 8494
2014-09-17 15:25:29,088 DEBUG [ResourceTransportRequestHandler] HTTP/1.1 200 OK, headers = [[Content-Type: image/jpeg,Content-Length: 8494,Date: Wed, 17 Sep 2014 13:25:29 GMT,Server: Windows 7, UPnP/1.0 DLNADOC/1.50, Serviio/1.4.1.2,Cache-control: no-cache,transferMode.dlna.org: Interactive,realTimeInfo.dlna.org: DLNA.ORG_TLAG=*]]
2014-09-17 15:25:29,115 DEBUG [ServiioHttpService] Incoming request from /x.x.x.3:17199: GET /resource/1211/COVER_IMAGE HTTP/1.1, headers = [User-Agent: Panasonic MIL DLNA CP UPnP/1.0 DLNADOC/1.50,Host: x.x.x.4:8895,transferMode.dlna.org: Interactive]]
2014-09-17 15:25:29,115 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:29,116 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:29,118 DEBUG [ResourceDeliveryProcessor] Resource request accepted. Using client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:29,118 DEBUG [ResourceDeliveryProcessor] Request for resource 1211 and type 'COVER_IMAGE' received
2014-09-17 15:25:29,118 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 1211)
2014-09-17 15:25:29,120 DEBUG [CoverImageRetrievalStrategy] Retrieving info of Cover image with id 1211
2014-09-17 15:25:29,120 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 1211)
2014-09-17 15:25:29,122 DEBUG [CoverImageRetrievalStrategy] Retrieving Cover image (HD) with id 1211
2014-09-17 15:25:29,122 DEBUG [GETMethodProcessor] Stream entity has length: 8494
2014-09-17 15:25:29,123 DEBUG [ResourceTransportRequestHandler] HTTP/1.1 200 OK, headers = [[Content-Type: image/jpeg,Content-Length: 8494,Date: Wed, 17 Sep 2014 13:25:29 GMT,Server: Windows 7, UPnP/1.0 DLNADOC/1.50, Serviio/1.4.1.2,Cache-control: no-cache,transferMode.dlna.org: Interactive,realTimeInfo.dlna.org: DLNA.ORG_TLAG=*]]
2014-09-17 15:25:29,151 DEBUG [ServiioHttpService] Incoming request from /x.x.x.3:17200: GET /resource/1212/COVER_IMAGE HTTP/1.1, headers = [User-Agent: Panasonic MIL DLNA CP UPnP/1.0 DLNADOC/1.50,Host: x.x.x.4:8895,transferMode.dlna.org: Interactive]]
2014-09-17 15:25:29,152 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:29,153 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:29,154 DEBUG [ResourceDeliveryProcessor] Resource request accepted. Using client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:29,155 DEBUG [ResourceDeliveryProcessor] Request for resource 1212 and type 'COVER_IMAGE' received
2014-09-17 15:25:29,155 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 1212)
2014-09-17 15:25:29,157 DEBUG [CoverImageRetrievalStrategy] Retrieving info of Cover image with id 1212
2014-09-17 15:25:29,157 DEBUG [CoverImageDAOImpl] Reading a CoverImage (id = 1212)
2014-09-17 15:25:29,159 DEBUG [CoverImageRetrievalStrategy] Retrieving Cover image (HD) with id 1212
2014-09-17 15:25:29,159 DEBUG [GETMethodProcessor] Stream entity has length: 8494
2014-09-17 15:25:29,159 DEBUG [ResourceTransportRequestHandler] HTTP/1.1 200 OK, headers = [[Content-Type: image/jpeg,Content-Length: 8494,Date: Wed, 17 Sep 2014 13:25:29 GMT,Server: Windows 7, UPnP/1.0 DLNADOC/1.50, Serviio/1.4.1.2,Cache-control: no-cache,transferMode.dlna.org: Interactive,realTimeInfo.dlna.org: DLNA.ORG_TLAG=*]]
2014-09-17 15:25:31,896 DEBUG [AbstractTranscodingDeliveryEngine] A suitable transcoding job already exists, re-use it for client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:31,898 DEBUG [TranscodingJobListener] Deleted temp file 'C:\Windows\TEMP\Serviio\transcoding-temp-354-viera2013-ORIGINAL-0b96604a8eb1273ae761a321d9cf07b7.stf': true
2014-09-17 15:25:31,898 DEBUG [AbstractTranscodingDeliveryEngine] Removing transcoding listener with id transcoding-temp-354-viera2013-ORIGINAL-0b96604a8eb1273ae761a321d9cf07b7.stf
2014-09-17 15:25:31,898 DEBUG [AbstractTranscodingDeliveryEngine] Removing transcoding listener with id transcoding-temp-354-viera2013-ORIGINAL-0b96604a8eb1273ae761a321d9cf07b7.stf
2014-09-17 15:25:31,898 ERROR [ResourceTransportRequestHandler] Error while processing resource, sending back 500 error. Message: FFmpeg execution failed
java.io.IOException: FFmpeg execution failed
at org.serviio.delivery.resource.transcode.FileBasedTranscodingDeliveryStrategy.createInputStream(FileBasedTranscodingDeliveryStrategy.java:49)
at org.serviio.delivery.resource.transcode.AbstractTranscodingDeliveryEngine.retrieveTranscodedResource(AbstractTranscodingDeliveryEngine.java:134)
at org.serviio.delivery.resource.AbstractDeliveryEngine.deliver(AbstractDeliveryEngine.java:110)
at org.serviio.delivery.MediaResourceRetrievalStrategy.retrieveResource(MediaResourceRetrievalStrategy.java:153)
at org.serviio.delivery.GETMethodProcessor.retrieveResource(GETMethodProcessor.java:121)
at org.serviio.delivery.GETMethodProcessor.buildDeliveryContainer(GETMethodProcessor.java:48)
at org.serviio.delivery.AbstractMethodProcessor.handleRequest(AbstractMethodProcessor.java:100)
at org.serviio.delivery.ResourceDeliveryProcessor.deliverContent(ResourceDeliveryProcessor.java:81)
at org.serviio.upnp.webserver.ResourceTransportRequestHandler.handleRequest(ResourceTransportRequestHandler.java:86)
at org.serviio.upnp.webserver.AbstractRequestHandler.handle(AbstractRequestHandler.java:61)
at org.apache.http.protocol.HttpService.doService(HttpService.java:293)
at org.serviio.upnp.webserver.ServiioHttpService.doService(ServiioHttpService.java:77)
at org.apache.http.protocol.HttpService.handleRequest(HttpService.java:212)
at org.serviio.upnp.webserver.WebServer$WorkerThread.run(WebServer.java:196)
2014-09-17 15:25:31,899 ERROR [ResourceTransportRequestHandler] Error while processing resource, sending back 500 error. Message: FFmpeg execution failed
java.io.IOException: FFmpeg execution failed
at org.serviio.delivery.resource.transcode.FileBasedTranscodingDeliveryStrategy.createInputStream(FileBasedTranscodingDeliveryStrategy.java:49)
at org.serviio.delivery.resource.transcode.AbstractTranscodingDeliveryEngine.retrieveTranscodedResource(AbstractTranscodingDeliveryEngine.java:134)
at org.serviio.delivery.resource.AbstractDeliveryEngine.deliver(AbstractDeliveryEngine.java:110)
at org.serviio.delivery.MediaResourceRetrievalStrategy.retrieveResource(MediaResourceRetrievalStrategy.java:153)
at org.serviio.delivery.GETMethodProcessor.retrieveResource(GETMethodProcessor.java:121)
at org.serviio.delivery.GETMethodProcessor.buildDeliveryContainer(GETMethodProcessor.java:48)
at org.serviio.delivery.AbstractMethodProcessor.handleRequest(AbstractMethodProcessor.java:100)
at org.serviio.delivery.ResourceDeliveryProcessor.deliverContent(ResourceDeliveryProcessor.java:81)
at org.serviio.upnp.webserver.ResourceTransportRequestHandler.handleRequest(ResourceTransportRequestHandler.java:86)
at org.serviio.upnp.webserver.AbstractRequestHandler.handle(AbstractRequestHandler.java:61)
at org.apache.http.protocol.HttpService.doService(HttpService.java:293)
at org.serviio.upnp.webserver.ServiioHttpService.doService(ServiioHttpService.java:77)
at org.apache.http.protocol.HttpService.handleRequest(HttpService.java:212)
at org.serviio.upnp.webserver.WebServer$WorkerThread.run(WebServer.java:196)
2014-09-17 15:25:32,913 DEBUG [ServiioHttpService] Incoming request from /x.x.x.3:17201: GET /resource/354/MEDIA_ITEM/MPEG_PS_PAL-0/ORIGINAL HTTP/1.1, headers = [Host: x.x.x.4:8895,TimeSeekRange.dlna.org: npt=00:00:00.000-,transferMode.dlna.org: Streaming,Connection: keep-alive]]
2014-09-17 15:25:32,914 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:32,915 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:32,917 DEBUG [ResourceDeliveryProcessor] Resource request accepted. Using client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:32,917 DEBUG [ResourceDeliveryProcessor] Request for resource 354 and type 'MEDIA_ITEM' received
2014-09-17 15:25:32,917 DEBUG [MediaResourceRetrievalStrategy] Getting information about media item 354 (local)
2014-09-17 15:25:32,917 DEBUG [MediaItemDAOImpl] Reading a MediaItem (id = 354)
2014-09-17 15:25:32,919 DEBUG [VideoDAOImpl] Reading a Video (id = 354)
2014-09-17 15:25:32,921 DEBUG [VideoDeliveryEngine] Retrieving resource information for item 354, format MPEG_PS_PAL and profile Panasonic Viera (2013)
2014-09-17 15:25:32,921 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:32,924 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:32,924 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:32,927 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:32,927 DEBUG [AbstractTranscodingDeliveryEngine] Getting media info for transcoded version of file XXX.S02E04.HDTV.x264-LOL.mp4
2014-09-17 15:25:32,927 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:32,930 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:32,930 DEBUG [VideoDeliveryEngine] Found Format profile for transcoded file XXX.S02E04.HDTV.x264-LOL.mp4: MPEG_PS_PAL
2014-09-17 15:25:32,931 DEBUG [VideoDeliveryEngine] Found Format profile for transcoded file XXX.S02E04.HDTV.x264-LOL.mp4: MPEG_PS_NTSC
2014-09-17 15:25:32,931 DEBUG [MediaResourceRetrievalStrategy] Getting information about media item 354 (local)
2014-09-17 15:25:32,931 DEBUG [MediaItemDAOImpl] Reading a MediaItem (id = 354)
2014-09-17 15:25:32,932 DEBUG [VideoDAOImpl] Reading a Video (id = 354)
2014-09-17 15:25:32,934 DEBUG [VideoDeliveryEngine] Delivering item '354' for client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:32,934 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:32,935 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:32,936 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:32,937 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:32,937 DEBUG [VideoDeliveryEngine] Delivering file 'XXX.S02E04.HDTV.x264-LOL.mp4' using transcoding
2014-09-17 15:25:32,937 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:32,938 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:32,939 DEBUG [AbstractTranscodingDeliveryEngine] No suitable transcoding job exists yet, start one for client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:32,939 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:32,940 DEBUG [FFMPEGWrapper] Invoking FFmpeg to transcode video file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.mp4
2014-09-17 15:25:32,940 DEBUG [ProcessExecutor] Starting C:\Program Files\Serviio\bin\\..\lib/ffmpeg.exe -threads auto -i C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.mp4 -y -threads auto -c:v mpeg2video -pix_fmt yuv420p -qscale:v 1 -vf subtitles=filename="C\\:/Users/Path/Downloads/XXX.S02E04.HDTV.x264-LOL.srt":original_size=720x404:charenc=UTF-8 -r 24000/1001 -g 15 -c:a ac3 -b:a 384k -ac 2 -map 0:0 -map 0:1 -sn -f vob C:\Windows\TEMP\Serviio\transcoding-temp-354-viera2013-ORIGINAL-0b96604a8eb1273ae761a321d9cf07b7.stf
2014-09-17 15:25:33,014 WARN [ProcessExecutor] Process cmd has a return code of 1! This is a possible error. Detailed output follows.
[AVFilterGraph @ 0000000002df9bc0] [Eval @ 000000000022abc0] Undefined constant or missing '(' in 'auto'
[AVFilterGraph @ 0000000002df9bc0] Unable to parse option value "auto"
[Parsed_subtitles_0 @ 0000000002df98a0] Unable to open C:/Users/Path/Downloads/XXX.S02E04.HDTV.x264-LOL.srt
[AVFilterGraph @ 0000000002df9bc0] Error initializing filter 'subtitles' with args 'filename=C\:/Users/Path/Downloads/XXX.S02E04.HDTV.x264-LOL.srt:original_size=720x404:charenc=UTF-8'
Error opening filters!
2014-09-17 15:25:33,015 DEBUG [TranscodingJobListener] Transcoding finished; successful: false
2014-09-17 15:25:34,267 DEBUG [SearchManager] Committing search index
2014-09-17 15:25:42,942 DEBUG [TranscodingJobListener] Deleted temp file 'C:\Windows\TEMP\Serviio\transcoding-temp-354-viera2013-ORIGINAL-0b96604a8eb1273ae761a321d9cf07b7.stf': true
2014-09-17 15:25:42,942 DEBUG [AbstractTranscodingDeliveryEngine] Removing transcoding listener with id transcoding-temp-354-viera2013-ORIGINAL-0b96604a8eb1273ae761a321d9cf07b7.stf
2014-09-17 15:25:42,942 ERROR [ResourceTransportRequestHandler] Error while processing resource, sending back 500 error. Message: FFmpeg execution failed
java.io.IOException: FFmpeg execution failed
at org.serviio.delivery.resource.transcode.FileBasedTranscodingDeliveryStrategy.createInputStream(FileBasedTranscodingDeliveryStrategy.java:49)
at org.serviio.delivery.resource.transcode.AbstractTranscodingDeliveryEngine.retrieveTranscodedResource(AbstractTranscodingDeliveryEngine.java:134)
at org.serviio.delivery.resource.AbstractDeliveryEngine.deliver(AbstractDeliveryEngine.java:110)
at org.serviio.delivery.MediaResourceRetrievalStrategy.retrieveResource(MediaResourceRetrievalStrategy.java:153)
at org.serviio.delivery.GETMethodProcessor.retrieveResource(GETMethodProcessor.java:121)
at org.serviio.delivery.GETMethodProcessor.buildDeliveryContainer(GETMethodProcessor.java:48)
at org.serviio.delivery.AbstractMethodProcessor.handleRequest(AbstractMethodProcessor.java:100)
at org.serviio.delivery.ResourceDeliveryProcessor.deliverContent(ResourceDeliveryProcessor.java:81)
at org.serviio.upnp.webserver.ResourceTransportRequestHandler.handleRequest(ResourceTransportRequestHandler.java:86)
at org.serviio.upnp.webserver.AbstractRequestHandler.handle(AbstractRequestHandler.java:61)
at org.apache.http.protocol.HttpService.doService(HttpService.java:293)
at org.serviio.upnp.webserver.ServiioHttpService.doService(ServiioHttpService.java:77)
at org.apache.http.protocol.HttpService.handleRequest(HttpService.java:212)
at org.serviio.upnp.webserver.WebServer$WorkerThread.run(WebServer.java:196)
2014-09-17 15:25:43,957 DEBUG [ServiioHttpService] Incoming request from /x.x.x.3:17202: GET /resource/354/MEDIA_ITEM/MPEG_PS_PAL-0/ORIGINAL HTTP/1.1, headers = [Host: x.x.x.4:8895,TimeSeekRange.dlna.org: npt=00:00:00.000-,transferMode.dlna.org: Streaming,Connection: keep-alive]]
2014-09-17 15:25:43,958 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:43,959 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:43,961 DEBUG [ResourceDeliveryProcessor] Resource request accepted. Using client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:43,961 DEBUG [ResourceDeliveryProcessor] Request for resource 354 and type 'MEDIA_ITEM' received
2014-09-17 15:25:43,961 DEBUG [MediaResourceRetrievalStrategy] Getting information about media item 354 (local)
2014-09-17 15:25:43,961 DEBUG [MediaItemDAOImpl] Reading a MediaItem (id = 354)
2014-09-17 15:25:43,963 DEBUG [VideoDAOImpl] Reading a Video (id = 354)
2014-09-17 15:25:43,965 DEBUG [VideoDeliveryEngine] Retrieving resource information for item 354, format MPEG_PS_PAL and profile Panasonic Viera (2013)
2014-09-17 15:25:43,965 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:43,967 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:43,968 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:43,970 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:43,971 DEBUG [AbstractTranscodingDeliveryEngine] Getting media info for transcoded version of file XXX.S02E04.HDTV.x264-LOL.mp4
2014-09-17 15:25:43,971 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:43,974 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:43,974 DEBUG [VideoDeliveryEngine] Found Format profile for transcoded file XXX.S02E04.HDTV.x264-LOL.mp4: MPEG_PS_PAL
2014-09-17 15:25:43,974 DEBUG [VideoDeliveryEngine] Found Format profile for transcoded file XXX.S02E04.HDTV.x264-LOL.mp4: MPEG_PS_NTSC
2014-09-17 15:25:43,975 DEBUG [MediaResourceRetrievalStrategy] Getting information about media item 354 (local)
2014-09-17 15:25:43,975 DEBUG [MediaItemDAOImpl] Reading a MediaItem (id = 354)
2014-09-17 15:25:43,976 DEBUG [VideoDAOImpl] Reading a Video (id = 354)
2014-09-17 15:25:43,978 DEBUG [VideoDeliveryEngine] Delivering item '354' for client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:43,978 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:43,981 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:43,981 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:43,984 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:43,984 DEBUG [VideoDeliveryEngine] Delivering file 'XXX.S02E04.HDTV.x264-LOL.mp4' using transcoding
2014-09-17 15:25:43,984 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:43,990 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:43,991 DEBUG [AbstractTranscodingDeliveryEngine] No suitable transcoding job exists yet, start one for client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:43,991 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:43,994 DEBUG [FFMPEGWrapper] Invoking FFmpeg to transcode video file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.mp4
2014-09-17 15:25:43,994 DEBUG [ProcessExecutor] Starting C:\Program Files\Serviio\bin\\..\lib/ffmpeg.exe -threads auto -i C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.mp4 -y -threads auto -c:v mpeg2video -pix_fmt yuv420p -qscale:v 1 -vf subtitles=filename="C\\:/Users/Path/Downloads/XXX.S02E04.HDTV.x264-LOL.srt":original_size=720x404:charenc=UTF-8 -r 24000/1001 -g 15 -c:a ac3 -b:a 384k -ac 2 -map 0:0 -map 0:1 -sn -f vob C:\Windows\TEMP\Serviio\transcoding-temp-354-viera2013-ORIGINAL-0b96604a8eb1273ae761a321d9cf07b7.stf
2014-09-17 15:25:44,068 WARN [ProcessExecutor] Process cmd has a return code of 1! This is a possible error. Detailed output follows.
[AVFilterGraph @ 0000000002dc9bc0] [Eval @ 000000000022abc0] Undefined constant or missing '(' in 'auto'
[AVFilterGraph @ 0000000002dc9bc0] Unable to parse option value "auto"
[Parsed_subtitles_0 @ 0000000002dc98a0] Unable to open C:/Users/Path/Downloads/XXX.S02E04.HDTV.x264-LOL.srt
[AVFilterGraph @ 0000000002dc9bc0] Error initializing filter 'subtitles' with args 'filename=C\:/Users/Path/Downloads/XXX.S02E04.HDTV.x264-LOL.srt:original_size=720x404:charenc=UTF-8'
Error opening filters!
2014-09-17 15:25:44,068 DEBUG [TranscodingJobListener] Transcoding finished; successful: false
2014-09-17 15:25:53,997 DEBUG [TranscodingJobListener] Deleted temp file 'C:\Windows\TEMP\Serviio\transcoding-temp-354-viera2013-ORIGINAL-0b96604a8eb1273ae761a321d9cf07b7.stf': true
2014-09-17 15:25:53,998 DEBUG [AbstractTranscodingDeliveryEngine] Removing transcoding listener with id transcoding-temp-354-viera2013-ORIGINAL-0b96604a8eb1273ae761a321d9cf07b7.stf
2014-09-17 15:25:53,998 ERROR [ResourceTransportRequestHandler] Error while processing resource, sending back 500 error. Message: FFmpeg execution failed
java.io.IOException: FFmpeg execution failed
at org.serviio.delivery.resource.transcode.FileBasedTranscodingDeliveryStrategy.createInputStream(FileBasedTranscodingDeliveryStrategy.java:49)
at org.serviio.delivery.resource.transcode.AbstractTranscodingDeliveryEngine.retrieveTranscodedResource(AbstractTranscodingDeliveryEngine.java:134)
at org.serviio.delivery.resource.AbstractDeliveryEngine.deliver(AbstractDeliveryEngine.java:110)
at org.serviio.delivery.MediaResourceRetrievalStrategy.retrieveResource(MediaResourceRetrievalStrategy.java:153)
at org.serviio.delivery.GETMethodProcessor.retrieveResource(GETMethodProcessor.java:121)
at org.serviio.delivery.GETMethodProcessor.buildDeliveryContainer(GETMethodProcessor.java:48)
at org.serviio.delivery.AbstractMethodProcessor.handleRequest(AbstractMethodProcessor.java:100)
at org.serviio.delivery.ResourceDeliveryProcessor.deliverContent(ResourceDeliveryProcessor.java:81)
at org.serviio.upnp.webserver.ResourceTransportRequestHandler.handleRequest(ResourceTransportRequestHandler.java:86)
at org.serviio.upnp.webserver.AbstractRequestHandler.handle(AbstractRequestHandler.java:61)
at org.apache.http.protocol.HttpService.doService(HttpService.java:293)
at org.serviio.upnp.webserver.ServiioHttpService.doService(ServiioHttpService.java:77)
at org.apache.http.protocol.HttpService.handleRequest(HttpService.java:212)
at org.serviio.upnp.webserver.WebServer$WorkerThread.run(WebServer.java:196)
2014-09-17 15:25:55,009 DEBUG [ServiioHttpService] Incoming request from /x.x.x.3:17203: GET /resource/354/MEDIA_ITEM/MPEG_PS_PAL-0/ORIGINAL HTTP/1.1, headers = [Host: x.x.x.4:8895,TimeSeekRange.dlna.org: npt=00:00:00.000-,transferMode.dlna.org: Streaming,Connection: keep-alive]]
2014-09-17 15:25:55,010 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:55,011 DEBUG [RendererDAOImpl] Reading a Renderer with ip address x.x.x.3
2014-09-17 15:25:55,013 DEBUG [ResourceDeliveryProcessor] Resource request accepted. Using client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:55,013 DEBUG [ResourceDeliveryProcessor] Request for resource 354 and type 'MEDIA_ITEM' received
2014-09-17 15:25:55,013 DEBUG [MediaResourceRetrievalStrategy] Getting information about media item 354 (local)
2014-09-17 15:25:55,013 DEBUG [MediaItemDAOImpl] Reading a MediaItem (id = 354)
2014-09-17 15:25:55,015 DEBUG [VideoDAOImpl] Reading a Video (id = 354)
2014-09-17 15:25:55,016 DEBUG [VideoDeliveryEngine] Retrieving resource information for item 354, format MPEG_PS_PAL and profile Panasonic Viera (2013)
2014-09-17 15:25:55,017 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:55,019 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:55,020 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:55,022 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:55,022 DEBUG [AbstractTranscodingDeliveryEngine] Getting media info for transcoded version of file XXX.S02E04.HDTV.x264-LOL.mp4
2014-09-17 15:25:55,023 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:55,025 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:55,026 DEBUG [VideoDeliveryEngine] Found Format profile for transcoded file XXX.S02E04.HDTV.x264-LOL.mp4: MPEG_PS_PAL
2014-09-17 15:25:55,026 DEBUG [VideoDeliveryEngine] Found Format profile for transcoded file XXX.S02E04.HDTV.x264-LOL.mp4: MPEG_PS_NTSC
2014-09-17 15:25:55,026 DEBUG [MediaResourceRetrievalStrategy] Getting information about media item 354 (local)
2014-09-17 15:25:55,027 DEBUG [MediaItemDAOImpl] Reading a MediaItem (id = 354)
2014-09-17 15:25:55,028 DEBUG [VideoDAOImpl] Reading a Video (id = 354)
2014-09-17 15:25:55,030 DEBUG [VideoDeliveryEngine] Delivering item '354' for client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:55,030 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:55,033 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:55,033 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:55,036 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:55,036 DEBUG [VideoDeliveryEngine] Delivering file 'XXX.S02E04.HDTV.x264-LOL.mp4' using transcoding
2014-09-17 15:25:55,036 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:55,039 DEBUG [SubtitlesService] Found external subtitle file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.srt
2014-09-17 15:25:55,039 DEBUG [AbstractTranscodingDeliveryEngine] No suitable transcoding job exists yet, start one for client 'Identifier=x.x.x.3, Profile=Panasonic Viera (2013)'
2014-09-17 15:25:55,040 DEBUG [MediaItemDAOImpl] Getting file of media item 354
2014-09-17 15:25:55,042 DEBUG [FFMPEGWrapper] Invoking FFmpeg to transcode video file: C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.mp4
2014-09-17 15:25:55,043 DEBUG [ProcessExecutor] Starting C:\Program Files\Serviio\bin\\..\lib/ffmpeg.exe -threads auto -i C:\Users\Path\Downloads\XXX.S02E04.HDTV.x264-LOL.mp4 -y -threads auto -c:v mpeg2video -pix_fmt yuv420p -qscale:v 1 -vf subtitles=filename="C\\:/Users/Path/Downloads/XXX.S02E04.HDTV.x264-LOL.srt":original_size=720x404:charenc=UTF-8 -r 24000/1001 -g 15 -c:a ac3 -b:a 384k -ac 2 -map 0:0 -map 0:1 -sn -f vob C:\Windows\TEMP\Serviio\transcoding-temp-354-viera2013-ORIGINAL-0b96604a8eb1273ae761a321d9cf07b7.stf
2014-09-17 15:25:55,153 WARN [ProcessExecutor] Process cmd has a return code of 1! This is a possible error. Detailed output follows.
[AVFilterGraph @ 0000000002b89bc0] [Eval @ 000000000022abc0] Undefined constant or missing '(' in 'auto'
[AVFilterGraph @ 0000000002b89bc0] Unable to parse option value "auto"
[Parsed_subtitles_0 @ 0000000002b898a0] Unable to open C:/Users/Path/Downloads/XXX.S02E04.HDTV.x264-LOL.srt
[AVFilterGraph @ 0000000002b89bc0] Error initializing filter 'subtitles' with args 'filename=C\:/Users/Path/Downloads/XXX.S02E04.HDTV.x264-LOL.srt:original_size=720x404:charenc=UTF-8'
Error opening filters!
