++ started: sh -c 'vdrburn.sh SYNC '/video0/.vdr-burn.3uuCUp' 0 '/video0/%Kopfgeld_-_Einer_wird_bezahlen!/2007-08-27.00.25.50.50.rec'' root: root: Starting Parameter validation not complete yet Initialising and analysing the streams.... **************************************** READING INDEX FILE, please be patient **************************************** no cutting without marks... Since there were no marks, we created fake ones: 0:00:00.01 1:51:46.03 CAUTION: You specified the -cut Option, but the marks look like remains of an already cut movie! I will process the full movie! 10 Mbytes of 3025 read DEFINED THE FIRST FRAME IN BUFFER FOR bd AS SINGLE FRAME WITH length 1336 and frame bytes are 1336 WARNING: Stopped Audio flush for stream bd because the last Audio PTS is bigger than the last Video PTS, but the Audio length is shorter than the Video length: Video length 129600 Audio length 115230 Diff: 14370 CORRECTION: Inserted 6 additional frames cause at 1194522026 there was not enough audio kill_score is now: 9 WARNING: Stopped Audio flush for stream bd because the last Audio PTS is bigger than the last Video PTS, but the Audio length is shorter than the Video length: Video length 259200 Audio length 242985 Diff: 16215 CORRECTION: Inserted 6 additional frames cause at 1194651626 there was not enough audio kill_score is now: 18 WARNING: Stopped Audio flush for stream bd because the last Audio PTS is bigger than the last Video PTS, but the Audio length is shorter than the Video length: Video length 388800 Audio length 370740 Diff: 18060 CORRECTION: Inserted 7 additional frames cause at 1194781226 there was not enough audio kill_score is now: 27 Illeagal AC3 freq Failed to find frame, skipping WARNING: Stopped Audio flush for stream bd because the last Audio PTS is bigger than the last Video PTS, but the Audio length is shorter than the Video length: Video length 518400 Audio length 501000 Diff: 17400 CORRECTION: Inserted 7 additional frames cause at 1194910826 there was not enough audio kill_score is now: 36 WARNING: Stopped Audio flush for stream bd because the last Audio PTS is bigger than the last Video PTS, but the Audio length is shorter than the Video length: Video length 648000 Audio length 628755 Diff: 19245 CORRECTION: Inserted 8 additional frames cause at 1195040426 there was not enough audio kill_score is now: 45 WARNING: Stopped Audio flush for stream bd because the last Audio PTS is bigger than the last Video PTS, but the Audio length is shorter than the Video length: Video length 777600 Audio length 761520 Diff: 16080 CORRECTION: Inserted 6 additional frames cause at 1195170026 there was not enough audio kill_score is now: 54 WARNING: Stopped Audio flush for stream bd because the last Audio PTS is bigger than the last Video PTS, but the Audio length is shorter than the Video length: Video length 907200 Audio length 889275 Diff: 17925 CORRECTION: Inserted 7 additional frames cause at 1195299626 there was not enough audio kill_score is now: 63 Illeagal AC3 freq Failed to find frame, skipping WARNING: Stopped Audio flush for stream bd because the last Audio PTS is bigger than the last Video PTS, but the Audio length is shorter than the Video length: Video length 1036800 Audio length 1019535 Diff: 17265 CORRECTION: Inserted 7 additional frames cause at 1195429226 there was not enough audio kill_score is now: 72 WARNING: Stopped Audio flush for stream bd because the last Audio PTS is bigger than the last Video PTS, but the Audio length is shorter than the Video length: Video length 1166400 Audio length 1147290 Diff: 19110 CORRECTION: Inserted 8 additional frames cause at 1195558826 there was not enough audio kill_score is now: 81 WARNING: Stopped Audio flush for stream bd because the last Audio PTS is bigger than the last Video PTS, but the Audio length is shorter than the Video length: Video length 1296000 Audio length 1280055 Diff: 15945 CORRECTION: Inserted 6 additional frames cause at 1195688426 there was not enough audio kill_score is now: 90 WARNING: Stopped Audio flush for stream bd because the last Audio PTS is bigger than the last Video PTS, but the Audio length is shorter than the Video length: Video length 1425600 Audio length 1407810 Diff: 17790 CORRECTION: Inserted 7 additional frames cause at 1195818026 there was not enough audio kill_score is now: 99 Broken Audio packet in stream AC3_audio (paket 562) Failed to find frame, skipping WARNING: Stopped Audio flush for stream bd because the last Audio PTS is bigger than the last Video PTS, but the Audio length is shorter than the Video length: Video length 1555200 Audio length 1538070 Diff: 17130 CORRECTION: Inserted 7 additional frames cause at 1195947626 there was not enough audio kill_score is now: 108 got the kill list bd Stream bd was killed due to an error 20 Mbytes of 3025 read 30 Mbytes of 3025 read 40 Mbytes of 3025 read 50 Mbytes of 3025 read [...] 680 Mbytes of 3025 read 690 Mbytes of 3025 read 700 Mbytes of 3025 read 710 Mbytes of 3025 read 720 Mbytes of 3025 readDEBUG Cut detected at 1349696426 before GOP 3192 CUT detected in Video at 1349696426 before GOP 3192 DEBUG ::1332286826::38304__NEW__1349696426 DEBUG Found non processed cuts in the buffer DEBUG processing Cut at GOP 3192 DEBUG Delaying processing cause cut is at the buffer end: 3192, and start is 3186 DEBUG Found non processed cuts in the buffer DEBUG processing Cut at GOP 3192 DEBUG Processing cut: ::1332286826::38304, 1349696426 DEBUG Setting cutcounter to 1 730 Mbytes of 3025 read 740 Mbytes of 3025 read [...] 1360 Mbytes of 3025 read 1370 Mbytes of 3025 readDEBUG Cut detected at 1501026026 before GOP 6345 CUT detected in Video at 1501026026 before GOP 6345 DEBUG ::1485906026::76140__NEW__1501026026 DEBUG Found non processed cuts in the buffer DEBUG processing Cut at GOP 6345 DEBUG Delaying processing cause cut is at the buffer end: 6345, and start is 6340 DEBUG Found non processed cuts in the buffer DEBUG processing Cut at GOP 6345 DEBUG Processing cut: ::1485906026::76140, 1501026026 DEBUG Setting cutcounter to 2 1380 Mbytes of 3025 read 1390 Mbytes of 3025 read [...] 1930 Mbytes of 3025 read 1940 Mbytes of 3025 readDEBUG Cut detected at 1639784426 before GOP 9098 CUT detected in Video at 1639784426 before GOP 9098 DEBUG ::1619955626::109176__NEW__1639784426 DEBUG Found non processed cuts in the buffer DEBUG processing Cut at GOP 9098 DEBUG Delaying processing cause cut is at the buffer end: 9098, and start is 9091 DEBUG Cut detected at 1639784426 before GOP 9098 CUT detected in Video at 1639784426 before GOP 9098 DEBUG ::1619955626::109176__NEW__1639784426 DEBUG Found non processed cuts in the buffer DEBUG processing Cut at GOP 9098 DEBUG Processing cut: ::1619955626::109176, 1639784426 DEBUG Setting cutcounter to 3 1950 Mbytes of 3025 read 1960 Mbytes of 3025 read [...] 3000 Mbytes of 3025 read 3010 Mbytes of 3025 read 3020 Mbytes of 3025 readUse of uninitialized value in split at /usr/bin/vdrsync.pl line 6397. Use of uninitialized value in multiplication (*) at /usr/bin/vdrsync.pl line 6398. Use of uninitialized value in multiplication (*) at /usr/bin/vdrsync.pl line 6398. Use of uninitialized value in addition (+) at /usr/bin/vdrsync.pl line 6398. Use of uninitialized value in addition (+) at /usr/bin/vdrsync.pl line 6398. did not find additional GOP at end of this chunk 3025 Mbytes of 3025 read 1620330 PES packets processed Assuming final sync for stream c0, cause there is no new chunk_start Finished processing /video0/%Kopfgeld_-_Einer_wird_bezahlen!/2007-08-27.00.25.50.50.rec/ No need to finish DVD Image, since there is none Last fork ended for vdrsync.pl 1908 ++ started: sh -c 'vdrburn.sh MPLEX '/video0/.vdr-burn.3uuCUp/VDRSYNC.0' '/video0/.vdr-burn.3uuCUp/VDRSYNC.0/vdrsync.mpv' '/video0/.vdr-burn.3uuCUp/VDRSYNC.0/vdrsync0.mpa' ''' root: root: Starting INFO: [mplex] mplex version 1.6.2 (2.2.3 $Date: 2004/01/13 20:45:26 $) INFO: [mplex] File /video0/.vdr-burn.3uuCUp/VDRSYNC.0/vdrsync.mpv looks like an MPEG Video stream. INFO: [mplex] File /video0/.vdr-burn.3uuCUp/VDRSYNC.0/vdrsync0.mpa looks like an MPEG Audio stream. INFO: [mplex] Video stream 0: profile 8 selected - ignoring non-standard options! INFO: [mplex] Found 1 audio streams and 1 video streams INFO: [mplex] Selecting dvdauthor DVD output profile INFO: [mplex] Multiplexing video program stream! INFO: [mplex] Scanning for header info: Video stream e0 (/video0/.vdr-burn.3uuCUp/VDRSYNC.0/vdrsync.mpv) INFO: [mplex] VIDEO STREAM: e0 INFO: [mplex] Frame width : 720 INFO: [mplex] Frame height : 576 INFO: [mplex] Aspect ratio : 4:3 display INFO: [mplex] Picture rate : 25.000 frames/sec INFO: [mplex] Bit rate : 8000000 bits/sec INFO: [mplex] Vbv buffer size : 186368 bytes INFO: [mplex] CSPF : 0 INFO: [mplex] Scanning for header info: Audio stream c0 (/video0/.vdr-burn.3uuCUp/VDRSYNC.0/vdrsync0.mpa) INFO: [mplex] MPEG AUDIO STREAM: c0 INFO: [mplex] Audio version : 1.0 INFO: [mplex] Layer : 2 INFO: [mplex] CRC checksums : yes INFO: [mplex] Bit rate : 24576 bytes/sec (192 kbit/sec) INFO: [mplex] Frequency : 48000 Hz INFO: [mplex] Mode : 0 stereo INFO: [mplex] Mode extension : 0 INFO: [mplex] Copyright bit : 1 copyright protected INFO: [mplex] Original/Copy : 1 original INFO: [mplex] Emphasis : 0 none INFO: [mplex] SYSTEMS/PROGRAM stream: INFO: [mplex] rough-guess multiplexed stream data rate : 8365848 INFO: [mplex] target data-rate specified : 10080000 INFO: [mplex] Setting specified specified data rate: 10080000 INFO: [mplex] Run-in Sectors = 89 Video delay = 13019 Audio delay = 23819 INFO: [mplex] New sequence commences... INFO: [mplex] Video e0: buf= 237568 frame=000000 sector=00000000 INFO: [mplex] Audio c0: buf= 4096 frame=000000 sector=00000000 INFO: [mplex] STREAM e0 completed @ frame 167650. INFO: [mplex] STREAM c0 completed @ frame 279419. INFO: [mplex] Multiplex completion at SCR=603560374. INFO: [mplex] Video e0: buf= 237568 frame=167650 sector=01253947 INFO: [mplex] Audio c0: buf= 1792 frame=279419 sector=00079677 INFO: [mplex] VIDEO_STATISTICS: e0 INFO: [mplex] Video Stream length: 2524221028 bytes INFO: [mplex] Sequence headers: 13971 INFO: [mplex] Sequence ends : 0 INFO: [mplex] No. Pictures : 167651 INFO: [mplex] No. Groups : 13971 INFO: [mplex] No. I Frames : 13971 avg. size 46077 bytes INFO: [mplex] No. P Frames : 41913 avg. size 20158 bytes INFO: [mplex] No. B Frames : 111768 avg. size 9265 bytes INFO: [mplex] Average bit-rate : 3011200 bits/sec INFO: [mplex] Peak bit-rate : 7897200 bits/sec INFO: [mplex] BUFFERING min 15 Buf max 134306 INFO: [mplex] AUDIO_STATISTICS: c0 INFO: [mplex] Audio stream length 160945920 bytes. INFO: [mplex] Syncwords : 279420 INFO: [mplex] Frames : 279420 padded INFO: [mplex] Frames : 0 unpadded INFO: [mplex] BUFFERING min 15 Buf max 587 INFO: [mplex] MUX STATUS: no under-runs detected. ++ executing: sh -c 'nice -n 19 rm -rf /video0/.vdr-burn.3uuCUp/VDRSYNC.0/*.m[p2]v' ++ executing: sh -c 'nice -n 19 rm -rf /video0/.vdr-burn.3uuCUp/VDRSYNC.0/*.mp[a2]' ++ executing: sh -c 'nice -n 19 rm -rf /video0/.vdr-burn.3uuCUp/VDRSYNC.0/*.ac3' ++ started an internal procedure ++ starting sh -c 'vdrburn.sh MKMENU '/video0/.vdr-burn.3uuCUp/VDRSYNC.0' '0' '/etc/vdr/plugins/burn'' in internal procedure root: DVDAuthor::spumux, version 0.6.11. Build options: gnugetopt magick iconv freetype Send bugs to INFO: Locale=C INFO: Converting filenames to ANSI_X3.4-1968 STAT: 0:00:00.000 INFO: Picture /video0/.vdr-burn.3uuCUp/VDRSYNC.0/menu-buttons-ns.png had 1 colors INFO: Picture /video0/.vdr-burn.3uuCUp/VDRSYNC.0/menu-buttons-h-0.png had 2 colors INFO: Picture /video0/.vdr-burn.3uuCUp/VDRSYNC.0/menu-buttons-ns.png had 1 colors INFO: Autodetect 0 = 80x509-112x541 INFO: Autodetect 1 = 605x509-637x541 INFO: Pickbuttongroups, success with 1 groups, useimg=1 INFO: After read_bmp(): xd=558 yd=34 x0=80 y0=508 INFO: Found EOF in .sub file. INFO: Max_sub_size=336 INFO: Subtitle inserted at: 0.184656 sd=0 WARN: Read 0, expected 4 INFO: 1 subtitles added, 0 subtitles skipped, stream: 32, offset: 0.18 Statistics: - Processed 0 subtitles. - The longest display line had -1 characters. - The maximum number of displayed lines was 0. - The normal display height of the font arial.ttf was 0. - The bottom display height of the font arial.ttf was 0. - The biggest subtitle box had 336 bytes. ++ started an internal procedure ++ starting sh -c 'vdrburn.sh MKMENU '/video0/.vdr-burn.3uuCUp' '0' '/etc/vdr/plugins/burn'' in internal procedure root: DVDAuthor::spumux, version 0.6.11. Build options: gnugetopt magick iconv freetype Send bugs to INFO: Locale=C INFO: Converting filenames to ANSI_X3.4-1968 STAT: 0:00:00.000 INFO: Picture /video0/.vdr-burn.3uuCUp/menu-buttons-ns.png had 1 colors INFO: Picture /video0/.vdr-burn.3uuCUp/menu-buttons-h-0.png had 2 colors INFO: Picture /video0/.vdr-burn.3uuCUp/menu-buttons-ns.png had 1 colors INFO: Autodetect 0 = 93x118-125x150 INFO: Pickbuttongroups, success with 1 groups, useimg=1 INFO: After read_bmp(): xd=34 yd=32 x0=92 y0=118 INFO: Found EOF in .sub file. INFO: Max_sub_size=146 INFO: Subtitle inserted at: 0.184656 sd=0 WARN: Read 0, expected 4 INFO: 1 subtitles added, 0 subtitles skipped, stream: 32, offset: 0.18 Statistics: - Processed 0 subtitles. - The longest display line had -1 characters. - The maximum number of displayed lines was 0. - The normal display height of the font arial.ttf was 0. - The bottom display height of the font arial.ttf was 0. - The biggest subtitle box had 146 bytes. ++ started: sh -c 'vdrburn.sh AUTHOR '/video0/.vdr-burn.3uuCUp/dvd.xml'' root: root: Starting DVDAuthor::dvdauthor, version 0.6.11. Build options: gnugetopt magick iconv freetype Send bugs to INFO: Locale=C INFO: Converting filenames to ANSI_X3.4-1968 INFO: dvdauthor creating VTS STAT: Picking VTS 01 STAT: Processing /video0/.vdr-burn.3uuCUp/VDRSYNC.0/menu-bg-0.mpg... INFO: Video pts = 0.184 .. 0.224 INFO: Audio[8] pts = 0.184 .. 1.168 INFO: Audio[32] pts = 0.184 .. 0.184 STAT: VOBU 1 at 0MB, 1 PGCS INFO: Generating VTSM with the following video attributes: INFO: MPEG version: mpeg2 INFO: TV standard: pal INFO: Aspect ratio: 4:3 INFO: Resolution: 720x576 INFO: Audio ch 0 format: mp2/2ch, 48khz 20bps STAT: Processing /video0/.vdr-burn.3uuCUp/VDRSYNC.0/movie.mpg... STAT: VOBU 16 at 2MB, 1 PGCS [...] STAT: VOBU 13952 at 2626MB, 1 PGCS STAT: VOBU 13968 at 2630MB, 1 PGCS INFO: Video pts = 0.184 .. 6706.224 INFO: Audio[8] pts = 0.264 .. 6706.344 STAT: VOBU 13971 at 2632MB, 1 PGCS WARN: GOP is not closed on cell 1 of source /video0/.vdr-burn.3uuCUp/VDRSYNC.0/movie.mpg of pgc 1 INFO: Generating VTS with the following video attributes: INFO: MPEG version: mpeg2 INFO: TV standard: pal INFO: Aspect ratio: 4:3 INFO: Resolution: 720x576 INFO: Audio ch 0 format: mp2/2ch, 48khz 20bps, 'de' STAT: fixed 1 VOBUS STAT: fixing VOBU at 2MB (17/13971, 0%) STAT: fixing VOBU at 4MB (33/13971, 0%) [...] STAT: fixing VOBU at 2621MB (13937/13971, 99%) STAT: fixing VOBU at 2626MB (13953/13971, 99%) STAT: fixing VOBU at 2630MB (13969/13971, 99%) STAT: fixed 13971 VOBUS INFO: dvdauthor creating table of contents INFO: Scanning /video0/.vdr-burn.3uuCUp/DVDAUTHOR/VIDEO_TS/VTS_01_0.IFO INFO: Creating menu for TOC STAT: Processing /video0/.vdr-burn.3uuCUp/menu-bg-0.mpg... INFO: Video pts = 0.184 .. 0.224 INFO: Audio[8] pts = 0.184 .. 1.168 INFO: Audio[32] pts = 0.184 .. 0.184 STAT: VOBU 1 at 0MB, 1 PGCS INFO: Generating VMGM with the following video attributes: INFO: MPEG version: mpeg2 INFO: TV standard: pal INFO: Aspect ratio: 4:3 INFO: Resolution: 720x576 INFO: Audio ch 0 format: mp2/2ch, 48khz 20bps STAT: fixed 1 VOBUS ++ started: sh -c 'vdrburn.sh BURN '/video0/.vdr-burn.3uuCUp' '/dev/burner' 'Kopfgeld - Einer wird bezahlen!'' root: root: Starting :-( /dev/burner: unsupported MMC profile 9