Results for igt@kms_flip@2x-flip-vs-expired-vblank@bc-dp2-hdmi-a3

Result: Fail

i915_display_info9 igt_runner9 results9.json results9-xe-load.json guc_logs9.tar i915_display_info_post_exec9 serial_data9 boot9 dmesg9

DetailValue
Duration 1.41 seconds
Hostname
shard-bmg-4
Igt-Version
IGT-Version: 2.4-g8b0b513dc (x86_64) (Linux: 7.1.0-rc5-lgci-xe-xe-pw-167391v1-debug+ x86_64)
Out
Starting dynamic subtest: BC-DP2-HDMI-A3
  1920x1080: 60 148500 1920 2008 2052 2200 1080 1084 1089 1125 0x48 0x5 
  1920x1080: 60 148500 1920 2008 2052 2200 1080 1084 1089 1125 0x48 0x5 
Stack trace:
  #0 ../lib/igt_core.c:2106 __igt_fail_assert()
  #1 ../tests/kms_flip.c:926 run_test_on_crtc_set()
  #2 ../tests/kms_flip.c:2029 run_pair()
  #3 ../tests/kms_flip.c:2193 __igt_unique____real_main2105()
  #4 ../tests/kms_flip.c:2105 main()
  #5 [__libc_init_first+0x8a]
  #6 [__libc_start_main+0x8b]
  #7 [_start+0x25]
Dynamic subtest BC-DP2-HDMI-A3: FAIL (1.408s)
Err
Starting dynamic subtest: BC-DP2-HDMI-A3
[93.687885] (kms_flip:3298) CRITICAL: Test assertion failure function run_test_step, file ../tests/kms_flip.c:931:
[93.687981] (kms_flip:3298) CRITICAL: Failed assertion: end - start < 500
Dynamic subtest BC-DP2-HDMI-A3 failed.
**** DEBUG ****
[92.317338] (kms_flip:3298) igt_fb-DEBUG: igt_create_fb_with_bo_size(width=1920, height=1080, format=XR24(0x34325258), modifier=0x100000000000009, size=0)
[92.317348] (kms_flip:3298) drmtest-DEBUG: Test requirement passed: is_intel_device(fd)
[92.317363] (kms_flip:3298) drmtest-DEBUG: Test requirement passed: is_intel_device(fd)
[92.317641] (kms_flip:3298) igt_fb-DEBUG: igt_create_fb_with_bo_size(handle=1, pitch=7680)
[92.317643] (kms_flip:3298) ioctl_wrappers-DEBUG: Test requirement passed: igt_has_fb_modifiers(fd)
[92.317676] (kms_flip:3298) igt_fb-DEBUG: igt_create_fb_with_bo_size(width=1920, height=1080, format=XR24(0x34325258), modifier=0x100000000000009, size=0)
[92.317684] (kms_flip:3298) drmtest-DEBUG: Test requirement passed: is_intel_device(fd)
[92.317700] (kms_flip:3298) drmtest-DEBUG: Test requirement passed: is_intel_device(fd)
[92.317939] (kms_flip:3298) igt_fb-DEBUG: igt_create_fb_with_bo_size(handle=2, pitch=7680)
[92.317941] (kms_flip:3298) ioctl_wrappers-DEBUG: Test requirement passed: igt_has_fb_modifiers(fd)
[92.320605] (kms_flip:3298) intel_allocator_simple-DEBUG: Using simple allocator
[92.323071] (kms_flip:3298) intel_allocator_simple-DEBUG: <ial: 0x63f94bac6030, fd: 5> objects: 3, reserved_areas: 0
[92.323074] (kms_flip:3298) intel_allocator_simple-DEBUG: <ial: 0x63f94bac6030, fd: 5> objects: 3, reserved_areas: 0
[92.337903] (kms_flip:3298) intel_allocator_simple-DEBUG: Using simple allocator
[92.339281] (kms_flip:3298) intel_allocator_simple-DEBUG: <ial: 0x63f94bb5ecd0, fd: 5> objects: 3, reserved_areas: 0
[92.339283] (kms_flip:3298) intel_allocator_simple-DEBUG: <ial: 0x63f94bb5ecd0, fd: 5> objects: 3, reserved_areas: 0
[92.342008] (kms_flip:3298) intel_allocator_simple-DEBUG: Using simple allocator
[92.343159] (kms_flip:3298) intel_allocator_simple-DEBUG: <ial: 0x63f94bb60d40, fd: 5> objects: 3, reserved_areas: 0
[92.343161] (kms_flip:3298) intel_allocator_simple-DEBUG: <ial: 0x63f94bb60d40, fd: 5> objects: 3, reserved_areas: 0
[92.355303] (kms_flip:3298) intel_allocator_simple-DEBUG: Using simple allocator
[92.356632] (kms_flip:3298) intel_allocator_simple-DEBUG: <ial: 0x63f94bb6e210, fd: 5> objects: 3, reserved_areas: 0
[92.356637] (kms_flip:3298) intel_allocator_simple-DEBUG: <ial: 0x63f94bb6e210, fd: 5> objects: 3, reserved_areas: 0
[92.357130] (kms_flip:3298) igt_kms-INFO:   1920x1080: 60 148500 1920 2008 2052 2200 1080 1084 1089 1125 0x48 0x5 
[92.357145] (kms_flip:3298) igt_kms-INFO:   1920x1080: 60 148500 1920 2008 2052 2200 1080 1084 1089 1125 0x48 0x5 
[92.377208] (kms_flip:3298) DEBUG: No stale events found
[92.590302] (kms_flip:3298) i915/intel_drrs-DEBUG: Manually disabling DRRS. 0
[92.590646] (kms_flip:3298) i915/intel_drrs-DEBUG: Test requirement passed: dir >= 0
[92.744610] (kms_flip:3298) i915/intel_drrs-DEBUG: Manually disabling DRRS. 0
[92.744944] (kms_flip:3298) i915/intel_drrs-DEBUG: Test requirement passed: dir >= 0
[92.770603] (kms_flip:3298) DEBUG: name = flip
last_ts = 0.000000
last_received_ts = 0.000000
last_seq = 0
current_ts = 94.446342
current_received_ts = 94.446091
current_seq = 734
count = 0
seq_step = 1
[92.770650] (kms_flip:3298) DEBUG: Vblank took 35us
[92.787215] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.446342
last_received_ts = 94.446091
last_seq = 734
current_ts = 94.463020
current_received_ts = 94.462708
current_seq = 735
count = 1
seq_step = 1
[92.787260] (kms_flip:3298) DEBUG: Vblank took 32us
[92.803801] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.463020
last_received_ts = 94.462708
last_seq = 735
current_ts = 94.479691
current_received_ts = 94.479317
current_seq = 736
count = 2
seq_step = 1
[92.803834] (kms_flip:3298) DEBUG: Vblank took 26us
[92.820241] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.479691
last_received_ts = 94.479317
last_seq = 736
current_ts = 94.496361
current_received_ts = 94.495758
current_seq = 737
count = 3
seq_step = 1
[92.820272] (kms_flip:3298) DEBUG: Vblank took 28us
[92.836908] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.496361
last_received_ts = 94.495758
last_seq = 737
current_ts = 94.513031
current_received_ts = 94.512436
current_seq = 738
count = 4
seq_step = 1
[92.836937] (kms_flip:3298) DEBUG: Vblank took 25us
[92.853576] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.513031
last_received_ts = 94.512436
last_seq = 738
current_ts = 94.529709
current_received_ts = 94.529106
current_seq = 739
count = 5
seq_step = 1
[92.853604] (kms_flip:3298) DEBUG: Vblank took 25us
[92.870242] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.529709
last_received_ts = 94.529106
last_seq = 739
current_ts = 94.546379
current_received_ts = 94.545776
current_seq = 740
count = 6
seq_step = 1
[92.870271] (kms_flip:3298) DEBUG: Vblank took 24us
[92.886910] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.546379
last_received_ts = 94.545776
last_seq = 740
current_ts = 94.563049
current_received_ts = 94.562454
current_seq = 741
count = 7
seq_step = 1
[92.886941] (kms_flip:3298) DEBUG: Vblank took 24us
[92.903576] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.563049
last_received_ts = 94.562454
last_seq = 741
current_ts = 94.579727
current_received_ts = 94.579124
current_seq = 742
count = 8
seq_step = 1
[92.903605] (kms_flip:3298) DEBUG: Vblank took 24us
[92.920245] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.579727
last_received_ts = 94.579124
last_seq = 742
current_ts = 94.596397
current_received_ts = 94.595802
current_seq = 743
count = 9
seq_step = 1
[92.920274] (kms_flip:3298) DEBUG: Vblank took 24us
[92.936912] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.596397
last_received_ts = 94.595802
last_seq = 743
current_ts = 94.613068
current_received_ts = 94.612473
current_seq = 744
count = 10
seq_step = 1
[92.936941] (kms_flip:3298) DEBUG: Vblank took 25us
[92.953579] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.613068
last_received_ts = 94.612473
last_seq = 744
current_ts = 94.629745
current_received_ts = 94.629143
current_seq = 745
count = 11
seq_step = 1
[92.953608] (kms_flip:3298) DEBUG: Vblank took 24us
[92.970246] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.629745
last_received_ts = 94.629143
last_seq = 745
current_ts = 94.646416
current_received_ts = 94.645821
current_seq = 746
count = 12
seq_step = 1
[92.970274] (kms_flip:3298) DEBUG: Vblank took 23us
[92.986915] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.646416
last_received_ts = 94.645821
last_seq = 746
current_ts = 94.663094
current_received_ts = 94.662491
current_seq = 747
count = 13
seq_step = 1
[92.986944] (kms_flip:3298) DEBUG: Vblank took 25us
[93.003580] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.663094
last_received_ts = 94.662491
last_seq = 747
current_ts = 94.679764
current_received_ts = 94.679161
current_seq = 748
count = 14
seq_step = 1
[93.003610] (kms_flip:3298) DEBUG: Vblank took 24us
[93.020247] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.679764
last_received_ts = 94.679161
last_seq = 748
current_ts = 94.696434
current_received_ts = 94.695839
current_seq = 749
count = 15
seq_step = 1
[93.020278] (kms_flip:3298) DEBUG: Vblank took 25us
[93.037140] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.696434
last_received_ts = 94.695839
last_seq = 749
current_ts = 94.713112
current_received_ts = 94.712730
current_seq = 750
count = 16
seq_step = 1
[93.037169] (kms_flip:3298) DEBUG: Vblank took 25us
[93.053806] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.713112
last_received_ts = 94.712730
last_seq = 750
current_ts = 94.729782
current_received_ts = 94.729408
current_seq = 751
count = 17
seq_step = 1
[93.053834] (kms_flip:3298) DEBUG: Vblank took 24us
[93.070486] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.729782
last_received_ts = 94.729408
last_seq = 751
current_ts = 94.746460
current_received_ts = 94.746094
current_seq = 752
count = 18
seq_step = 1
[93.070515] (kms_flip:3298) DEBUG: Vblank took 25us
[93.087142] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.746460
last_received_ts = 94.746094
last_seq = 752
current_ts = 94.763130
current_received_ts = 94.762756
current_seq = 753
count = 19
seq_step = 1
[93.087171] (kms_flip:3298) DEBUG: Vblank took 25us
[93.103806] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.763130
last_received_ts = 94.762756
last_seq = 753
current_ts = 94.779800
current_received_ts = 94.779427
current_seq = 754
count = 20
seq_step = 1
[93.103833] (kms_flip:3298) DEBUG: Vblank took 23us
[93.120251] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.779800
last_received_ts = 94.779427
last_seq = 754
current_ts = 94.796478
current_received_ts = 94.795876
current_seq = 755
count = 21
seq_step = 1
[93.120280] (kms_flip:3298) DEBUG: Vblank took 24us
[93.136920] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.796478
last_received_ts = 94.795876
last_seq = 755
current_ts = 94.813148
current_received_ts = 94.812546
current_seq = 756
count = 22
seq_step = 1
[93.136949] (kms_flip:3298) DEBUG: Vblank took 25us
[93.153588] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.813148
last_received_ts = 94.812546
last_seq = 756
current_ts = 94.829819
current_received_ts = 94.829224
current_seq = 757
count = 23
seq_step = 1
[93.153617] (kms_flip:3298) DEBUG: Vblank took 25us
[93.170255] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.829819
last_received_ts = 94.829224
last_seq = 757
current_ts = 94.846497
current_received_ts = 94.845894
current_seq = 758
count = 24
seq_step = 1
[93.170283] (kms_flip:3298) DEBUG: Vblank took 25us
[93.186923] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.846497
last_received_ts = 94.845894
last_seq = 758
current_ts = 94.863167
current_received_ts = 94.862564
current_seq = 759
count = 25
seq_step = 1
[93.186950] (kms_flip:3298) DEBUG: Vblank took 24us
[93.203588] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.863167
last_received_ts = 94.862564
last_seq = 759
current_ts = 94.879837
current_received_ts = 94.879242
current_seq = 760
count = 26
seq_step = 1
[93.203617] (kms_flip:3298) DEBUG: Vblank took 24us
[93.220256] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.879837
last_received_ts = 94.879242
last_seq = 760
current_ts = 94.896515
current_received_ts = 94.895912
current_seq = 761
count = 27
seq_step = 1
[93.220284] (kms_flip:3298) DEBUG: Vblank took 24us
[93.236924] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.896515
last_received_ts = 94.895912
last_seq = 761
current_ts = 94.913185
current_received_ts = 94.912582
current_seq = 762
count = 28
seq_step = 1
[93.236953] (kms_flip:3298) DEBUG: Vblank took 25us
[93.253592] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.913185
last_received_ts = 94.912582
last_seq = 762
current_ts = 94.929855
current_received_ts = 94.929260
current_seq = 763
count = 29
seq_step = 1
[93.253621] (kms_flip:3298) DEBUG: Vblank took 25us
[93.270259] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.929855
last_received_ts = 94.929260
last_seq = 763
current_ts = 94.946533
current_received_ts = 94.945930
current_seq = 764
count = 30
seq_step = 1
[93.270286] (kms_flip:3298) DEBUG: Vblank took 24us
[93.286926] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.946533
last_received_ts = 94.945930
last_seq = 764
current_ts = 94.963203
current_received_ts = 94.962608
current_seq = 765
count = 31
seq_step = 1
[93.286955] (kms_flip:3298) DEBUG: Vblank took 24us
[93.303593] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.963203
last_received_ts = 94.962608
last_seq = 765
current_ts = 94.979881
current_received_ts = 94.979279
current_seq = 766
count = 32
seq_step = 1
[93.303622] (kms_flip:3298) DEBUG: Vblank took 24us
[93.320262] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.979881
last_received_ts = 94.979279
last_seq = 766
current_ts = 94.996552
current_received_ts = 94.995949
current_seq = 767
count = 33
seq_step = 1
[93.320290] (kms_flip:3298) DEBUG: Vblank took 24us
[93.337151] (kms_flip:3298) DEBUG: name = flip
last_ts = 94.996552
last_received_ts = 94.995949
last_seq = 767
current_ts = 95.013222
current_received_ts = 95.012848
current_seq = 768
count = 34
seq_step = 1
[93.337179] (kms_flip:3298) DEBUG: Vblank took 24us
[93.353817] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.013222
last_received_ts = 95.012848
last_seq = 768
current_ts = 95.029907
current_received_ts = 95.029518
current_seq = 769
count = 35
seq_step = 1
[93.353846] (kms_flip:3298) DEBUG: Vblank took 25us
[93.370485] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.029907
last_received_ts = 95.029518
last_seq = 769
current_ts = 95.046570
current_received_ts = 95.046188
current_seq = 770
count = 36
seq_step = 1
[93.370513] (kms_flip:3298) DEBUG: Vblank took 24us
[93.387153] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.046570
last_received_ts = 95.046188
last_seq = 770
current_ts = 95.063248
current_received_ts = 95.062866
current_seq = 771
count = 37
seq_step = 1
[93.387181] (kms_flip:3298) DEBUG: Vblank took 24us
[93.404446] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.063248
last_received_ts = 95.062866
last_seq = 771
current_ts = 95.079918
current_received_ts = 95.080147
current_seq = 772
count = 38
seq_step = 1
[93.404577] (kms_flip:3298) DEBUG: Vblank took 114us
[93.420298] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.079918
last_received_ts = 95.080147
last_seq = 772
current_ts = 95.096588
current_received_ts = 95.096001
current_seq = 773
count = 39
seq_step = 1
[93.420332] (kms_flip:3298) DEBUG: Vblank took 27us
[93.436943] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.096588
last_received_ts = 95.096001
last_seq = 773
current_ts = 95.113266
current_received_ts = 95.112671
current_seq = 774
count = 40
seq_step = 1
[93.436973] (kms_flip:3298) DEBUG: Vblank took 25us
[93.453606] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.113266
last_received_ts = 95.112671
last_seq = 774
current_ts = 95.129936
current_received_ts = 95.129341
current_seq = 775
count = 41
seq_step = 1
[93.453636] (kms_flip:3298) DEBUG: Vblank took 25us
[93.470310] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.129936
last_received_ts = 95.129341
last_seq = 775
current_ts = 95.146606
current_received_ts = 95.146049
current_seq = 776
count = 42
seq_step = 1
[93.470340] (kms_flip:3298) DEBUG: Vblank took 25us
[93.486941] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.146606
last_received_ts = 95.146049
last_seq = 776
current_ts = 95.163284
current_received_ts = 95.162689
current_seq = 777
count = 43
seq_step = 1
[93.486975] (kms_flip:3298) DEBUG: Vblank took 24us
[93.503611] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.163284
last_received_ts = 95.162689
last_seq = 777
current_ts = 95.179955
current_received_ts = 95.179359
current_seq = 778
count = 44
seq_step = 1
[93.503640] (kms_flip:3298) DEBUG: Vblank took 25us
[93.520294] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.179955
last_received_ts = 95.179359
last_seq = 778
current_ts = 95.196625
current_received_ts = 95.196053
current_seq = 779
count = 45
seq_step = 1
[93.520323] (kms_flip:3298) DEBUG: Vblank took 25us
[93.536942] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.196625
last_received_ts = 95.196053
last_seq = 779
current_ts = 95.213303
current_received_ts = 95.212708
current_seq = 780
count = 46
seq_step = 1
[93.536971] (kms_flip:3298) DEBUG: Vblank took 25us
[93.553612] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.213303
last_received_ts = 95.212708
last_seq = 780
current_ts = 95.229973
current_received_ts = 95.229378
current_seq = 781
count = 47
seq_step = 1
[93.553643] (kms_flip:3298) DEBUG: Vblank took 25us
[93.570278] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.229973
last_received_ts = 95.229378
last_seq = 781
current_ts = 95.246651
current_received_ts = 95.246056
current_seq = 782
count = 48
seq_step = 1
[93.570309] (kms_flip:3298) DEBUG: Vblank took 26us
[93.586943] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.246651
last_received_ts = 95.246056
last_seq = 782
current_ts = 95.263321
current_received_ts = 95.262726
current_seq = 783
count = 49
seq_step = 1
[93.586973] (kms_flip:3298) DEBUG: Vblank took 26us
[93.603614] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.263321
last_received_ts = 95.262726
last_seq = 783
current_ts = 95.279991
current_received_ts = 95.279404
current_seq = 784
count = 50
seq_step = 1
[93.603643] (kms_flip:3298) DEBUG: Vblank took 24us
[93.620283] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.279991
last_received_ts = 95.279404
last_seq = 784
current_ts = 95.296661
current_received_ts = 95.296074
current_seq = 785
count = 51
seq_step = 1
[93.620314] (kms_flip:3298) DEBUG: Vblank took 26us
[93.637168] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.296661
last_received_ts = 95.296074
last_seq = 785
current_ts = 95.313339
current_received_ts = 95.312965
current_seq = 786
count = 52
seq_step = 1
[93.637217] (kms_flip:3298) DEBUG: Vblank took 25us
[93.653840] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.313339
last_received_ts = 95.312965
last_seq = 786
current_ts = 95.330009
current_received_ts = 95.329643
current_seq = 787
count = 53
seq_step = 1
[93.653869] (kms_flip:3298) DEBUG: Vblank took 26us
[93.670506] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.330009
last_received_ts = 95.329643
last_seq = 787
current_ts = 95.346687
current_received_ts = 95.346313
current_seq = 788
count = 54
seq_step = 1
[93.670535] (kms_flip:3298) DEBUG: Vblank took 25us
[93.687173] (kms_flip:3298) DEBUG: name = flip
last_ts = 95.346687
last_received_ts = 95.346313
last_seq = 788
current_ts = 95.363358
current_received_ts = 95.362984
current_seq = 789
count = 55
seq_step = 1
[93.687879] (kms_flip:3298) DEBUG: Vblank took 700us
[93.687885] (kms_flip:3298) CRITICAL: Test assertion failure function run_test_step, file ../tests/kms_flip.c:931:
[93.687981] (kms_flip:3298) CRITICAL: Failed assertion: end - start < 500
[93.702342] (kms_flip:3298) igt_core-INFO: Stack trace:
[93.716950] (kms_flip:3298) igt_core-INFO:   #0 ../lib/igt_core.c:2106 __igt_fail_assert()
[93.718304] (kms_flip:3298) igt_core-INFO:   #1 ../tests/kms_flip.c:926 run_test_on_crtc_set()
[93.718394] (kms_flip:3298) igt_core-INFO:   #2 ../tests/kms_flip.c:2029 run_pair()
[93.718432] (kms_flip:3298) igt_core-INFO:   #3 ../tests/kms_flip.c:2193 __igt_unique____real_main2105()
[93.718470] (kms_flip:3298) igt_core-INFO:   #4 ../tests/kms_flip.c:2105 main()
[93.721914] (kms_flip:3298) igt_core-INFO:   #5 [__libc_init_first+0x8a]
[93.722793] (kms_flip:3298) igt_core-INFO:   #6 [__libc_start_main+0x8b]
[93.722990] (kms_flip:3298) igt_core-INFO:   #7 [_start+0x25]
****  END  ****
Dynamic subtest BC-DP2-HDMI-A3: FAIL (1.408s)
Dmesg
<6> [93.903031] [IGT] kms_flip: starting dynamic subtest BC-DP2-HDMI-A3
<7> [93.903540] xe 0000:03:00.0: [drm:drm_mode_addfb2] [FB:559]
<7> [93.903824] xe 0000:03:00.0: [drm:drm_mode_addfb2] [FB:560]
<7> [93.963088] xe 0000:03:00.0: [drm:drm_mode_setcrtc] [CRTC:151:pipe A]
<7> [93.963278] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.enable (expected yes, found no)
<7> [93.963610] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.active (expected yes, found no)
<7> [93.963876] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in cpu_transcoder (expected 0, found -1)
<7> [93.964127] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in lane_count (expected 4, found 0)
<7> [93.964362] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in dp_m_n (expected tu 64 data 5190451/8388608 link 288358/524288, found tu 0, data 0/0 link 0/0)
<7> [93.964617] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in output_types (expected 0x00000080, found 0x00000000)
<7> [93.964861] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in framestart_delay (expected 1, found 0)
<7> [93.965081] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 1920, found 0)
<7> [93.965291] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 2200, found 0)
<7> [93.965508] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 1920, found 0)
<7> [93.965707] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 2200, found 0)
<7> [93.965904] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 2008, found 0)
<7> [93.966098] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 2052, found 0)
<7> [93.966289] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 1080, found 0)
<7> [93.966476] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 1080, found 0)
<7> [93.966683] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 1084, found 0)
<7> [93.966862] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 1089, found 0)
<7> [93.967039] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 1125, found 0)
<7> [93.967212] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 1125, found 0)
<7> [93.967379] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 1920, found 0)
<7> [93.967569] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 2200, found 0)
<7> [93.967737] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 1920, found 0)
<7> [93.967896] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 2200, found 0)
<7> [93.968057] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 2008, found 0)
<7> [93.968219] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 2052, found 0)
<7> [93.968377] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 1080, found 0)
<7> [93.968576] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 1080, found 0)
<7> [93.968728] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 1084, found 0)
<7> [93.968874] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 1089, found 0)
<7> [93.969018] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 1125, found 0)
<7> [93.969162] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 1125, found 0)
<7> [93.969304] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in pixel_multiplier (expected 1, found 0)
<7> [93.969443] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 1, found 0)
<7> [93.969592] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (4) (expected 4, found 0)
<7> [93.969727] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in enhanced_framing (expected yes, found no)
<7> [93.969862] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in pipe_bpp (expected 36, found 0)
<7> [93.969996] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 148500, found 0)
<7> [93.970129] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 148500, found 0)
<7> [93.970259] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in port_clock (expected 270000, found 0)
<7> [93.970388] xe 0000:03:00.0: [drm:intel_atomic_check [xe]] [CRTC:151:pipe A] fastset requirement not met, forcing full modeset
<7> [93.970515] xe 0000:03:00.0: [drm:intel_dpll_crtc_put [xe]] [CRTC:151:pipe A] releasing TC PLL 2
<7> [93.970664] xe 0000:03:00.0: [drm:skl_compute_wm [xe]] [CRTC:151:pipe A] dbuf slices 0x3 -> 0x0, ddb (0 - 1024) -> (0 - 0), active pipes 0x9 -> 0x8
<7> [93.970779] xe 0000:03:00.0: [drm:skl_compute_wm [xe]] [CRTC:505:pipe D] dbuf slices 0x3 -> 0x3, ddb (1024 - 2048) -> (0 - 2048), active pipes 0x9 -> 0x8
<7> [93.970905] xe 0000:03:00.0: [drm:skl_print_plane_ddb_changes [xe]] [PLANE:145:cursor A] ddb ( 965 - 1024) -> ( 0 - 0), size 59 -> 0
<7> [93.971020] xe 0000:03:00.0: [drm:intel_cdclk_atomic_check [xe]] [CRTC:151:pipe A] min cdclk: 192000 kHz -> 0 kHz
<7> [93.971188] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [CRTC:151:pipe A] enable: no [modeset]
<7> [93.971318] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:35:plane 1A] fb: [NOFB], visible: no
<7> [93.971451] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:65:plane 2A] fb: [NOFB], visible: no
<7> [93.971580] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:95:plane 3A] fb: [NOFB], visible: no
<7> [93.971696] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:125:plane 4A] fb: [NOFB], visible: no
<7> [93.971810] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:135:plane 5A] fb: [NOFB], visible: no
<7> [93.971919] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:145:cursor A] fb: [NOFB], visible: no
<7> [93.972698] xe 0000:03:00.0: [drm:intel_audio_codec_disable [xe]] [CONNECTOR:527:DP-2][ENCODER:526:DDI TC2/PHY G] Disable audio codec on [CRTC:151:pipe A]
<7> [93.993644] xe 0000:03:00.0: [drm:intel_disable_transcoder [xe]] disabling pipe A
<7> [94.010737] xe 0000:03:00.0: [drm:intel_power_well_enable [xe]] enabling AUX_TC2
<7> [94.013278] xe 0000:03:00.0: [drm:intel_dpll_disable [xe]] disable TC PLL 2 (active 0x1, on? 1) for [CRTC:151:pipe A]
<7> [94.015696] xe 0000:03:00.0: [drm:intel_dpll_disable [xe]] disabling TC PLL 2
<7> [94.016402] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:507:DDI TC1/PHY F]
<7> [94.016931] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:509:DP-MST A]
<7> [94.017399] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:510:DP-MST B]
<7> [94.017885] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:511:DP-MST C]
<7> [94.018322] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:512:DP-MST D]
<7> [94.018884] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:526:DDI TC2/PHY G]
<7> [94.019536] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:528:DP-MST A]
<7> [94.019933] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:529:DP-MST B]
<7> [94.020299] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:530:DP-MST C]
<7> [94.020717] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:531:DP-MST D]
<7> [94.021092] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:538:DDI TC3/PHY H]
<7> [94.021446] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:542:DDI TC4/PHY I]
<7> [94.021822] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:544:DP-MST A]
<7> [94.022132] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:545:DP-MST B]
<7> [94.022437] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:546:DP-MST C]
<7> [94.022777] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:547:DP-MST D]
<7> [94.023058] xe 0000:03:00.0: [drm:verify_connector_state [xe]] [CONNECTOR:527:DP-2]
<7> [94.025097] xe 0000:03:00.0: [drm:intel_dbuf_mdclk_cdclk_ratio_update [xe]] Updating dbuf ratio to 2 (mbus joined: no)
<7> [94.029280] xe 0000:03:00.0: [drm:intel_power_well_disable [xe]] disabling PW_A
<7> [94.029808] xe 0000:03:00.0: [drm:dss_pipe_gating_enable_disable [xe]] DSS clock gating disabled for pipe_mask=0x1 (CLKGATE_DIS_DSSDSC=0x2a000000)
<7> [94.030335] xe 0000:03:00.0: [drm:intel_modeset_verify_crtc [xe]] [CRTC:151:pipe A]
<7> [94.030834] xe 0000:03:00.0: [drm:drm_mode_setcrtc] [CRTC:269:pipe C]
<7> [94.031360] xe 0000:03:00.0: [drm:drm_mode_setcrtc] [CRTC:387:pipe B]
<7> [94.031596] xe 0000:03:00.0: [drm:drm_mode_setcrtc] [CRTC:505:pipe D]
<7> [94.031849] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.enable (expected yes, found no)
<7> [94.032173] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.active (expected yes, found no)
<7> [94.032909] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in cpu_transcoder (expected 3, found -1)
<7> [94.033172] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in lane_count (expected 4, found 0)
<7> [94.033416] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in output_types (expected 0x00000040, found 0x00000000)
<7> [94.033673] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in framestart_delay (expected 1, found 0)
<7> [94.033897] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 1920, found 0)
<7> [94.034118] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 2200, found 0)
<7> [94.034334] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 1920, found 0)
<7> [94.034553] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 2200, found 0)
<7> [94.034751] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 2008, found 0)
<7> [94.034936] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 2052, found 0)
<7> [94.035120] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 1080, found 0)
<7> [94.035302] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 1080, found 0)
<7> [94.035484] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 1084, found 0)
<7> [94.035661] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 1089, found 0)
<7> [94.035830] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 1125, found 0)
<7> [94.035999] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 1125, found 0)
<7> [94.036163] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 1920, found 0)
<7> [94.036318] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 2200, found 0)
<7> [94.036468] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 1920, found 0)
<7> [94.036635] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 2200, found 0)
<7> [94.036777] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 2008, found 0)
<7> [94.036919] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 2052, found 0)
<7> [94.037057] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 1080, found 0)
<7> [94.037193] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 1080, found 0)
<7> [94.037329] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 1084, found 0)
<7> [94.037457] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 1089, found 0)
<7> [94.037600] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 1125, found 0)
<7> [94.037725] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 1125, found 0)
<7> [94.037850] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in pixel_multiplier (expected 1, found 0)
<7> [94.037970] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 1, found 0)
<7> [94.038089] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.adjusted_mode.flags (4) (expected 4, found 0)
<7> [94.038208] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in has_hdmi_sink (expected yes, found no)
<7> [94.038326] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in has_infoframe (expected yes, found no)
<7> [94.038439] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in pipe_bpp (expected 36, found 0)
<7> [94.038560] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 148500, found 0)
<7> [94.038669] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 148500, found 0)
<7> [94.038776] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in port_clock (expected 222750, found 0)
<7> [94.038880] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in infoframes.enable (expected 0x00000071, found 0x00000000)
<7> [94.038984] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in infoframes.gcp (expected 0x00000006, found 0x00000000)
<7> [94.039088] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in avi infoframe
<7> [94.039192] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] expected:
<7> [94.039294] xe 0000:03:00.0: HDMI infoframe: Auxiliary Video Information (AVI), version 2, length 13
<7> [94.039295] xe 0000:03:00.0: colorspace: RGB
<7> [94.039297] xe 0000:03:00.0: scan mode: Underscan
<7> [94.039298] xe 0000:03:00.0: colorimetry: No Data
<7> [94.039299] xe 0000:03:00.0: picture aspect: 16:9
<7> [94.039301] xe 0000:03:00.0: active aspect: Same as Picture
<7> [94.039302] xe 0000:03:00.0: itc: No Data
<7> [94.039303] xe 0000:03:00.0: extended colorimetry: xvYCC 601
<7> [94.039304] xe 0000:03:00.0: quantization range: Limited
<7> [94.039305] xe 0000:03:00.0: nups: Unknown Non-uniform Scaling
<7> [94.039307] xe 0000:03:00.0: video code: 16
<7> [94.039308] xe 0000:03:00.0: ycc quantization range: Limited
<7> [94.039309] xe 0000:03:00.0: hdmi content type: Graphics
<7> [94.039310] xe 0000:03:00.0: pixel repeat: 0
<7> [94.039312] xe 0000:03:00.0: bar top 0, bottom 0, left 0, right 0
<7> [94.039313] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] found:
<7> [94.039409] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in spd infoframe
<7> [94.039515] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] expected:
<7> [94.039610] xe 0000:03:00.0: HDMI infoframe: Source Product Description (SPD), version 1, length 25
<7> [94.039611] xe 0000:03:00.0: vendor: Intel
<7> [94.039613] xe 0000:03:00.0: product: Discrete gfx
<7> [94.039614] xe 0000:03:00.0: source device information: PC General (0x9)
<7> [94.039615] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] found:
<7> [94.039711] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:505:pipe D] fastset requirement not met in hdmi infoframe
<7> [94.039805] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] expected:
<7> [94.039898] xe 0000:03:00.0: HDMI infoframe: Vendor, version 1, length 4
<7> [94.039900] xe 0000:03:00.0: empty frame
<7> [94.039901] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] found:
<7> [94.039995] xe 0000:03:00.0: [drm:intel_atomic_check [xe]] [CRTC:505:pipe D] fastset requirement not met, forcing full modeset
<7> [94.040092] xe 0000:03:00.0: [drm:intel_dpll_crtc_put [xe]] [CRTC:505:pipe D] releasing TC PLL 3
<7> [94.040203] xe 0000:03:00.0: [drm:skl_compute_wm [xe]] Enabled dbuf slices 0x3 -> 0x1 (total dbuf slices 0xf), mbus joined? no->no
<7> [94.040284] xe 0000:03:00.0: [drm:skl_compute_wm [xe]] [CRTC:505:pipe D] dbuf slices 0x3 -> 0x0, ddb (0 - 2048) -> (0 - 0), active pipes 0x8 -> 0x0
<7> [94.040380] xe 0000:03:00.0: [drm:skl_print_plane_ddb_changes [xe]] [PLANE:499:cursor D] ddb (1989 - 2048) -> ( 0 - 0), size 59 -> 0
<7> [94.040468] xe 0000:03:00.0: [drm:intel_cdclk_atomic_check [xe]] [CRTC:505:pipe D] min cdclk: 192000 kHz -> 0 kHz
<7> [94.040614] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [CRTC:505:pipe D] enable: no [modeset]
<7> [94.040720] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:389:plane 1D] fb: [NOFB], visible: no
<7> [94.040822] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:419:plane 2D] fb: [NOFB], visible: no
<7> [94.040924] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:449:plane 3D] fb: [NOFB], visible: no
<7> [94.041025] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:479:plane 4D] fb: [NOFB], visible: no
<7> [94.041126] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:489:plane 5D] fb: [NOFB], visible: no
<7> [94.041225] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:499:cursor D] fb: [NOFB], visible: no
<7> [94.041899] xe 0000:03:00.0: [drm:intel_audio_codec_disable [xe]] [CONNECTOR:539:HDMI-A-3][ENCODER:538:DDI TC3/PHY H] Disable audio codec on [CRTC:505:pipe D]
<7> [94.063142] xe 0000:03:00.0: [drm:intel_disable_transcoder [xe]] disabling pipe D
<7> [94.080717] xe 0000:03:00.0: [drm:intel_dpll_disable [xe]] disable TC PLL 3 (active 0x8, on? 1) for [CRTC:505:pipe D]
<7> [94.083308] xe 0000:03:00.0: [drm:intel_dpll_disable [xe]] disabling TC PLL 3
<7> [94.084214] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:507:DDI TC1/PHY F]
<7> [94.084783] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:509:DP-MST A]
<7> [94.085286] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:510:DP-MST B]
<7> [94.085813] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:511:DP-MST C]
<7> [94.086295] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:512:DP-MST D]
<7> [94.086809] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:526:DDI TC2/PHY G]
<7> [94.087272] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:528:DP-MST A]
<7> [94.087714] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:529:DP-MST B]
<7> [94.088117] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:530:DP-MST C]
<7> [94.088492] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:531:DP-MST D]
<7> [94.088864] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:538:DDI TC3/PHY H]
<7> [94.089445] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:542:DDI TC4/PHY I]
<7> [94.089815] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:544:DP-MST A]
<7> [94.090143] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:545:DP-MST B]
<7> [94.090450] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:546:DP-MST C]
<7> [94.090798] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:547:DP-MST D]
<7> [94.091084] xe 0000:03:00.0: [drm:verify_connector_state [xe]] [CONNECTOR:539:HDMI-A-3]
<7> [94.091619] xe 0000:03:00.0: [drm:intel_dbuf_mdclk_cdclk_ratio_update [xe]] Updating dbuf ratio to 2 (mbus joined: no)
<7> [94.092077] xe 0000:03:00.0: [drm:gen9_dbuf_slices_update [xe]] Updating dbuf slices to 0x1
<7> [94.092663] xe 0000:03:00.0: [drm:intel_power_well_disable [xe]] disabling PW_D
<7> [94.093150] xe 0000:03:00.0: [drm:dss_pipe_gating_enable_disable [xe]] DSS clock gating disabled for pipe_mask=0x8 (CLKGATE_DIS_DSSDSC=0xaa000000)
<7> [94.093655] xe 0000:03:00.0: [drm:intel_power_well_disable [xe]] disabling PW_2
<7> [94.094130] xe 0000:03:00.0: [drm:intel_modeset_verify_crtc [xe]] [CRTC:505:pipe D]
<7> [94.095255] xe 0000:03:00.0: [drm:drm_mode_setcrtc] [CRTC:387:pipe B]
<7> [94.095300] xe 0000:03:00.0: [drm:drm_mode_setcrtc] [CONNECTOR:539:HDMI-A-3]
<7> [94.095424] xe 0000:03:00.0: [drm:intel_hdmi_compute_output_format [xe]] picking 12 bpc for HDMI output (pipe bpp: 36)
<7> [94.095667] xe 0000:03:00.0: [drm:intel_atomic_check [xe]] [CRTC:387:pipe B] hw max bpp: 36, pipe bpp: 36, dithering: 0
<7> [94.095873] xe 0000:03:00.0: [drm:intel_ddi_compute_config_late [xe]] [ENCODER:538:DDI TC3/PHY H] [CRTC:387:pipe B]
<7> [94.096070] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.enable (expected no, found yes)
<7> [94.096258] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.active (expected no, found yes)
<7> [94.096438] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in cpu_transcoder (expected -1, found 1)
<7> [94.096633] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in lane_count (expected 0, found 4)
<7> [94.096809] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in output_types (expected 0x00000000, found 0x00000040)
<7> [94.096974] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in framestart_delay (expected 0, found 1)
<7> [94.097134] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 0, found 1920)
<7> [94.097290] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 0, found 2200)
<7> [94.097435] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 0, found 1920)
<7> [94.097593] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 0, found 2200)
<7> [94.097731] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 0, found 2008)
<7> [94.097866] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 0, found 2052)
<7> [94.098008] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 0, found 1080)
<7> [94.098140] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 0, found 1080)
<7> [94.098272] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 0, found 1084)
<7> [94.098390] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 0, found 1089)
<7> [94.098518] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 0, found 1125)
<7> [94.098635] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 0, found 1125)
<7> [94.098753] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 0, found 1920)
<7> [94.098865] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 0, found 2200)
<7> [94.098975] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 0, found 1920)
<7> [94.099085] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 0, found 2200)
<7> [94.099196] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 0, found 2008)
<7> [94.099299] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 0, found 2052)
<7> [94.099405] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 0, found 1080)
<7> [94.099519] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 0, found 1080)
<7> [94.099624] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 0, found 1084)
<7> [94.099726] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 0, found 1089)
<7> [94.099827] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 0, found 1125)
<7> [94.099927] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 0, found 1125)
<7> [94.100027] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in pixel_multiplier (expected 0, found 1)
<7> [94.100127] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 0, found 1)
<7> [94.100227] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.adjusted_mode.flags (4) (expected 0, found 4)
<7> [94.100326] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in has_hdmi_sink (expected no, found yes)
<7> [94.100425] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in has_infoframe (expected no, found yes)
<7> [94.100531] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in pipe_bpp (expected 0, found 36)
<7> [94.100630] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 0, found 148500)
<7> [94.100729] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 0, found 148500)
<7> [94.100828] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in port_clock (expected 0, found 222750)
<7> [94.100927] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in infoframes.enable (expected 0x00000000, found 0x00000071)
<7> [94.101026] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in infoframes.gcp (expected 0x00000000, found 0x00000006)
<7> [94.101124] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in avi infoframe
<7> [94.101223] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] expected:
<7> [94.101322] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] found:
<7> [94.101420] xe 0000:03:00.0: HDMI infoframe: Auxiliary Video Information (AVI), version 2, length 13
<7> [94.101422] xe 0000:03:00.0: colorspace: RGB
<7> [94.101423] xe 0000:03:00.0: scan mode: Underscan
<7> [94.101424] xe 0000:03:00.0: colorimetry: No Data
<7> [94.101425] xe 0000:03:00.0: picture aspect: 16:9
<7> [94.101426] xe 0000:03:00.0: active aspect: Same as Picture
<7> [94.101428] xe 0000:03:00.0: itc: No Data
<7> [94.101429] xe 0000:03:00.0: extended colorimetry: xvYCC 601
<7> [94.101430] xe 0000:03:00.0: quantization range: Limited
<7> [94.101431] xe 0000:03:00.0: nups: Unknown Non-uniform Scaling
<7> [94.101432] xe 0000:03:00.0: video code: 16
<7> [94.101433] xe 0000:03:00.0: ycc quantization range: Limited
<7> [94.101435] xe 0000:03:00.0: hdmi content type: Graphics
<7> [94.101436] xe 0000:03:00.0: pixel repeat: 0
<7> [94.101437] xe 0000:03:00.0: bar top 0, bottom 0, left 0, right 0
<7> [94.101438] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in spd infoframe
<7> [94.101548] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] expected:
<7> [94.101648] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] found:
<7> [94.101746] xe 0000:03:00.0: HDMI infoframe: Source Product Description (SPD), version 1, length 25
<7> [94.101747] xe 0000:03:00.0: vendor: Intel
<7> [94.101749] xe 0000:03:00.0: product: Discrete gfx
<7> [94.101750] xe 0000:03:00.0: source device information: PC General (0x9)
<7> [94.101751] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:387:pipe B] fastset requirement not met in hdmi infoframe
<7> [94.101849] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] expected:
<7> [94.101947] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] found:
<7> [94.102046] xe 0000:03:00.0: HDMI infoframe: Vendor, version 1, length 4
<7> [94.102048] xe 0000:03:00.0: empty frame
<7> [94.102049] xe 0000:03:00.0: [drm:intel_atomic_check [xe]] [CRTC:387:pipe B] fastset requirement not met, forcing full modeset
<7> [94.102183] xe 0000:03:00.0: [drm:skl_compute_wm [xe]] Enabled dbuf slices 0x1 -> 0xf (total dbuf slices 0xf), mbus joined? no->yes
<7> [94.102272] xe 0000:03:00.0: [drm:skl_compute_wm [xe]] [CRTC:387:pipe B] dbuf slices 0x0 -> 0xf, ddb (0 - 0) -> (0 - 4096), active pipes 0x0 -> 0x2
<7> [94.102376] xe 0000:03:00.0: [drm:skl_print_plane_ddb_changes [xe]] [PLANE:271:plane 1B] ddb ( 0 - 0) -> ( 0 - 4037), size 0 -> 4037
<7> [94.102461] xe 0000:03:00.0: [drm:skl_print_plane_ddb_changes [xe]] [PLANE:381:cursor B] ddb ( 0 - 0) -> (4037 - 4096), size 0 -> 59
<7> [94.102542] xe 0000:03:00.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:271:plane 1B] level wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm -> *wm0,*wm1,*wm2,*wm3,*wm4,*wm5, wm6, wm7,*twm,*swm,*stwm
<7> [94.102621] xe 0000:03:00.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:271:plane 1B] lines 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 4, 4, 9, 9, 17, 17, 17, 17, 0, 15, 0
<7> [94.102698] xe 0000:03:00.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:271:plane 1B] blocks 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 62, 62, 139, 139, 261, 261, 261, 261, 137, 230, 244
<7> [94.102776] xe 0000:03:00.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:271:plane 1B] min_ddb 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 123, 123, 245, 245, 367, 367, 0, 0, 138, 306, 306
<7> [94.102865] xe 0000:03:00.0: [drm:intel_bw_atomic_check [xe]] [CRTC:387:pipe B] data rate 594000 num active planes 1
<7> [94.102979] xe 0000:03:00.0: [drm:intel_bw_atomic_check [xe]] QGV point 0: max bw 33600 required 624 qgv_peak_bw: 48000
<7> [94.103091] xe 0000:03:00.0: [drm:intel_bw_atomic_check [xe]] QGV point 1: max bw 53000 required 624 qgv_peak_bw: 48000
<7> [94.103201] xe 0000:03:00.0: [drm:intel_bw_atomic_check [xe]] Matching peaks QGV bw: 48000 for required data rate: 624
<7> [94.103311] xe 0000:03:00.0: [drm:intel_cdclk_atomic_check [xe]] [CRTC:387:pipe B] min cdclk: 0 kHz -> 192000 kHz
<7> [94.103443] xe 0000:03:00.0: [drm:intel_find_dpll [xe]] [CRTC:387:pipe B] allocated TC PLL 3
<7> [94.103557] xe 0000:03:00.0: [drm:intel_dpll_crtc_get [xe]] [CRTC:387:pipe B] reserving TC PLL 3
<7> [94.103661] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [CRTC:387:pipe B] enable: yes [modeset]
<7> [94.103773] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] active: yes, output_types: HDMI (0x40), output format: RGB, sink format: RGB
<7> [94.103880] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] cpu_transcoder: B, pipe bpp: 36, dithering: 0
<7> [94.103986] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] MST master transcoder: <invalid>
<7> [94.104090] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] port sync: master transcoder: <invalid>, slave transcoder bitmask = 0x0
<7> [94.104195] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] joiner: no, pipes: 0x0
<7> [94.104300] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] splitter: disabled, link count 0, overlap 0
<7> [94.104405] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] audio: 1, infoframes: 1, infoframes enabled: 0x71
<7> [94.104517] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] GCP: 0x6
<7> [94.104620] xe 0000:03:00.0: HDMI infoframe: Auxiliary Video Information (AVI), version 2, length 13
<7> [94.104621] xe 0000:03:00.0: colorspace: RGB
<7> [94.104622] xe 0000:03:00.0: scan mode: Underscan
<7> [94.104624] xe 0000:03:00.0: colorimetry: No Data
<7> [94.104625] xe 0000:03:00.0: picture aspect: 16:9
<7> [94.104626] xe 0000:03:00.0: active aspect: Same as Picture
<7> [94.104627] xe 0000:03:00.0: itc: No Data
<7> [94.104628] xe 0000:03:00.0: extended colorimetry: xvYCC 601
<7> [94.104630] xe 0000:03:00.0: quantization range: Limited
<7> [94.104631] xe 0000:03:00.0: nups: Unknown Non-uniform Scaling
<7> [94.104632] xe 0000:03:00.0: video code: 16
<7> [94.104633] xe 0000:03:00.0: ycc quantization range: Limited
<7> [94.104634] xe 0000:03:00.0: hdmi content type: Graphics
<7> [94.104635] xe 0000:03:00.0: pixel repeat: 0
<7> [94.104637] xe 0000:03:00.0: bar top 0, bottom 0, left 0, right 0
<7> [94.104638] xe 0000:03:00.0: HDMI infoframe: Source Product Description (SPD), version 1, length 25
<7> [94.104640] xe 0000:03:00.0: vendor: Intel
<7> [94.104641] xe 0000:03:00.0: product: Discrete gfx
<7> [94.104642] xe 0000:03:00.0: source device information: PC General (0x9)
<7> [94.104644] xe 0000:03:00.0: HDMI infoframe: Vendor, version 1, length 4
<7> [94.104645] xe 0000:03:00.0: empty frame
<7> [94.104646] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] ELD: 10 00 08 00 65 32 00 01 00 00 00 00 00 00 00 00
<7> [94.104751] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] ELD: 61 a4 9a 00 4d 69 20 54 56 09 07 07 11 17 50 51
<7> [94.104853] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] ELD: 07 00 00 00
<7> [94.104954] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] scanline offset: 1
<7> [94.105056] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] framestart delay: 1, MSA timing delay: 0, set context latency: 0
<7> [94.105160] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] vrr: no, fixed rr: yes, vmin: 1125, vmax: 1125, flipline: 1125, pipeline full: 0, guardband: 45 vsync start: 41, vsync end: 36
<7> [94.105262] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] vrr: vmin vblank: 1080, vmax vblank: 1080, vmin vtotal: 1125, vmax vtotal: 1125
<7> [94.105365] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] vrr: dc balance: no, vmin: 0 vmax: 0 guardband: 0, slope: 0 max increase: 0 max decrease: 0 vblank target: 0
<7> [94.105471] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] requested mode: "1920x1080": 60 148500 1920 2008 2052 2200 1080 1084 1089 1125 0x48 0x5
<7> [94.105578] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] adjusted mode: "1920x1080": 60 148500 1920 2008 2052 2200 1080 1084 1089 1125 0x48 0x5
<7> [94.105682] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] crtc timings: clock=148500, hd=1920 hb=1920-2200 hs=2008-2052 ht=2200, vd=1080 vb=1080-1125 vs=1084-1089 vt=1125, flags=0x5
<7> [94.105787] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pipe mode: "1920x1080": 60 148500 1920 2008 2052 2200 1080 1084 1089 1125 0x40 0x5
<7> [94.105891] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] crtc timings: clock=148500, hd=1920 hb=1920-2200 hs=2008-2052 ht=2200, vd=1080 vb=1080-1125 vs=1084-1089 vt=1125, flags=0x5
<7> [94.105996] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] port clock: 222750, pixel rate 148500, min cdclk 192000, min voltage level 0
<7> [94.106100] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] linetime: 119, ips linetime: 0
<7> [94.106203] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] num_scalers: 2, scaler_users: 0x0, scaler_id: -1, scaling_filter: 0, sharpness_strength: 0
<7> [94.106306] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pipe src: 1920x1080+0+0
<7> [94.106410] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pch pfit: 0x0+0+0, disabled, force thru: no
<7> [94.106522] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] sharpness strength: 0, sharpness tap size: 0, sharpness enable: 0
<7> [94.106626] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] ips: 0, double wide: 0, drrs: 0
<7> [94.106729] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] cx0pll_hw_state: lane_count: 4, ssc_enabled: no, use_c10: no, tbt_mode: no
<7> [94.106833] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] c20pll_hw_state:
<7> [94.106932] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] tx[0] = 0xbe88, tx[1] = 0x5800, tx[2] = 0x0000
<7> [94.107035] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] cmn[0] = 0x0500, cmn[1] = 0x0005, cmn[2] = 0x0000, cmn[3] = 0x0000
<7> [94.107139] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[0] = 0x40e8
<7> [94.107241] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[1] = 0x7d20
<7> [94.107343] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[2] = 0x0a06
<7> [94.107449] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[3] = 0x8f1c
<7> [94.107551] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[4] = 0x0000
<7> [94.107653] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[5] = 0x0000
<7> [94.107756] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[6] = 0x2200
<7> [94.107858] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[7] = 0xffff
<7> [94.107960] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[8] = 0x0400
<7> [94.108062] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[9] = 0x0000
<7> [94.108165] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[10] = 0x0001
<7> [94.108267] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] vdr: custom width: 0x00, serdes rate: 0x00, hdmi rate: 0x00
<7> [94.108368] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] csc_mode: 0x40000000 gamma_mode: 0x0 gamma_enable: 0 csc_enable: 0
<7> [94.108474] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pre csc lut: 0 entries, post csc lut: 0 entries
<7> [94.108578] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] output csc: pre offsets: 0x0000 0x0000 0x0000
<7> [94.108681] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] output csc: coefficients: 0x0db0 0x0000 0x0000
<7> [94.108785] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] output csc: coefficients: 0x0000 0x0db0 0x0000
<7> [94.108885] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] output csc: coefficients: 0x0000 0x0000 0x0db0
<7> [94.108989] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] output csc: post offsets: 0x0100 0x0100 0x0100
<7> [94.109091] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pipe csc: pre offsets: 0x0000 0x0000 0x0000
<7> [94.109193] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [94.109295] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [94.109397] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [94.109507] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pipe csc: post offsets: 0x0000 0x0000 0x0000
<7> [94.109611] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:271:plane 1B] fb: [FB:559] 1920x1080 format = XR24 little-endian (0x34325258) modifier = 0x100000000000009, visible: yes
<7> [94.109715] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] rotation: 0x1, scaler: -1, scaling_filter: 0
<7> [94.109817] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] src: 1920.000000x1080.000000+0.000000+0.000000 dst: 1920x1080+0+0
<7> [94.109923] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:301:plane 2B] fb: [NOFB], visible: no
<7> [94.110030] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:331:plane 3B] fb: [NOFB], visible: no
<7> [94.110135] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:361:plane 4B] fb: [NOFB], visible: no
<7> [94.110237] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:371:plane 5B] fb: [NOFB], visible: no
<7> [94.110338] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:381:cursor B] fb: [NOFB], visible: no
<7> [94.110984] xe 0000:03:00.0: [drm:intel_power_well_enable [xe]] enabling PW_2
<7> [94.111107] xe 0000:03:00.0: [drm:intel_power_well_enable [xe]] enabling PW_B
<7> [94.111473] xe 0000:03:00.0: [drm:dss_pipe_gating_enable_disable [xe]] DSS clock gating enabled for pipe_mask=0x2 (CLKGATE_DIS_DSSDSC=0xa2000000)
<7> [94.111589] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:507:DDI TC1/PHY F]
<7> [94.111687] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:509:DP-MST A]
<7> [94.111780] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:510:DP-MST B]
<7> [94.111871] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:511:DP-MST C]
<7> [94.111961] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:512:DP-MST D]
<7> [94.112051] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:526:DDI TC2/PHY G]
<7> [94.112139] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:528:DP-MST A]
<7> [94.112227] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:529:DP-MST B]
<7> [94.112314] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:530:DP-MST C]
<7> [94.112402] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:531:DP-MST D]
<7> [94.112498] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:538:DDI TC3/PHY H]
<7> [94.112584] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:542:DDI TC4/PHY I]
<7> [94.112671] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:544:DP-MST A]
<7> [94.112758] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:545:DP-MST B]
<7> [94.112845] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:546:DP-MST C]
<7> [94.112930] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:547:DP-MST D]
<7> [94.113227] xe 0000:03:00.0: [drm:gen9_dbuf_slices_update [xe]] Updating dbuf slices to 0xf
<7> [94.113401] xe 0000:03:00.0: [drm:intel_dbuf_mbus_join_update [xe]] Changing mbus joined: no -> yes (pipe: *)
<7> [94.113697] xe 0000:03:00.0: [drm:intel_dbuf_mdclk_cdclk_ratio_update [xe]] Updating dbuf ratio to 4 (mbus joined: yes)
<7> [94.113805] xe 0000:03:00.0: [drm:intel_dpll_enable [xe]] enable TC PLL 3 (active 0x2, on? 0) for [CRTC:387:pipe B]
<7> [94.113908] xe 0000:03:00.0: [drm:intel_dpll_enable [xe]] enabling TC PLL 3
<7> [94.116492] xe 0000:03:00.0: [drm:intel_enable_transcoder [xe]] enabling pipe B
<7> [94.119507] xe 0000:03:00.0: [drm:intel_power_well_disable [xe]] disabling AUX_TC2
<7> [94.151643] xe 0000:03:00.0: [drm:intel_audio_codec_enable [xe]] [CONNECTOR:539:HDMI-A-3][ENCODER:538:DDI TC3/PHY H] Enable audio codec on [CRTC:387:pipe B], 36 bytes ELD
<7> [94.168363] xe 0000:03:00.0: [drm:audio_config_hdmi_pixel_clock [xe]] Configuring HDMI audio for pixel clock 148500 (0x00090000)
<7> [94.169130] xe 0000:03:00.0: [drm:hsw_audio_config_update [xe]] using automatic N
<7> [94.170176] xe 0000:03:00.0: [drm:verify_connector_state [xe]] [CONNECTOR:539:HDMI-A-3]
<7> [94.171006] xe 0000:03:00.0: [drm:intel_modeset_verify_crtc [xe]] [CRTC:387:pipe B]
<7> [94.176666] xe 0000:03:00.0: [drm:drm_mode_setcrtc] [CRTC:269:pipe C]
<7> [94.176753] xe 0000:03:00.0: [drm:drm_mode_setcrtc] [CONNECTOR:527:DP-2]
<7> [94.177032] xe 0000:03:00.0: [drm:intel_dp_compute_config_limits [xe]] [ENCODER:526:DDI TC2/PHY G][CRTC:269:pipe C] DP link limits: pixel clock 148500 kHz DSC off max lanes 4 max rate 540000 max pipe_bpp 36 min link_bpp 18.0000 max link_bpp 36.0000
<7> [94.177591] xe 0000:03:00.0: [drm:intel_dp_compute_output_format [xe]] DP lane count 4 clock 270000 bpp input 36 compressed 0.0000 HDR no link rate required 668250 available 1080000
<7> [94.178059] xe 0000:03:00.0: [drm:intel_atomic_check [xe]] [CRTC:269:pipe C] hw max bpp: 36, pipe bpp: 36, dithering: 0
<7> [94.178541] xe 0000:03:00.0: [drm:intel_ddi_compute_config_late [xe]] [ENCODER:526:DDI TC2/PHY G] [CRTC:269:pipe C]
<7> [94.179041] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.enable (expected no, found yes)
<7> [94.179486] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.active (expected no, found yes)
<7> [94.179884] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in cpu_transcoder (expected -1, found 2)
<7> [94.180256] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in lane_count (expected 0, found 4)
<7> [94.180633] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in dp_m_n (expected tu 0 data 0/0 link 0/0, found tu 64, data 5190451/8388608 link 288358/524288)
<7> [94.180975] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in output_types (expected 0x00000000, found 0x00000080)
<7> [94.181297] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in framestart_delay (expected 0, found 1)
<7> [94.181628] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 0, found 1920)
<7> [94.181928] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 0, found 2200)
<7> [94.182212] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 0, found 1920)
<7> [94.182487] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 0, found 2200)
<7> [94.182750] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 0, found 2008)
<7> [94.182999] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 0, found 2052)
<7> [94.183242] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 0, found 1080)
<7> [94.183485] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 0, found 1080)
<7> [94.183716] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 0, found 1084)
<7> [94.183938] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 0, found 1089)
<7> [94.184158] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 0, found 1125)
<7> [94.184373] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 0, found 1125)
<7> [94.184599] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 0, found 1920)
<7> [94.184828] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 0, found 2200)
<7> [94.185018] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 0, found 1920)
<7> [94.185207] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 0, found 2200)
<7> [94.185385] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 0, found 2008)
<7> [94.185580] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 0, found 2052)
<7> [94.185752] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 0, found 1080)
<7> [94.185916] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 0, found 1080)
<7> [94.186081] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 0, found 1084)
<7> [94.186241] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 0, found 1089)
<7> [94.186393] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 0, found 1125)
<7> [94.186561] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 0, found 1125)
<7> [94.186710] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in pixel_multiplier (expected 0, found 1)
<7> [94.186857] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 0, found 1)
<7> [94.186999] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.adjusted_mode.flags (4) (expected 0, found 4)
<7> [94.187140] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in enhanced_framing (expected no, found yes)
<7> [94.187282] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in dpll_hw_state
<7> [94.187415] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] expected:
<7> [94.187561] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] cx0pll_hw_state: lane_count: 4, ssc_enabled: no, use_c10: no, tbt_mode: no
<7> [94.187689] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] c20pll_hw_state:
<7> [94.187814] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] tx[0] = 0xbe88, tx[1] = 0x5800, tx[2] = 0x0000
<7> [94.187934] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] cmn[0] = 0x0500, cmn[1] = 0x0005, cmn[2] = 0x0000, cmn[3] = 0x0000
<7> [94.188056] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[0] = 0x40e8
<7> [94.188177] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[1] = 0x7d20
<7> [94.188295] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[2] = 0x0a06
<7> [94.188407] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[3] = 0x8f1c
<7> [94.188556] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[4] = 0x0000
<7> [94.188665] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[5] = 0x0000
<7> [94.188771] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[6] = 0x2200
<7> [94.188873] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[7] = 0xffff
<7> [94.188975] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[8] = 0x0400
<7> [94.189079] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[9] = 0x0000
<7> [94.189182] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[10] = 0x0001
<7> [94.189282] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] vdr: custom width: 0x00, serdes rate: 0x00, hdmi rate: 0x00
<7> [94.189383] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] found:
<7> [94.189492] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] cx0pll_hw_state: lane_count: 4, ssc_enabled: no, use_c10: no, tbt_mode: no
<7> [94.189593] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] c20pll_hw_state:
<7> [94.189693] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] tx[0] = 0xbe88, tx[1] = 0x4800, tx[2] = 0x0000
<7> [94.189794] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] cmn[0] = 0x0500, cmn[1] = 0x0005, cmn[2] = 0x0000, cmn[3] = 0x0000
<7> [94.189894] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[0] = 0x308c
<7> [94.189995] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[1] = 0x2110
<7> [94.190094] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[2] = 0xcc9c
<7> [94.190194] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[3] = 0xbfc1
<7> [94.190293] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[4] = 0x4b9a
<7> [94.190393] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[5] = 0x3f81
<7> [94.190500] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[6] = 0x2000
<7> [94.190600] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[7] = 0x0001
<7> [94.190700] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[8] = 0x5000
<7> [94.190799] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[9] = 0x0000
<7> [94.190899] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] mpllb[10] = 0x0000
<7> [94.190999] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] vdr: custom width: 0x00, serdes rate: 0x42, hdmi rate: 0x00
<7> [94.191099] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in pipe_bpp (expected 0, found 36)
<7> [94.191199] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 0, found 148500)
<7> [94.191300] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 0, found 148500)
<7> [94.191400] xe 0000:03:00.0: [drm:intel_pipe_config_compare [xe]] [CRTC:269:pipe C] fastset requirement not met in port_clock (expected 0, found 270000)
<7> [94.191511] xe 0000:03:00.0: [drm:intel_atomic_check [xe]] [CRTC:269:pipe C] fastset requirement not met, forcing full modeset
<7> [94.191640] xe 0000:03:00.0: [drm:skl_compute_wm [xe]] Enabled dbuf slices 0xf -> 0xd (total dbuf slices 0xf), mbus joined? yes->no
<7> [94.191735] xe 0000:03:00.0: [drm:skl_compute_wm [xe]] [CRTC:387:pipe B] dbuf slices 0xf -> 0xc, ddb (0 - 4096) -> (0 - 1024), active pipes 0x2 -> 0x6
<7> [94.191819] xe 0000:03:00.0: [drm:skl_compute_wm [xe]] [CRTC:269:pipe C] dbuf slices 0x0 -> 0xc, ddb (0 - 0) -> (1024 - 2048), active pipes 0x2 -> 0x6
<7> [94.191924] xe 0000:03:00.0: [drm:skl_print_plane_ddb_changes [xe]] [PLANE:271:plane 1B] ddb ( 0 - 4037) -> ( 0 - 965), size 4037 -> 965
<7> [94.192002] xe 0000:03:00.0: [drm:skl_print_plane_ddb_changes [xe]] [PLANE:381:cursor B] ddb (4037 - 4096) -> ( 965 - 1024), size 59 -> 59
<7> [94.192079] xe 0000:03:00.0: [drm:skl_print_plane_ddb_changes [xe]] [PLANE:153:plane 1C] ddb ( 0 - 0) -> (1024 - 1989), size 0 -> 965
<7> [94.192154] xe 0000:03:00.0: [drm:skl_print_plane_ddb_changes [xe]] [PLANE:263:cursor C] ddb ( 0 - 0) -> (1989 - 2048), size 0 -> 59
<7> [94.192230] xe 0000:03:00.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:153:plane 1C] level wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm -> *wm0,*wm1,*wm2,*wm3,*wm4,*wm5, wm6, wm7,*twm,*swm,*stwm
<7> [94.192304] xe 0000:03:00.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:153:plane 1C] lines 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 4, 4, 9, 9, 17, 17, 17, 17, 0, 15, 0
<7> [94.192379] xe 0000:03:00.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:153:plane 1C] blocks 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 62, 62, 139, 139, 261, 261, 261, 261, 137, 230, 244
<7> [94.192462] xe 0000:03:00.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:153:plane 1C] min_ddb 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 123, 123, 245, 245, 367, 367, 0, 0, 138, 306, 306
<7> [94.192550] xe 0000:03:00.0: [drm:intel_bw_atomic_check [xe]] [CRTC:269:pipe C] data rate 594000 num active planes 1
<7> [94.192666] xe 0000:03:00.0: [drm:intel_bw_atomic_check [xe]] QGV point 0: max bw 33600 required 1248 qgv_peak_bw: 48000
<7> [94.192780] xe 0000:03:00.0: [drm:intel_bw_atomic_check [xe]] QGV point 1: max bw 53000 required 1248 qgv_peak_bw: 48000
<7> [94.192889] xe 0000:03:00.0: [drm:intel_bw_atomic_check [xe]] Matching peaks QGV bw: 48000 for required data rate: 1248
<7> [94.192996] xe 0000:03:00.0: [drm:intel_cdclk_atomic_check [xe]] [CRTC:269:pipe C] min cdclk: 0 kHz -> 192000 kHz
<7> [94.193126] xe 0000:03:00.0: [drm:intel_find_dpll [xe]] [CRTC:269:pipe C] allocated TC PLL 2
<7> [94.193231] xe 0000:03:00.0: [drm:intel_dpll_crtc_get [xe]] [CRTC:269:pipe C] reserving TC PLL 2
<7> [94.193332] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [CRTC:269:pipe C] enable: yes [modeset]
<7> [94.193464] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] active: yes, output_types: DP (0x80), output format: RGB, sink format: RGB
<7> [94.193573] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] cpu_transcoder: C, pipe bpp: 36, dithering: 0
<7> [94.193681] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] MST master transcoder: <invalid>
<7> [94.193785] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] port sync: master transcoder: <invalid>, slave transcoder bitmask = 0x0
<7> [94.193891] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] joiner: no, pipes: 0x0
<7> [94.193996] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] splitter: disabled, link count 0, overlap 0
<7> [94.194098] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] dp m_n: lanes: 4; data_m: 5190451, data_n: 8388608, link_m: 288358, link_n: 524288, tu: 64
<7> [94.194202] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] dp m2_n2: lanes: 4; data_m: 0, data_n: 0, link_m: 0, link_n: 0, tu: 0
<7> [94.194310] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] fec: disabled, enhanced framing: enabled
<7> [94.194413] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] sdp split: disabled
<7> [94.194530] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] psr: disabled, selective update: disabled, panel replay: disabled, selective fetch: disabled
<7> [94.194634] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] minimum hblank: 0
<7> [94.194736] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] audio: 1, infoframes: 0, infoframes enabled: 0x0
<7> [94.194838] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] ELD: 10 00 09 00 68 36 00 01 00 00 00 00 00 00 00 00
<7> [94.194940] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] ELD: 61 a4 9a 00 44 50 46 39 30 34 33 35 09 07 07 11
<7> [94.195041] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] ELD: 17 50 51 07 00 00 00 00
<7> [94.195143] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] scanline offset: 1
<7> [94.195244] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] framestart delay: 1, MSA timing delay: 0, set context latency: 0
<7> [94.195346] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] vrr: no, fixed rr: yes, vmin: 1125, vmax: 1125, flipline: 1125, pipeline full: 0, guardband: 42 vsync start: 41, vsync end: 36
<7> [94.195455] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] vrr: vmin vblank: 1083, vmax vblank: 1083, vmin vtotal: 1125, vmax vtotal: 1125
<7> [94.195557] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] vrr: dc balance: no, vmin: 0 vmax: 0 guardband: 0, slope: 0 max increase: 0 max decrease: 0 vblank target: 0
<7> [94.195659] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] requested mode: "1920x1080": 60 148500 1920 2008 2052 2200 1080 1084 1089 1125 0x48 0x5
<7> [94.195762] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] adjusted mode: "1920x1080": 60 148500 1920 2008 2052 2200 1080 1084 1089 1125 0x48 0x5
<7> [94.195864] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] crtc timings: clock=148500, hd=1920 hb=1920-2200 hs=2008-2052 ht=2200, vd=1080 vb=1080-1125 vs=1084-1089 vt=1125, flags=0x5
<7> [94.195966] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pipe mode: "1920x1080": 60 148500 1920 2008 2052 2200 1080 1084 1089 1125 0x40 0x5
<7> [94.196068] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] crtc timings: clock=148500, hd=1920 hb=1920-2200 hs=2008-2052 ht=2200, vd=1080 vb=1080-1125 vs=1084-1089 vt=1125, flags=0x5
<7> [94.196170] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] port clock: 270000, pixel rate 148500, min cdclk 192000, min voltage level 0
<7> [94.196271] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] linetime: 119, ips linetime: 0
<7> [94.196373] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] num_scalers: 2, scaler_users: 0x0, scaler_id: -1, scaling_filter: 0, sharpness_strength: 0
<7> [94.196483] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pipe src: 1920x1080+0+0
<7> [94.196585] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pch pfit: 0x0+0+0, disabled, force thru: no
<7> [94.196686] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] sharpness strength: 0, sharpness tap size: 0, sharpness enable: 0
<7> [94.196788] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] ips: 0, double wide: 0, drrs: 0
<7> [94.196889] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] cx0pll_hw_state: lane_count: 4, ssc_enabled: no, use_c10: no, tbt_mode: no
<7> [94.196991] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] c20pll_hw_state:
<7> [94.197092] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] tx[0] = 0xbe88, tx[1] = 0x4800, tx[2] = 0x0000
<7> [94.197193] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] cmn[0] = 0x0500, cmn[1] = 0x0005, cmn[2] = 0x0000, cmn[3] = 0x0000
<7> [94.197295] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[0] = 0x308c
<7> [94.197397] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[1] = 0x2110
<7> [94.197508] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[2] = 0xcc9c
<7> [94.197609] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[3] = 0xbfc1
<7> [94.197710] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[4] = 0x4b9a
<7> [94.197811] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[5] = 0x3f81
<7> [94.197913] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[6] = 0x2000
<7> [94.198013] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[7] = 0x0001
<7> [94.198113] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[8] = 0x5000
<7> [94.198213] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[9] = 0x0000
<7> [94.198314] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] mpllb[10] = 0x0000
<7> [94.198419] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] vdr: custom width: 0x00, serdes rate: 0x42, hdmi rate: 0x00
<7> [94.198522] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] csc_mode: 0x40000000 gamma_mode: 0x0 gamma_enable: 0 csc_enable: 0
<7> [94.198624] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pre csc lut: 0 entries, post csc lut: 0 entries
<7> [94.198725] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] output csc: pre offsets: 0x0000 0x0000 0x0000
<7> [94.198826] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] output csc: coefficients: 0x0db0 0x0000 0x0000
<7> [94.198927] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] output csc: coefficients: 0x0000 0x0db0 0x0000
<7> [94.199029] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] output csc: coefficients: 0x0000 0x0000 0x0db0
<7> [94.199130] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] output csc: post offsets: 0x0100 0x0100 0x0100
<7> [94.199232] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pipe csc: pre offsets: 0x0000 0x0000 0x0000
<7> [94.199333] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [94.199439] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [94.199541] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [94.199642] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] pipe csc: post offsets: 0x0000 0x0000 0x0000
<7> [94.199744] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:153:plane 1C] fb: [FB:559] 1920x1080 format = XR24 little-endian (0x34325258) modifier = 0x100000000000009, visible: yes
<7> [94.199846] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] rotation: 0x1, scaler: -1, scaling_filter: 0
<7> [94.199947] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] src: 1920.000000x1080.000000+0.000000+0.000000 dst: 1920x1080+0+0
<7> [94.200049] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:183:plane 2C] fb: [NOFB], visible: no
<7> [94.200151] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:213:plane 3C] fb: [NOFB], visible: no
<7> [94.200253] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:243:plane 4C] fb: [NOFB], visible: no
<7> [94.200354] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:253:plane 5C] fb: [NOFB], visible: no
<7> [94.200463] xe 0000:03:00.0: [drm:intel_crtc_state_dump [xe]] [PLANE:263:cursor C] fb: [NOFB], visible: no
<7> [94.201364] xe 0000:03:00.0: [drm:intel_power_well_enable [xe]] enabling PW_C
<7> [94.201517] xe 0000:03:00.0: [drm:dss_pipe_gating_enable_disable [xe]] DSS clock gating enabled for pipe_mask=0x4 (CLKGATE_DIS_DSSDSC=0x82000000)
<7> [94.201843] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:507:DDI TC1/PHY F]
<7> [94.201943] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:509:DP-MST A]
<7> [94.202037] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:510:DP-MST B]
<7> [94.202131] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:511:DP-MST C]
<7> [94.202221] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:512:DP-MST D]
<7> [94.202311] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:526:DDI TC2/PHY G]
<7> [94.202399] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:528:DP-MST A]
<7> [94.202498] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:529:DP-MST B]
<7> [94.202586] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:530:DP-MST C]
<7> [94.202674] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:531:DP-MST D]
<7> [94.202761] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:538:DDI TC3/PHY H]
<7> [94.202848] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:542:DDI TC4/PHY I]
<7> [94.202935] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:544:DP-MST A]
<7> [94.203021] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:545:DP-MST B]
<7> [94.203106] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:546:DP-MST C]
<7> [94.203197] xe 0000:03:00.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:547:DP-MST D]
<7> [94.218187] xe 0000:03:00.0: [drm:intel_dbuf_mdclk_cdclk_ratio_update [xe]] Updating dbuf ratio to 2 (mbus joined: no)
<7> [94.218512] xe 0000:03:00.0: [drm:intel_dbuf_mbus_join_update [xe]] Changing mbus joined: yes -> no (pipe: B)
<7> [94.234881] xe 0000:03:00.0: [drm:intel_dpll_enable [xe]] enable TC PLL 2 (active 0x4, on? 0) for [CRTC:269:pipe C]
<7> [94.235150] xe 0000:03:00.0: [drm:intel_dpll_enable [xe]] enabling TC PLL 2
<7> [94.237601] xe 0000:03:00.0: [drm:intel_power_well_enable [xe]] enabling AUX_TC2
<7> [94.243084] xe 0000:03:00.0: [drm:drm_dp_read_dpcd_caps [drm_display_helper]] AUX USBC2/DDI TC2/PHY G: DPCD: 12 14 c4 01 01 15 01 81 00 01 04 01 0f 00 01
<7> [94.250276] xe 0000:03:00.0: [drm:intel_dp_init_lttpr_and_dprx_caps [xe]] [CONNECTOR:527:DP-2][ENCODER:526:DDI TC2/PHY G][DPRX] LTTPR common capabilities: 00 00 00 00 00 00 00 00
<7> [94.251808] xe 0000:03:00.0: [drm:drm_dp_read_dpcd_caps [drm_display_helper]] AUX USBC2/DDI TC2/PHY G: DPCD: 12 14 c4 01 01 15 01 81 00 01 04 01 0f 00 01
<7> [94.252537] xe 0000:03:00.0: [drm:intel_dp_start_link_train [xe]] [CONNECTOR:527:DP-2][ENCODER:526:DDI TC2/PHY G][DPRX] Using LINK_BW_SET value 0a
<7> [94.254518] xe 0000:03:00.0: [drm:intel_dp_set_signal_levels [xe]] [CONNECTOR:527:DP-2][ENCODER:526:DDI TC2/PHY G][DPRX] 8b/10b, lanes: 4, vswing levels: 0/0/0/0, pre-emphasis levels: 0/0/0/0
<7> [94.255506] xe 0000:03:00.0: [drm:intel_dp_program_link_training_pattern [xe]] [CONNECTOR:527:DP-2][ENCODER:526:DDI TC2/PHY G][DPRX] Using DP training pattern TPS1
<7> [94.262312] xe 0000:03:00.0: [drm:intel_dp_link_train_phy [xe]] [CONNECTOR:527:DP-2][ENCODER:526:DDI TC2/PHY G][DPRX] Clock recovery OK
<7> [94.262847] xe 0000:03:00.0: [drm:intel_dp_program_link_training_pattern [xe]] [CONNECTOR:527:DP-2][ENCODER:526:DDI TC2/PHY G][DPRX] Using DP training pattern TPS3
<7> [94.269851] xe 0000:03:00.0: [drm:intel_dp_link_train_phy [xe]] [CONNECTOR:527:DP-2][ENCODER:526:DDI TC2/PHY G][DPRX] Channel EQ done. DP Training successful
<7> [94.270375] xe 0000:03:00.0: [drm:intel_dp_link_train_phy [xe]] [CONNECTOR:527:DP-2][ENCODER:526:DDI TC2/PHY G][DPRX] Link Training passed at link rate = 270000, lane count = 4
<7> [94.272103] xe 0000:03:00.0: [drm:intel_enable_transcoder [xe]] enabling pipe C
<7> [94.306527] xe 0000:03:00.0: [drm:gen9_dbuf_slices_update [xe]] Updating dbuf slices to 0xd
<7> [94.307715] xe 0000:03:00.0: [drm:intel_audio_codec_enable [xe]] [CONNECTOR:527:DP-2][ENCODER:526:DDI TC2/PHY G] Enable audio codec on [CRTC:269:pipe C], 40 bytes ELD
<7> [94.323528] xe 0000:03:00.0: [drm:verify_connector_state [xe]] [CONNECTOR:527:DP-2]
<7> [94.324433] xe 0000:03:00.0: [drm:intel_modeset_verify_crtc [xe]] [CRTC:269:pipe C]
<7> [94.375436] xe 0000:03:00.0: [drm:intel_power_well_disable [xe]] disabling AUX_TC2
<6> [95.310782] [IGT] kms_flip: finished subtest BC-DP2-HDMI-A3, FAIL
Created at 2026-05-28 01:30:36