Log Warning and ref frames?

Jul 19, 2013 at 10:04 AM
Edited Jul 19, 2013 at 12:39 PM
I inputted a 3gb 720p avi and converted to mp4 using 4.1 profile preset film to 700mb(2 pass) with mp3 pass through, 1280x688(1.85 aspect). Everything else was defaulted. Looking at the log I saw this:

x264 [warning]: --psnr used with psy on: results will be invalid!
x264 [warning]: --tune psnr should be used if attempting to benchmark psnr!

I used Cabac at default 3 ref frames, but using Media Info tool my file says Cabac 4 ref frames. Just curious to warning messages and more ref frames despite defaulting. My logical guess is some default settings violate the constraints of that level perse 4.1 High and x264 encoder is just warning me, but like most users I do not have an idea in hell which options I have to tweak to comply with contraints and not violate compliancy of that specific level 4.1. These tweaks must be command line scripts which only developers can do. I'm using your portable x86 version.

Regarding the ref frames Media Info is very dodgy at extracting mp4 information sometimes, It even had my framerate down as minimum 23.974 to a stupendously maximum 90 000.000fps. I set it at a constant 23.976 same as source, My mp4 plays great anyway. Thanks.

P.S Just saw this at Doom9 and according to the webpage it is a x264 command line which needs to be changed! Some Handbrake users who saw this issue had crashed encodings too.

http://forum.doom9.org/showthread.php?t=161534

http://mailman.videolan.org/pipermail/x264-devel/2011-April/008381.html
Coordinator
Jul 19, 2013 at 3:14 PM
That warning is nothing to worry about; it happens basically every time. It's just saying that the PSNR scores won't be of much use. All you need to do to comply with a level is select it on the Video tab.

And I can't tell for sure with no log but if you use preset/profile/tune/level you can get different results from what appears on the advanced tab. If it appears to be default on the advanced tab it might actually be changed by something from the video tab.
Jul 19, 2013 at 4:21 PM
Edited Jul 19, 2013 at 4:32 PM
Thanks. I still have the log, if you wanted to see it, but posting a reply has limits here so cuts the log down to 1000 characters. Anyway log below with just usual libdvdnav log parts missing from start as source was an avi anyway.
Jul 19, 2013 at 4:27 PM

VidCoder 1.4.23.0 (x86)

Input #0, avi, from 'D:\TEST\TEST.avi':
Metadata:
encoder         : VirtualDubMod 1.6.0.0 SURROUND (build 2560/release)
Duration: 02:07:01.51, start: 0.000000, bitrate: 2961 kb/s
Stream #0.0: Video: mpeg4 (Advanced Simple Profile), yuv420p, 1280x688 [PAR 1:1 DAR 80:43], 23.98 tbn, 23.98 tbc
Stream #0.1: Audio: mp3, 44100 Hz, 2 channels, s16p, 108 kb/s
[14:23:34] scan: decoding previews for title 1
[14:23:34] scan: audio 0x1: mp3, rate=44100Hz, bitrate=108000 Unknown (mp3) (2.0 ch)
[14:23:34] scan: 10 previews, 1280x688, 23.976 fps, autocrop = 0/0/0/0, aspect 16:9, PAR 1:1
[14:23:34] libhb: scan thread found 1 valid title(s)
[14:23:34] 2 job(s) to process
[14:23:34] starting job
[14:23:34] yadif thread started for segment 0
[14:23:34] yadif thread started for segment 1
[14:23:34] decomb filter thread started for segment 0
[14:23:34] decomb check thread started for segment 0
[14:23:34] decomb filter thread started for segment 1
[14:23:34] decomb check thread started for segment 1
[14:23:34] mask filter thread started for segment 0
[14:23:34] mask filter thread started for segment 1
[14:23:34] mask erode thread started for segment 0
[14:23:34] mask erode thread started for segment 1
[14:23:34] mask dilate thread started for segment 1
[14:23:34] mask dilate thread started for segment 0
[14:23:34] sync: expecting 182733 video frames
[14:23:34] job configuration:
[14:23:34] * source
[14:23:34] + D:\TEST\TEST.avi
[14:23:34] + title 1, chapter(s) 1 to 1
[14:23:34] + container: avi
[14:23:34] + data rate: 2961 kbps
[14:23:34] * destination
[14:23:34] + C:\Documents and Settings\Owner\My Documents\My Videos\TEST.mp4
[14:23:34] + container: MPEG-4 (.mp4 and .m4v)
[14:23:34] + 64-bit formatting
[14:23:34] * video track
[14:23:34] + decoder: mpeg4
[14:23:34] + frame rate: 23.976 fps -> constant 23.976 fps
[14:23:34] + filters
[14:23:34] + Decomb (default settings)
[14:23:34] + Framerate Shaper (1:27000000:1126125)
[14:23:34] + frame rate: 23.976 fps -> constant 23.976 fps
[14:23:34] + Crop and Scale (1280:688:0:0:0:0)
[14:23:34] + source: 1280 * 688, crop (0/0/0/0): 1280 * 688, scale: 1280 * 688
[14:23:34] + dimensions: 1280 * 688, mod 0
[14:23:34] + encoder: H.264 (x264)
[14:23:34] + x264 preset: medium
[14:23:34] + x264 tune: film
[14:23:34] + h264 profile: high
[14:23:34] + h264 level: 4.1
[14:23:34] + bitrate: 660 kbps, pass: 1
[14:23:34] * audio track 1
[14:23:34] + decoder: Unknown (mp3) (2.0 ch) (track 2, id 0x1)
[14:23:34] + bitrate: 108 kbps, samplerate: 44100 Hz
[14:23:34] + MP3 Passthru
[14:23:35] reader: first SCR 0 id 0x1 DTS 0
[14:23:35] encx264: min-keyint: 24, keyint: 240
x264 [warning]: --psnr used with psy on: results will be invalid!
x264 [warning]: --tune psnr should be used if attempting to benchmark psnr!
x264 [info]: using cpu capabilities: MMX2 SSE2Fast SSSE3 Cache64
x264 [info]: profile High, level 4.1
[18:38:27] reader: done. 1 scr changes
[18:38:28] work: average encoding speed for job is 11.948980 fps
[18:38:29] sync: got 182732 frames, 182733 expected
[18:38:29] decomb: deinterlaced 0 | blended 10 | unfiltered 182721 | total 182731
[18:38:29] render: 182732 frames output, 0 dropped and 1 duped for CFR/PFR
[18:38:29] render: lost time: 0 (0 frames)
[18:38:29] render: gained time: 0 (0 frames) (0 not accounted for)
[18:38:29] mpeg4-decoder done: 182732 frames, 0 decoder errors, 0 drops
x264 [info]: frame I:3269 Avg QP:25.56 size: 25031 PSNR Mean Y:43.55 U:49.77 V:51.38 Avg:44.87 Global:43.88
x264 [info]: frame P:72525 Avg QP:27.61 size: 5578 PSNR Mean Y:43.24 U:49.22 V:50.02 Avg:44.50 Global:43.35
x264 [info]: frame B:106938 Avg QP:30.25 size: 1334 PSNR Mean Y:43.33 U:49.27 V:50.08 Avg:44.58 Global:43.44
x264 [info]: consecutive B-frames: 13.4% 22.5% 10.1% 54.0%
x264 [info]: mb I I16..4: 34.3% 59.8% 6.0%
x264 [info]: mb P I16..4: 9.9% 8.5% 0.2% P16..4: 31.3% 3.4% 1.4% 0.0% 0.0% skip:45.4%
x264 [info]: mb B I16..4: 0.3% 0.3% 0.0% B16..8: 23.2% 0.8% 0.1% direct: 0.4% skip:75.0% L0:38.5% L1:60.2% BI: 1.3%
x264 [info]: final ratefactor: 28.91
x264 [info]: 8x8 transform intra:48.5% inter:93.3%
x264 [info]: coded y,uvDC,uvAC intra: 23.5% 42.3% 3.2% inter: 3.5% 6.2% 0.0%
x264 [info]: i16 v,h,dc,p: 45% 26% 13% 16%
x264 [info]: i8 v,h,dc,ddl,ddr,vr,hd,vl,hu: 18% 15% 47% 3% 3% 4% 3% 3% 3%
x264 [info]: i4 v,h,dc,ddl,ddr,vr,hd,vl,hu: 28% 20% 17% 5% 7% 7% 6% 5% 4%
x264 [info]: i8c dc,h,v,p: 60% 19% 20% 2%
x264 [info]: Weighted P-Frames: Y:1.5% UV:0.4%
x264 [info]: ref P L0: 64.3% 14.3% 15.7% 5.6% 0.1%
x264 [info]: ref B L0: 87.4% 10.5% 2.1%
x264 [info]: ref B L1: 97.1% 2.9%
x264 [info]: SSIM Mean Y:0.9793377 (16.848db)
x264 [info]: PSNR Mean Y:43.302 U:49.259 V:50.081 Avg:44.553 Global:43.412 kb/s:660.23
[18:38:29] mp3-decoder done: 0 frames, 0 decoder errors, 0 drops
[18:38:29] starting job
[18:38:29] yadif thread started for segment 0
[18:38:29] decomb filter thread started for segment 0
[18:38:29] decomb check thread started for segment 0
[18:38:29] yadif thread started for segment 1
[18:38:29] decomb check thread started for segment 1
[18:38:29] mask filter thread started for segment 0
[18:38:29] mask erode thread started for segment 0
[18:38:29] mask dilate thread started for segment 0
[18:38:29] sync: expecting 182732 video frames
[18:38:29] job configuration:
[18:38:29] * source
[18:38:29] + D:\TEST\TEST.avi
[18:38:29] + title 1, chapter(s) 1 to 1
[18:38:29] + container: avi
[18:38:29] + data rate: 2961 kbps
[18:38:29] * destination
[18:38:29] + C:\Documents and Settings\Owner\My Documents\My Videos\TEST.mp4
[18:38:29] + container: MPEG-4 (.mp4 and .m4v)
[18:38:29] + 64-bit formatting
[18:38:29] * video track
[18:38:29] + decoder: mpeg4
[18:38:29] + frame rate: 23.976 fps -> constant 23.976 fps
[18:38:29] + filters
[18:38:29] + Decomb (default settings)
[18:38:29] + Framerate Shaper (1:27000000:1126125)
[18:38:29] + frame rate: 23.976 fps -> constant 23.976 fps
[18:38:29] + Crop and Scale (1280:688:0:0:0:0)
[18:38:29] + source: 1280 * 688, crop (0/0/0/0): 1280 * 688, scale: 1280 * 688
[18:38:29] + dimensions: 1280 * 688, mod 0
[18:38:29] + encoder: H.264 (x264)
[18:38:29] + x264 preset: medium
[18:38:29] + x264 tune: film
[18:38:29] + h264 profile: high
[18:38:29] + h264 level: 4.1
[18:38:29] + bitrate: 660 kbps, pass: 2
[18:38:29] * audio track 1
[18:38:29] + decoder: Unknown (mp3) (2.0 ch) (track 2, id 0x1)
[18:38:29] + bitrate: 108 kbps, samplerate: 44100 Hz
[18:38:29] + MP3 Passthru
[18:38:29] decomb filter thread started for segment 1
[18:38:29] mask erode thread started for segment 1
[18:38:29] mask filter thread started for segment 1
[18:38:29] mask dilate thread started for segment 1
[18:38:29] reader: first SCR 0 id 0x1 DTS 0
[18:38:29] encx264: min-keyint: 24, keyint: 240
x264 [warning]: --psnr used with psy on: results will be invalid!
x264 [warning]: --tune psnr should be used if attempting to benchmark psnr!
x264 [info]: using cpu capabilities: MMX2 SSE2Fast SSSE3 Cache64
x264 [info]: profile High, level 4.1
[22:35:52] reader: done. 1 scr changes
[22:35:54] work: average encoding speed for job is 12.907641 fps
[22:35:54] sync: got 182732 frames, 182732 expected
[22:35:54] decomb: deinterlaced 0 | blended 10 | unfiltered 182721 | total 182731
[22:35:54] render: 182732 frames output, 0 dropped and 1 duped for CFR/PFR
[22:35:54] render: lost time: 0 (0 frames)
[22:35:54] render: gained time: 0 (0 frames) (0 not accounted for)
[22:35:54] mpeg4-decoder done: 182732 frames, 0 decoder errors, 0 drops
x264 [info]: frame I:3269 Avg QP:25.45 size: 25160 PSNR Mean Y:43.60 U:49.82 V:51.46 Avg:44.91 Global:44.16
x264 [info]: frame P:72525 Avg QP:27.53 size: 5603 PSNR Mean Y:43.29 U:49.26 V:50.07 Avg:44.54 Global:43.63
x264 [info]: frame B:106938 Avg QP:30.40 size: 1311 PSNR Mean Y:43.28 U:49.24 V:50.06 Avg:44.53 Global:43.63
x264 [info]: consecutive B-frames: 13.4% 22.5% 10.1% 54.0%
x264 [info]: mb I I16..4: 34.6% 59.4% 6.0%
x264 [info]: mb P I16..4: 10.2% 8.3% 0.2% P16..4: 31.3% 3.3% 1.4% 0.0% 0.0% skip:45.3%
x264 [info]: mb B I16..4: 0.3% 0.3% 0.0% B16..8: 22.7% 0.8% 0.1% direct: 0.3% skip:75.5% L0:38.0% L1:60.7% BI: 1.3%
x264 [info]: 8x8 transform intra:47.4% inter:93.0%
x264 [info]: coded y,uvDC,uvAC intra: 24.0% 43.1% 3.3% inter: 3.4% 6.0% 0.0%
x264 [info]: i16 v,h,dc,p: 45% 26% 13% 16%
x264 [info]: i8 v,h,dc,ddl,ddr,vr,hd,vl,hu: 18% 16% 45% 3% 4% 4% 4% 3% 3%
x264 [info]: i4 v,h,dc,ddl,ddr,vr,hd,vl,hu: 28% 20% 17% 5% 7% 7% 7% 5% 4%
x264 [info]: i8c dc,h,v,p: 59% 19% 20% 2%
x264 [info]: Weighted P-Frames: Y:1.7% UV:0.4%
x264 [info]: ref P L0: 64.9% 13.7% 15.6% 5.7% 0.1%
x264 [info]: ref B L0: 87.5% 10.7% 1.8%
x264 [info]: ref B L1: 97.1% 2.9%
x264 [info]: SSIM Mean Y:0.9799743 (16.984db)
x264 [info]: PSNR Mean Y:43.288 U:49.254 V:50.087 Avg:44.539 Global:43.643 kb/s:660.01
[22:35:54] mp3-decoder done: 0 frames, 0 decoder errors, 0 drops
[22:35:59] mux: track 0, 182732 frames, 628669863 bytes, 659.89 kbps, fifo 8192
[22:35:59] mux: track 1, 291761 frames, 102887245 bytes, 108.00 kbps, fifo 8192
[22:35:59] libhb: work result = 0

Job completed

Coordinator
Jul 19, 2013 at 4:39 PM
Yeah you have some level/tune stuff set that could override any default settings you see in the Advanced tab. For future reference you can use Pastebin for logs.
Jul 19, 2013 at 5:52 PM
Edited Jul 19, 2013 at 5:56 PM
MP4 test encoding came out great. Will use pastebin. Cheers!