Results for igt@kms_vrr@seamless-rr-switch-virtual@pipe-a-edp-1

Result: Fail

i915_display_info17 igt_runner17 results17.json results17-xe-load.json guc_logs17.tar i915_display_info_post_exec17 serial_data17 boot17 dmesg17

DetailValue
Duration 6.26 seconds
Hostname
shard-lnl-3
Igt-Version
IGT-Version: 2.4-g22222b7d9 (x86_64) (Linux: 7.1.0-rc3-lgci-xe-xe-5065-66af2225d31aa8315-debug+ x86_64)
Out
Using IGT_SRANDOM=1778848315 for randomisation
Opened device: /dev/dri/card0
Starting subtest: seamless-rr-switch-virtual
Default Mode:   2880x1800: 60 347710 2880 2928 2960 3040 1800 1803 1809 1906 0x48 0xa 
Starting dynamic subtest: pipe-A-eDP-1
Use HIGH_RR Mode as default
  2880x1800: 120 695310 2880 2928 2960 3040 1800 1803 1809 1906 0x40 0xa 
Requested rate[0]: 8333333 ns (120.00 Hz), Expected rate between: 8264462 ns (121.00 Hz) to 8403361 ns (119.00 Hz)
Completed 319 flips, 37 were in threshold for [(120 Hz) 8333333ns]
Stack trace:
  #0 ../lib/igt_core.c:2074 __igt_fail_assert()
  #1 ../tests/kms_vrr.c:773 test_seamless_virtual_rr_basic()
  #2 ../tests/kms_vrr.c:998 run_vrr_test.constprop.0()
  #3 ../tests/kms_vrr.c:1105 __igt_unique____real_main1046()
  #4 ../tests/kms_vrr.c:1046 main()
  #5 [__libc_init_first+0x8a]
  #6 [__libc_start_main+0x8b]
  #7 [_start+0x25]
Dynamic subtest pipe-A-eDP-1: FAIL (6.257s)
Subtest seamless-rr-switch-virtual: FAIL (6.563s)
Err
Starting subtest: seamless-rr-switch-virtual
Starting dynamic subtest: pipe-A-eDP-1
[471.815472] (kms_vrr:8884) CRITICAL: Test assertion failure function test_seamless_virtual_rr_basic, file ../tests/kms_vrr.c:776:
[471.815478] (kms_vrr:8884) CRITICAL: Failed assertion: result > 75
[471.815485] (kms_vrr:8884) CRITICAL: Refresh rate (120 Hz) 8333333ns: Target threshold not reached, result was 11%
Dynamic subtest pipe-A-eDP-1 failed.
**** DEBUG ****
commit {
[471.753690] (kms_vrr:8884) igt_kms-DEBUG: display:     populating plane data: A.0, fb 433
[471.753691] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_X" to 0x0/0
[471.753691] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_Y" to 0x0/0
[471.753691] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_W" to 0xb400000/188743680
[471.753692] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_H" to 0x7080000/117964800
[471.753692] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_W" to 0xb40/2880
[471.753693] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_H" to 0x708/1800
[471.753693] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "FB_ID" to 0x1b1/433
[471.753694] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_ID" to 0x97/151
[471.753694] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_ENCODING" to 0x0/0
[471.753694] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_RANGE" to 0x0/0
[471.756483] (kms_vrr:8884) igt_kms-DEBUG: display: }
[471.756491] (kms_vrr:8884) DEBUG: event_ns - last_event_ns: 16667000 (60.00 Hz)
[471.756492] (kms_vrr:8884) igt_kms-DEBUG: display: A.0: plane_set_fb(432)
[471.756492] (kms_vrr:8884) igt_kms-DEBUG: display: A.0: plane_set_size (2880x1800)
[471.756493] (kms_vrr:8884) igt_kms-DEBUG: display: A.0: fb_set_position(0,0)
[471.756493] (kms_vrr:8884) igt_kms-DEBUG: display: A.0: fb_set_size(2880x1800)
[471.756494] (kms_vrr:8884) igt_kms-DEBUG: display: commit {
[471.756494] (kms_vrr:8884) igt_kms-DEBUG: display:     populating plane data: A.0, fb 432
[471.756495] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_X" to 0x0/0
[471.756496] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_Y" to 0x0/0
[471.756496] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_W" to 0xb400000/188743680
[471.756496] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_H" to 0x7080000/117964800
[471.756497] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_W" to 0xb40/2880
[471.756497] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_H" to 0x708/1800
[471.756498] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "FB_ID" to 0x1b0/432
[471.756498] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_ID" to 0x97/151
[471.756498] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_ENCODING" to 0x0/0
[471.756499] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_RANGE" to 0x0/0
[471.764151] (kms_vrr:8884) igt_kms-DEBUG: display: }
[471.764153] (kms_vrr:8884) igt_kms-DEBUG: display: commit {
[471.764154] (kms_vrr:8884) igt_kms-DEBUG: display:     populating plane data: A.0, fb 432
[471.764156] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_X" to 0x0/0
[471.764157] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_Y" to 0x0/0
[471.764157] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_W" to 0xb400000/188743680
[471.764158] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_H" to 0x7080000/117964800
[471.764158] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_W" to 0xb40/2880
[471.764159] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_H" to 0x708/1800
[471.764159] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "FB_ID" to 0x1b0/432
[471.764160] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_ID" to 0x97/151
[471.764160] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_ENCODING" to 0x0/0
[471.764161] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_RANGE" to 0x0/0
[471.769424] (kms_vrr:8884) igt_kms-DEBUG: display: }
[471.769425] (kms_vrr:8884) igt_kms-DEBUG: display: commit {
[471.769425] (kms_vrr:8884) igt_kms-DEBUG: display:     populating plane data: A.0, fb 432
[471.769426] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_X" to 0x0/0
[471.769426] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_Y" to 0x0/0
[471.769427] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_W" to 0xb400000/188743680
[471.769427] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_H" to 0x7080000/117964800
[471.769428] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_W" to 0xb40/2880
[471.769428] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_H" to 0x708/1800
[471.769429] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "FB_ID" to 0x1b0/432
[471.769429] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_ID" to 0x97/151
[471.769429] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_ENCODING" to 0x0/0
[471.769430] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_RANGE" to 0x0/0
[471.772337] (kms_vrr:8884) igt_kms-DEBUG: display: }
[471.772347] (kms_vrr:8884) DEBUG: event_ns - last_event_ns: 16663000 (60.01 Hz)
[471.772349] (kms_vrr:8884) igt_kms-DEBUG: display: A.0: plane_set_fb(433)
[471.772350] (kms_vrr:8884) igt_kms-DEBUG: display: A.0: plane_set_size (2880x1800)
[471.772350] (kms_vrr:8884) igt_kms-DEBUG: display: A.0: fb_set_position(0,0)
[471.772351] (kms_vrr:8884) igt_kms-DEBUG: display: A.0: fb_set_size(2880x1800)
[471.772351] (kms_vrr:8884) igt_kms-DEBUG: display: commit {
[471.772352] (kms_vrr:8884) igt_kms-DEBUG: display:     populating plane data: A.0, fb 433
[471.772352] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_X" to 0x0/0
[471.772353] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_Y" to 0x0/0
[471.772354] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_W" to 0xb400000/188743680
[471.772354] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_H" to 0x7080000/117964800
[471.772355] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_W" to 0xb40/2880
[471.772355] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_H" to 0x708/1800
[471.772356] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "FB_ID" to 0x1b1/433
[471.772356] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_ID" to 0x97/151
[471.772356] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_ENCODING" to 0x0/0
[471.772357] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_RANGE" to 0x0/0
[471.780230] (kms_vrr:8884) igt_kms-DEBUG: display: }
[471.780232] (kms_vrr:8884) igt_kms-DEBUG: display: commit {
[471.780233] (kms_vrr:8884) igt_kms-DEBUG: display:     populating plane data: A.0, fb 433
[471.780235] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_X" to 0x0/0
[471.780236] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_Y" to 0x0/0
[471.780236] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_W" to 0xb400000/188743680
[471.780237] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_H" to 0x7080000/117964800
[471.780237] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_W" to 0xb40/2880
[471.780238] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_H" to 0x708/1800
[471.780238] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "FB_ID" to 0x1b1/433
[471.780238] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_ID" to 0x97/151
[471.780239] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_ENCODING" to 0x0/0
[471.780240] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_RANGE" to 0x0/0
[471.785474] (kms_vrr:8884) igt_kms-DEBUG: display: }
[471.785475] (kms_vrr:8884) igt_kms-DEBUG: display: commit {
[471.785475] (kms_vrr:8884) igt_kms-DEBUG: display:     populating plane data: A.0, fb 433
[471.785476] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_X" to 0x0/0
[471.785477] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_Y" to 0x0/0
[471.785477] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_W" to 0xb400000/188743680
[471.785478] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_H" to 0x7080000/117964800
[471.785478] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_W" to 0xb40/2880
[471.785478] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_H" to 0x708/1800
[471.785479] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "FB_ID" to 0x1b1/433
[471.785479] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_ID" to 0x97/151
[471.785480] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_ENCODING" to 0x0/0
[471.785480] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_RANGE" to 0x0/0
[471.788386] (kms_vrr:8884) igt_kms-DEBUG: display: }
[471.788396] (kms_vrr:8884) DEBUG: event_ns - last_event_ns: 16664000 (60.01 Hz)
[471.788398] (kms_vrr:8884) igt_kms-DEBUG: display: A.0: plane_set_fb(432)
[471.788398] (kms_vrr:8884) igt_kms-DEBUG: display: A.0: plane_set_size (2880x1800)
[471.788399] (kms_vrr:8884) igt_kms-DEBUG: display: A.0: fb_set_position(0,0)
[471.788400] (kms_vrr:8884) igt_kms-DEBUG: display: A.0: fb_set_size(2880x1800)
[471.788400] (kms_vrr:8884) igt_kms-DEBUG: display: commit {
[471.788401] (kms_vrr:8884) igt_kms-DEBUG: display:     populating plane data: A.0, fb 432
[471.788401] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_X" to 0x0/0
[471.788402] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_Y" to 0x0/0
[471.788402] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_W" to 0xb400000/188743680
[471.788403] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_H" to 0x7080000/117964800
[471.788403] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_W" to 0xb40/2880
[471.788404] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_H" to 0x708/1800
[471.788404] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "FB_ID" to 0x1b0/432
[471.788404] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_ID" to 0x97/151
[471.788405] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_ENCODING" to 0x0/0
[471.788405] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_RANGE" to 0x0/0
[471.796272] (kms_vrr:8884) igt_kms-DEBUG: display: }
[471.796274] (kms_vrr:8884) igt_kms-DEBUG: display: commit {
[471.796275] (kms_vrr:8884) igt_kms-DEBUG: display:     populating plane data: A.0, fb 432
[471.796276] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_X" to 0x0/0
[471.796278] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_Y" to 0x0/0
[471.796278] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_W" to 0xb400000/188743680
[471.796278] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_H" to 0x7080000/117964800
[471.796279] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_W" to 0xb40/2880
[471.796280] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_H" to 0x708/1800
[471.796280] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "FB_ID" to 0x1b0/432
[471.796280] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_ID" to 0x97/151
[471.796281] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_ENCODING" to 0x0/0
[471.796281] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_RANGE" to 0x0/0
[471.801533] (kms_vrr:8884) igt_kms-DEBUG: display: }
[471.801534] (kms_vrr:8884) igt_kms-DEBUG: display: commit {
[471.801534] (kms_vrr:8884) igt_kms-DEBUG: display:     populating plane data: A.0, fb 432
[471.801535] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_X" to 0x0/0
[471.801536] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_Y" to 0x0/0
[471.801536] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_W" to 0xb400000/188743680
[471.801537] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_H" to 0x7080000/117964800
[471.801537] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_W" to 0xb40/2880
[471.801538] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_H" to 0x708/1800
[471.801538] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "FB_ID" to 0x1b0/432
[471.801538] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_ID" to 0x97/151
[471.801539] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_ENCODING" to 0x0/0
[471.801539] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_RANGE" to 0x0/0
[471.804546] (kms_vrr:8884) igt_kms-DEBUG: display: }
[471.804557] (kms_vrr:8884) DEBUG: event_ns - last_event_ns: 16668000 (60.00 Hz)
[471.804829] (kms_vrr:8884) igt_kms-DEBUG: display: A.0: plane_set_fb(433)
[471.804830] (kms_vrr:8884) igt_kms-DEBUG: display: A.0: plane_set_size (2880x1800)
[471.804831] (kms_vrr:8884) igt_kms-DEBUG: display: A.0: fb_set_position(0,0)
[471.804831] (kms_vrr:8884) igt_kms-DEBUG: display: A.0: fb_set_size(2880x1800)
[471.804832] (kms_vrr:8884) igt_kms-DEBUG: display: commit {
[471.804832] (kms_vrr:8884) igt_kms-DEBUG: display:     populating plane data: A.0, fb 433
[471.804833] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_X" to 0x0/0
[471.804834] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_Y" to 0x0/0
[471.804834] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_W" to 0xb400000/188743680
[471.804834] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_H" to 0x7080000/117964800
[471.804835] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_W" to 0xb40/2880
[471.804835] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_H" to 0x708/1800
[471.804836] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "FB_ID" to 0x1b1/433
[471.804836] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_ID" to 0x97/151
[471.804837] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_ENCODING" to 0x0/0
[471.804837] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_RANGE" to 0x0/0
[471.812736] (kms_vrr:8884) igt_kms-DEBUG: display: }
[471.812738] (kms_vrr:8884) igt_kms-DEBUG: display: commit {
[471.812739] (kms_vrr:8884) igt_kms-DEBUG: display:     populating plane data: A.0, fb 433
[471.812741] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_X" to 0x0/0
[471.812742] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_Y" to 0x0/0
[471.812742] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_W" to 0xb400000/188743680
[471.812743] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "SRC_H" to 0x7080000/117964800
[471.812743] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_W" to 0xb40/2880
[471.812744] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_H" to 0x708/1800
[471.812744] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "FB_ID" to 0x1b1/433
[471.812745] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Setting property "CRTC_ID" to 0x97/151
[471.812745] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_ENCODING" to 0x0/0
[471.812745] (kms_vrr:8884) igt_kms-DEBUG: plane A.0: Ignoring property "COLOR_RANGE" to 0x0/0
[471.815402] (kms_vrr:8884) igt_kms-DEBUG: display: }
[471.815411] (kms_vrr:8884) DEBUG: event_ns - last_event_ns: 8331000 (120.03 Hz)
[471.815412] (kms_vrr:8884) INFO: Completed 319 flips, 37 were in threshold for [(120 Hz) 8333333ns]
[471.815472] (kms_vrr:8884) CRITICAL: Test assertion failure function test_seamless_virtual_rr_basic, file ../tests/kms_vrr.c:776:
[471.815478] (kms_vrr:8884) CRITICAL: Failed assertion: result > 75
[471.815485] (kms_vrr:8884) CRITICAL: Refresh rate (120 Hz) 8333333ns: Target threshold not reached, result was 11%
[471.833149] (kms_vrr:8884) igt_core-INFO: Stack trace:
[471.840181] (kms_vrr:8884) igt_core-INFO:   #0 ../lib/igt_core.c:2074 __igt_fail_assert()
[471.840434] (kms_vrr:8884) igt_core-INFO:   #1 ../tests/kms_vrr.c:773 test_seamless_virtual_rr_basic()
[471.840451] (kms_vrr:8884) igt_core-INFO:   #2 ../tests/kms_vrr.c:998 run_vrr_test.constprop.0()
[471.840464] (kms_vrr:8884) igt_core-INFO:   #3 ../tests/kms_vrr.c:1105 __igt_unique____real_main1046()
[471.840474] (kms_vrr:8884) igt_core-INFO:   #4 ../tests/kms_vrr.c:1046 main()
[471.842519] (kms_vrr:8884) igt_core-INFO:   #5 [__libc_init_first+0x8a]
[471.842980] (kms_vrr:8884) igt_core-INFO:   #6 [__libc_start_main+0x8b]
[471.843092] (kms_vrr:8884) igt_core-INFO:   #7 [_start+0x25]
****  END  ****
Dynamic subtest pipe-A-eDP-1: FAIL (6.257s)
Subtest seamless-rr-switch-virtual: FAIL (6.563s)
Dmesg
<6> [482.233827] Console: switching to colour dummy device 80x25
<6> [482.234157] [IGT] kms_vrr: executing
<7> [482.241595] xe 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:402:DP-1]
<7> [482.241604] xe 0000:00:02.0: [drm:intel_dp_detect [xe]] [CONNECTOR:402:DP-1]
<7> [482.241756] xe 0000:00:02.0: [drm:intel_tc_port_reset_mode [xe]] Port D/TC#1: TC port mode reset (disconnected -> tbt-alt) pin assignment: - max lanes: 4
<7> [482.241851] xe 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:402:DP-1] disconnected
<7> [482.242079] xe 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:414:DP-2]
<7> [482.242082] xe 0000:00:02.0: [drm:intel_dp_detect [xe]] [CONNECTOR:414:DP-2]
<7> [482.242247] xe 0000:00:02.0: [drm:intel_tc_port_reset_mode [xe]] Port E/TC#2: TC port mode reset (disconnected -> tbt-alt) pin assignment: - max lanes: 4
<7> [482.242342] xe 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:414:DP-2] disconnected
<7> [482.242556] xe 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:422:DP-3]
<7> [482.242559] xe 0000:00:02.0: [drm:intel_dp_detect [xe]] [CONNECTOR:422:DP-3]
<7> [482.242672] xe 0000:00:02.0: [drm:intel_tc_port_reset_mode [xe]] Port F/TC#3: TC port mode reset (disconnected -> tbt-alt) pin assignment: - max lanes: 4
<7> [482.242757] xe 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:422:DP-3] disconnected
<7> [482.242957] xe 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:393:eDP-1]
<7> [482.242959] xe 0000:00:02.0: [drm:intel_dp_detect [xe]] [CONNECTOR:393:eDP-1]
<7> [482.243405] xe 0000:00:02.0: [drm:intel_dp_read_dsc_dpcd [xe]] DSC DPCD: 00 11 00 76 0b 01 01 80 00 01 06 66 08 00 00 00
<7> [482.243711] xe 0000:00:02.0: [drm:intel_dp_print_rates [xe]] source rates: 162000, 216000, 243000, 270000, 324000, 432000, 540000, 675000, 810000
<7> [482.243812] xe 0000:00:02.0: [drm:intel_dp_print_rates [xe]] sink rates: 162000, 216000, 243000, 270000, 324000, 432000, 540000, 810000
<7> [482.243923] xe 0000:00:02.0: [drm:intel_dp_print_rates [xe]] common rates: 162000, 216000, 243000, 270000, 324000, 432000, 540000, 810000
<7> [482.244075] xe 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:393:eDP-1] Supported Monitor Refresh rate range is 40 Hz - 120 Hz
<5> [482.244082] [drm] DisplayID checksum invalid, remainder is 248 (ignoring)
<5> [482.244084] [drm] DisplayID checksum invalid, remainder is 248 (ignoring)
<7> [482.244086] xe 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:393:eDP-1] DisplayID extension version 0x13, primary use 0x00
<7> [482.244090] xe 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:393:eDP-1] Assigning EDID-1.4 digital sink color depth as 10 bpc.
<5> [482.244093] [drm] DisplayID checksum invalid, remainder is 248 (ignoring)
<7> [482.244095] xe 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:393:eDP-1] ELD monitor
<5> [482.244099] [drm] DisplayID checksum invalid, remainder is 248 (ignoring)
<7> [482.244101] xe 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:393:eDP-1] ELD size 20, SAD count 0
<5> [482.244104] [drm] DisplayID checksum invalid, remainder is 248 (ignoring)
<7> [482.244125] xe 0000:00:02.0: [drm:intel_dp_set_edid [xe]] [CONNECTOR:393:eDP-1] VRR capable: yes
<7> [482.244247] xe 0000:00:02.0: [drm:intel_dp_set_edid [xe]] [CONNECTOR:393:eDP-1] DFP max bpc 0, max dotclock 0, TMDS clock 0-0, PCON Max FRL BW 0Gbps
<7> [482.244366] xe 0000:00:02.0: [drm:intel_dp_set_edid [xe]] [CONNECTOR:393:eDP-1] RGB->YcbCr conversion? no, YCbCr 4:2:0 allowed? yes, YCbCr 4:4:4->4:2:0 conversion? no
<5> [482.244723] [drm] DisplayID checksum invalid, remainder is 248 (ignoring)
<5> [482.244726] [drm] DisplayID checksum invalid, remainder is 248 (ignoring)
<5> [482.244729] [drm] DisplayID checksum invalid, remainder is 248 (ignoring)
<7> [482.244786] xe 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:393:eDP-1] probed modes:
<7> [482.244791] xe 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "2880x1800": 60 347710 2880 2928 2960 3040 1800 1803 1809 1906 0x48 0xa
<7> [482.244796] xe 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "2880x1800": 120 695310 2880 2928 2960 3040 1800 1803 1809 1906 0x40 0xa
<7> [482.244812] xe 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:402:DP-1]
<7> [482.244818] xe 0000:00:02.0: [drm:intel_dp_detect [xe]] [CONNECTOR:402:DP-1]
<7> [482.244971] xe 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:402:DP-1] disconnected
<7> [482.244983] xe 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:414:DP-2]
<7> [482.244987] xe 0000:00:02.0: [drm:intel_dp_detect [xe]] [CONNECTOR:414:DP-2]
<7> [482.245098] xe 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:414:DP-2] disconnected
<7> [482.245105] xe 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:422:DP-3]
<7> [482.245107] xe 0000:00:02.0: [drm:intel_dp_detect [xe]] [CONNECTOR:422:DP-3]
<7> [482.245233] xe 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:422:DP-3] disconnected
<6> [482.245640] [IGT] kms_vrr: starting subtest seamless-rr-switch-virtual
<6> [482.246505] [IGT] kms_vrr: starting dynamic subtest pipe-A-eDP-1
<7> [482.251364] xe 0000:00:02.0: [drm:drm_mode_addfb2] [FB:432]
<7> [482.278974] xe 0000:00:02.0: [drm:drm_mode_addfb2] [FB:433]
<7> [482.331414] xe 0000:00:02.0: [drm:compute_baseline_pipe_bpp [xe]] [CONNECTOR:393:eDP-1] Limiting target display pipe bpp to 30 (EDID bpp 30, max requested bpp 36, max platform bpp 36)
<7> [482.331565] xe 0000:00:02.0: [drm:intel_dp_compute_config_limits [xe]] [ENCODER:392:DDI A/PHY A][CRTC:151:pipe A] DP link limits: pixel clock 695310 kHz DSC off max lanes 4 max rate 810000 max pipe_bpp 30 min link_bpp 18.0000 max link_bpp 30.0000
<7> [482.331664] xe 0000:00:02.0: [drm:intel_dp_compute_output_format [xe]] DP lane count 4 clock 810000 bpp input 30 compressed 0.0000 HDR no link rate required 2607413 available 3240000
<7> [482.331769] xe 0000:00:02.0: [drm:intel_atomic_check [xe]] [CRTC:151:pipe A] hw max bpp: 30, pipe bpp: 30, dithering: 0
<7> [482.331863] xe 0000:00:02.0: [drm:intel_ddi_compute_config_late [xe]] [ENCODER:392:DDI A/PHY A] [CRTC:151:pipe A]
<7> [482.331958] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in dp_m_n (expected tu 64 data 6329869/8388608 link 421991/524288, found tu 64, data 6750791/8388608 link 450052/524288)
<7> [482.332053] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in dpll_hw_state
<7> [482.332156] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] expected:
<7> [482.332244] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] cx0pll_hw_state: lane_count: 4, ssc_enabled: no, use_c10: yes, tbt_mode: no
<7> [482.332341] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] c10pll_hw_state: fracen: no,
<7> [482.332435] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] multiplier: 225, tx_clk_div: 1.
<7> [482.332525] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] c10pll_rawhw_state:
<7> [482.332614] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] tx: 0x10, cmn: 0x21
<7> [482.332704] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[0] = 0x4, pll[1] = 0x0, pll[2] = 0xa2, pll[3] = 0x1
<7> [482.332792] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[4] = 0x0, pll[5] = 0x0, pll[6] = 0x0, pll[7] = 0x0
<7> [482.332877] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[8] = 0x0, pll[9] = 0x1, pll[10] = 0x0, pll[11] = 0x0
<7> [482.332964] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[12] = 0x0, pll[13] = 0x0, pll[14] = 0x0, pll[15] = 0x1
<7> [482.333050] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[16] = 0x85, pll[17] = 0xf, pll[18] = 0xe6, pll[19] = 0x23
<7> [482.333143] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] found:
<7> [482.333230] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] cx0pll_hw_state: lane_count: 4, ssc_enabled: no, use_c10: yes, tbt_mode: no
<7> [482.333335] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] c10pll_hw_state: fracen: yes,
<7> [482.333441] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] quot: 61440, rem: 0, den: 1,
<7> [482.333543] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] multiplier: 210, tx_clk_div: 0.
<7> [482.333633] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] c10pll_rawhw_state:
<7> [482.333721] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] tx: 0x10, cmn: 0x21
<7> [482.333809] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[0] = 0x34, pll[1] = 0x0, pll[2] = 0x84, pll[3] = 0x1
<7> [482.333897] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[4] = 0x0, pll[5] = 0x0, pll[6] = 0x0, pll[7] = 0x0
<7> [482.333985] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[8] = 0x0, pll[9] = 0x1, pll[10] = 0x0, pll[11] = 0x0
<7> [482.334076] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[12] = 0xf0, pll[13] = 0x0, pll[14] = 0x0, pll[15] = 0x0
<7> [482.334183] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[16] = 0x84, pll[17] = 0xf, pll[18] = 0xe5, pll[19] = 0x23
<7> [482.334294] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 347710, found 695309)
<7> [482.334402] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 347710, found 695309)
<7> [482.334493] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in port_clock (expected 432000, found 810000)
<7> [482.334575] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in min_voltage_level (expected 0, found 1)
<7> [482.334656] xe 0000:00:02.0: [drm:intel_atomic_check [xe]] [CRTC:151:pipe A] fastset requirement not met, forcing full modeset
<7> [482.334737] xe 0000:00:02.0: [drm:intel_dpll_crtc_put [xe]] [CRTC:151:pipe A] releasing DPLL 0
<7> [482.334847] xe 0000:00:02.0: [drm:skl_print_plane_ddb_changes [xe]] [PLANE:35:plane 1A] ddb ( 0 - 4051) -> ( 0 - 4011), size 4051 -> 4011
<7> [482.334910] xe 0000:00:02.0: [drm:skl_print_plane_ddb_changes [xe]] [PLANE:145:cursor A] ddb (4051 - 4096) -> (4011 - 4096), size 45 -> 85
<7> [482.334975] xe 0000:00:02.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:35:plane 1A] level *wm0,*wm1,*wm2,*wm3,*wm4,*wm5, wm6, wm7,*twm,*swm,*stwm -> *wm0,*wm1,*wm2,*wm3,*wm4,*wm5, wm6, wm7,*twm,*swm,*stwm
<7> [482.335040] xe 0000:00:02.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:35:plane 1A] lines 1, 13, 13, 13, 13, 13, 0, 0, 0, 3, 0 -> 2, 25, 25, 25, 25, 25, 0, 0, 0, 5, 0
<7> [482.335103] xe 0000:00:02.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:35:plane 1A] blocks 24, 313, 313, 313, 313, 313, 0, 0, 38, 73, 87 -> 49, 601, 601, 601, 601, 601, 0, 0, 63, 121, 135
<7> [482.335184] xe 0000:00:02.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:35:plane 1A] min_ddb 28, 346, 346, 346, 346, 346, 0, 0, 39, 82, 88 -> 55, 663, 663, 663, 663, 663, 0, 0, 64, 135, 136
<7> [482.335278] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] [CRTC:151:pipe A] data rate 2781236 num active planes 1
<7> [482.335406] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 0: max bw 23530 required 2921 qgv_peak_bw: 38400
<7> [482.335506] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 1: max bw 36260 required 2921 qgv_peak_bw: 38400
<7> [482.335600] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 2: max bw 38000 required 2921 qgv_peak_bw: 38400
<7> [482.335693] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 3: max bw 38000 required 2921 qgv_peak_bw: 38400
<7> [482.335778] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] Matching peaks QGV bw: 38400 for required data rate: 2921
<7> [482.335879] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] [CRTC:151:pipe A] min cdclk: 173855 kHz -> 347655 kHz
<7> [482.335964] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] [CRTC:151:pipe A] min voltage level: 0 -> 1
<7> [482.336062] xe 0000:00:02.0: [drm:intel_cdclk_update_dbuf_bw_min_cdclk [xe]] dbuf bandwidth min cdclk: 21732 kHz -> 43457 kHz
<7> [482.336148] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] Can change cdclk via crawling and squashing
<7> [482.336251] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] New cdclk calculated to be logical 360000 kHz, actual 360000 kHz
<7> [482.336356] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] New voltage level calculated to be logical 1, actual 1
<7> [482.336472] xe 0000:00:02.0: [drm:intel_find_dpll [xe]] [CRTC:151:pipe A] allocated DPLL 0
<7> [482.336561] xe 0000:00:02.0: [drm:intel_dpll_crtc_get [xe]] [CRTC:151:pipe A] reserving DPLL 0
<7> [482.336653] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [CRTC:151:pipe A] enable: yes [modeset]
<7> [482.336746] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] active: yes, output_types: EDP (0x100), output format: RGB, sink format: RGB
<7> [482.336837] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] cpu_transcoder: A, pipe bpp: 30, dithering: 0
<7> [482.336926] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] MST master transcoder: <invalid>
<7> [482.337016] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] port sync: master transcoder: <invalid>, slave transcoder bitmask = 0x0
<7> [482.337106] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] joiner: no, pipes: 0x0
<7> [482.337207] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] splitter: disabled, link count 0, overlap 0
<7> [482.337313] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] dp m_n: lanes: 4; data_m: 6750791, data_n: 8388608, link_m: 450052, link_n: 524288, tu: 64
<7> [482.337418] xe 0000:00:02.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> [482.337508] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] fec: disabled, enhanced framing: disabled
<7> [482.337596] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] sdp split: disabled
<7> [482.337684] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] psr: enabled, selective update: enabled, panel replay: disabled, selective fetch: enabled
<7> [482.337783] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] minimum hblank: 0
<7> [482.337886] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] audio: 0, infoframes: 0, infoframes enabled: 0x4
<7> [482.337989] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] DP SDP: VSC, revision 4, length 14
<7> [482.338092] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pixelformat: RGB
<7> [482.338324] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] colorimetry: sRGB
<7> [482.338450] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] bpc: 0
<7> [482.338557] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] dynamic range: VESA range
<7> [482.338646] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] content type: Not defined
<7> [482.338733] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] scanline offset: 1
<7> [482.338819] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] framestart delay: 1, MSA timing delay: 0, set context latency: 0
<7> [482.338906] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] vrr: no, fixed rr: yes, vmin: 1906, vmax: 1906, flipline: 1906, pipeline full: 0, guardband: 104 vsync start: 103, vsync end: 97
<7> [482.338991] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] vrr: vmin vblank: 1802, vmax vblank: 1802, vmin vtotal: 1906, vmax vtotal: 1906
<7> [482.339076] xe 0000:00:02.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> [482.339224] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] requested mode: "2880x1800": 120 695310 2880 2928 2960 3040 1800 1803 1809 1906 0x40 0xa
<7> [482.339334] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] adjusted mode: "2880x1800": 120 695310 2880 2928 2960 3040 1800 1803 1809 1906 0x40 0xa
<7> [482.339435] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] crtc timings: clock=695309, hd=2880 hb=2880-3040 hs=2928-2960 ht=3040, vd=1800 vb=1800-1906 vs=1803-1809 vt=1906, flags=0xa
<7> [482.339521] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe mode: "2880x1800": 120 695309 2880 2928 2960 3040 1800 1803 1809 1906 0x40 0xa
<7> [482.339604] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] crtc timings: clock=695309, hd=2880 hb=2880-3040 hs=2928-2960 ht=3040, vd=1800 vb=1800-1906 vs=1803-1809 vt=1906, flags=0xa
<7> [482.339688] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] port clock: 810000, pixel rate 695309, min cdclk 347655, min voltage level 1
<7> [482.339771] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] linetime: 35, ips linetime: 0
<7> [482.339855] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] num_scalers: 2, scaler_users: 0x0, scaler_id: -1, scaling_filter: 0, sharpness_strength: 0
<7> [482.339937] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe src: 2880x1800+0+0
<7> [482.340019] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pch pfit: 0x0+0+0, disabled, force thru: no
<7> [482.340096] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] sharpness strength: 0, sharpness tap size: 0, sharpness enable: 0
<7> [482.340186] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] ips: 0, double wide: 0, drrs: 0
<7> [482.340284] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] cx0pll_hw_state: lane_count: 4, ssc_enabled: no, use_c10: yes, tbt_mode: no
<7> [482.340382] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] c10pll_hw_state: fracen: yes,
<7> [482.340480] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] quot: 61440, rem: 0, den: 1,
<7> [482.340558] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] multiplier: 210, tx_clk_div: 0.
<7> [482.340640] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] c10pll_rawhw_state:
<7> [482.340732] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] tx: 0x10, cmn: 0x21
<7> [482.340830] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pll[0] = 0x34, pll[1] = 0x0, pll[2] = 0x84, pll[3] = 0x1
<7> [482.340925] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pll[4] = 0x0, pll[5] = 0x0, pll[6] = 0x0, pll[7] = 0x0
<7> [482.341007] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pll[8] = 0x0, pll[9] = 0x1, pll[10] = 0x0, pll[11] = 0x0
<7> [482.341091] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pll[12] = 0xf0, pll[13] = 0x0, pll[14] = 0x0, pll[15] = 0x0
<7> [482.341197] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pll[16] = 0x84, pll[17] = 0xf, pll[18] = 0xe5, pll[19] = 0x23
<7> [482.341300] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] csc_mode: 0x0 gamma_mode: 0x0 gamma_enable: 0 csc_enable: 0
<7> [482.341403] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pre csc lut: 0 entries, post csc lut: 0 entries
<7> [482.341503] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] output csc: pre offsets: 0x0000 0x0000 0x0000
<7> [482.341582] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [482.341661] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [482.341738] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [482.341817] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] output csc: post offsets: 0x0000 0x0000 0x0000
<7> [482.341895] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe csc: pre offsets: 0x0000 0x0000 0x0000
<7> [482.341972] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [482.342058] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [482.342143] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [482.342242] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe csc: post offsets: 0x0000 0x0000 0x0000
<7> [482.342338] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:35:plane 1A] fb: [FB:432] 2880x1800 format = XR24 little-endian (0x34325258) modifier = 0x0, visible: yes
<7> [482.342438] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] rotation: 0x1, scaler: -1, scaling_filter: 0
<7> [482.342530] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] src: 2880.000000x1800.000000+0.000000+0.000000 dst: 2880x1800+0+0
<7> [482.342611] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:65:plane 2A] fb: [NOFB], visible: no
<7> [482.342694] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:95:plane 3A] fb: [NOFB], visible: no
<7> [482.342778] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:125:plane 4A] fb: [NOFB], visible: no
<7> [482.342860] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:135:plane 5A] fb: [NOFB], visible: no
<7> [482.342942] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:145:cursor A] fb: [NOFB], visible: no
<7> [482.345423] xe 0000:00:02.0: [drm:intel_power_well_enable [xe]] enabling DC_off
<7> [482.346143] xe 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [xe]] Setting DC state from 02 to 00
<7> [482.346304] xe 0000:00:02.0: [drm:intel_psr_disable_locked [xe]] Disabling PSR2
<7> [482.347012] xe 0000:00:02.0: [drm:intel_alpm_disable [xe]] Disabling ALPM
<7> [482.347128] xe 0000:00:02.0: [drm:intel_edp_backlight_off [xe]]
<7> [482.553391] xe 0000:00:02.0: [drm:intel_backlight_set_pwm_level [xe]] [CONNECTOR:393:eDP-1] set backlight PWM = 0
<7> [482.553855] xe 0000:00:02.0: [drm:intel_disable_transcoder [xe]] disabling pipe A
<7> [482.563585] xe 0000:00:02.0: [drm:intel_pps_off_unlocked [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 turn panel power off
<7> [482.563947] xe 0000:00:02.0: [drm:intel_pps_off_unlocked [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 wait for panel power off time
<7> [482.564324] xe 0000:00:02.0: [drm:wait_panel_status [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 mask: 0xb0000000 value: 0x00000000 PP_STATUS: 0xa0000002 PP_CONTROL: 0x00000060
<7> [482.616571] xe 0000:00:02.0: [drm:icp_irq_handler [xe]] hotplug event received, stat 0x00010000, dig 0x00000009, pins 0x00000010, long 0x00000000
<7> [482.617237] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] digital hpd on [ENCODER:392:DDI A/PHY A] - short
<7> [482.624976] xe 0000:00:02.0: [drm:wait_panel_status [xe]] Wait complete
<7> [482.625471] xe 0000:00:02.0: [drm:intel_dpll_disable [xe]] disable DPLL 0 (active 0x1, on? 1) for [CRTC:151:pipe A]
<7> [482.625606] xe 0000:00:02.0: [drm:intel_dp_hpd_pulse [xe]] ignoring short hpd on eDP [ENCODER:392:DDI A/PHY A]
<7> [482.626977] xe 0000:00:02.0: [drm:intel_dpll_disable [xe]] disabling DPLL 0
<7> [482.627508] xe 0000:00:02.0: [drm:intel_power_well_disable [xe]] disabling AUX_A
<7> [482.628020] xe 0000:00:02.0: [drm:intel_pmdemand_program_params [xe]] initiate pmdemand request values: (0x1801071 0x16832a72)
<7> [482.628428] xe 0000:00:02.0: [drm:intel_set_cdclk [xe]] Pre changing CDCLK to 360000 kHz, VCO 960000 kHz, ref 38400 kHz, bypass 19200 kHz, voltage level 1
<7> [482.628891] xe 0000:00:02.0: [drm:intel_dbuf_mdclk_cdclk_ratio_update [xe]] Updating dbuf ratio to 6 (mbus joined: yes)
<7> [482.629209] xe 0000:00:02.0: [drm:intel_audio_cdclk_change_post.part.0 [xe]] aud_ts_cdclk set to M=60, N=900
<7> [482.629593] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:392:DDI A/PHY A]
<7> [482.629895] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:401:DDI TC1/PHY TC1]
<7> [482.630207] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:403:DP-MST A]
<7> [482.630483] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:404:DP-MST B]
<7> [482.630755] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:405:DP-MST C]
<7> [482.631063] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:413:DDI TC2/PHY TC2]
<7> [482.631343] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:415:DP-MST A]
<7> [482.631587] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:416:DP-MST B]
<7> [482.631828] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:417:DP-MST C]
<7> [482.632083] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:421:DDI TC3/PHY TC3]
<7> [482.632386] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:423:DP-MST A]
<7> [482.632654] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:424:DP-MST B]
<7> [482.632903] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:425:DP-MST C]
<7> [482.633247] xe 0000:00:02.0: [drm:verify_connector_state [xe]] [CONNECTOR:402:DP-1]
<7> [482.633495] xe 0000:00:02.0: [drm:verify_connector_state [xe]] [CONNECTOR:414:DP-2]
<7> [482.633731] xe 0000:00:02.0: [drm:verify_connector_state [xe]] [CONNECTOR:422:DP-3]
<7> [482.634032] xe 0000:00:02.0: [drm:intel_power_well_enable [xe]] enabling AUX_A
<7> [482.635309] xe 0000:00:02.0: [drm:intel_dpll_enable [xe]] enable DPLL 0 (active 0x1, on? 0) for [CRTC:151:pipe A]
<7> [482.635648] xe 0000:00:02.0: [drm:intel_dpll_enable [xe]] enabling DPLL 0
<7> [482.637998] xe 0000:00:02.0: [drm:intel_pps_on_unlocked [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 turn panel power on
<7> [482.638362] xe 0000:00:02.0: [drm:wait_panel_power_cycle [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 wait for panel power cycle (488 ms remaining)
<7> [482.655883] xe 0000:00:02.0: [drm:icp_irq_handler [xe]] hotplug event received, stat 0x00010000, dig 0x0000000a, pins 0x00000010, long 0x00000010
<7> [482.656393] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] digital hpd on [ENCODER:392:DDI A/PHY A] - long
<7> [482.656829] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] Received HPD interrupt on PIN 4 - cnt: 10
<7> [482.657270] xe 0000:00:02.0: [drm:intel_dp_hpd_pulse [xe]] ignoring long hpd on eDP [ENCODER:392:DDI A/PHY A]
<7> [483.129516] xe 0000:00:02.0: [drm:wait_panel_status [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 mask: 0xb800000f value: 0x00000000 PP_STATUS: 0x08000001 PP_CONTROL: 0x00000060
<7> [483.211047] xe 0000:00:02.0: [drm:wait_panel_status [xe]] Wait complete
<7> [483.211465] xe 0000:00:02.0: [drm:intel_pps_on_unlocked [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 wait for panel power on
<7> [483.211749] xe 0000:00:02.0: [drm:wait_panel_status [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 mask: 0xb000000f value: 0x80000008 PP_STATUS: 0x9000000a PP_CONTROL: 0x00000063
<7> [483.248462] xe 0000:00:02.0: [drm:icp_irq_handler [xe]] hotplug event received, stat 0x00010000, dig 0x0000000a, pins 0x00000010, long 0x00000010
<7> [483.249058] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] digital hpd on [ENCODER:392:DDI A/PHY A] - long
<7> [483.249520] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] Received HPD interrupt on PIN 4 - cnt: 20
<7> [483.250119] xe 0000:00:02.0: [drm:intel_dp_hpd_pulse [xe]] ignoring long hpd on eDP [ENCODER:392:DDI A/PHY A]
<7> [483.273385] xe 0000:00:02.0: [drm:intel_tc_port_reset_mode [xe]] Port F/TC#3: TC port mode reset (tbt-alt -> disconnected) pin assignment: - max lanes: 4
<7> [483.273517] xe 0000:00:02.0: [drm:intel_tc_port_reset_mode [xe]] Port E/TC#2: TC port mode reset (tbt-alt -> disconnected) pin assignment: - max lanes: 4
<7> [483.273646] xe 0000:00:02.0: [drm:intel_tc_port_reset_mode [xe]] Port D/TC#1: TC port mode reset (tbt-alt -> disconnected) pin assignment: - max lanes: 4
<7> [483.425121] xe 0000:00:02.0: [drm:wait_panel_status [xe]] Wait complete
<7> [483.425672] xe 0000:00:02.0: [drm:intel_pps_vdd_on_unlocked [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 turning VDD on
<7> [483.426073] xe 0000:00:02.0: [drm:intel_pps_vdd_on_unlocked [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 PP_STATUS: 0x80000008 PP_CONTROL: 0x0000006b
<7> [483.428355] xe 0000:00:02.0: [drm:drm_dp_read_dpcd_caps [drm_display_helper]] AUX A/DDI A/PHY A: DPCD: 14 1e 44 c1 00 00 01 c0 02 00 02 00 00 0b 80
<7> [483.429871] xe 0000:00:02.0: [drm:intel_dp_start_link_train [xe]] [CONNECTOR:393:eDP-1][ENCODER:392:DDI A/PHY A][DPRX] Reloading eDP link rates
<7> [483.430647] xe 0000:00:02.0: [drm:intel_dp_start_link_train [xe]] [CONNECTOR:393:eDP-1][ENCODER:392:DDI A/PHY A][DPRX] Using LINK_RATE_SET value 07
<7> [483.431822] xe 0000:00:02.0: [drm:intel_dp_set_signal_levels [xe]] [CONNECTOR:393:eDP-1][ENCODER:392:DDI A/PHY A][DPRX] 8b/10b, lanes: 4, vswing levels: 0/0/0/0, pre-emphasis levels: 0/0/0/0
<7> [483.433160] xe 0000:00:02.0: [drm:intel_dp_program_link_training_pattern [xe]] [CONNECTOR:393:eDP-1][ENCODER:392:DDI A/PHY A][DPRX] Using DP training pattern TPS1
<7> [483.434279] xe 0000:00:02.0: [drm:intel_dp_link_train_phy [xe]] [CONNECTOR:393:eDP-1][ENCODER:392:DDI A/PHY A][DPRX] Clock recovery OK
<7> [483.434713] xe 0000:00:02.0: [drm:intel_dp_program_link_training_pattern [xe]] [CONNECTOR:393:eDP-1][ENCODER:392:DDI A/PHY A][DPRX] Using DP training pattern TPS4
<7> [483.436360] xe 0000:00:02.0: [drm:intel_dp_link_train_phy [xe]] [CONNECTOR:393:eDP-1][ENCODER:392:DDI A/PHY A][DPRX] Channel EQ done. DP Training successful
<7> [483.436732] xe 0000:00:02.0: [drm:intel_dp_link_train_phy [xe]] [CONNECTOR:393:eDP-1][ENCODER:392:DDI A/PHY A][DPRX] Link Training passed at link rate = 810000, lane count = 4
<7> [483.437490] xe 0000:00:02.0: [drm:intel_enable_transcoder [xe]] enabling pipe A
<7> [483.437946] xe 0000:00:02.0: [drm:intel_edp_backlight_on [xe]]
<7> [483.438310] xe 0000:00:02.0: [drm:intel_backlight_enable [xe]] pipe A
<7> [483.438809] xe 0000:00:02.0: [drm:intel_backlight_set_pwm_level [xe]] [CONNECTOR:393:eDP-1] set backlight PWM = 4518
<7> [483.454796] xe 0000:00:02.0: [drm:intel_psr_post_plane_update [xe]] Enabling PSR2
<7> [483.456462] xe 0000:00:02.0: [drm:verify_connector_state [xe]] [CONNECTOR:393:eDP-1]
<7> [483.456892] xe 0000:00:02.0: [drm:intel_modeset_verify_crtc [xe]] [CRTC:151:pipe A]
<7> [483.460934] xe 0000:00:02.0: [drm:i915_fifo_underrun_reset_write [xe]] Re-arming FIFO underruns on pipe A
<7> [485.962754] xe 0000:00:02.0: [drm:intel_pps_vdd_off_sync_unlocked [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 turning VDD off
<7> [485.962964] xe 0000:00:02.0: [drm:intel_pps_vdd_off_sync_unlocked [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 PP_STATUS: 0x80000008 PP_CONTROL: 0x00000067
<7> [488.497176] xe 0000:00:02.0: [drm:intel_power_well_disable [xe]] disabling DC_off
<7> [488.497382] xe 0000:00:02.0: [drm:skl_enable_dc6 [xe]] Enabling DC6
<7> [488.497489] xe 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [xe]] Setting DC state from 00 to 02
<6> [488.504254] [IGT] kms_vrr: finished subtest pipe-A-eDP-1, FAIL
<7> [488.504579] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.enable (expected yes, found no)
<7> [488.504691] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.active (expected yes, found no)
<7> [488.504792] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in cpu_transcoder (expected 0, found -1)
<7> [488.504890] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in lane_count (expected 4, found 0)
<7> [488.505001] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in dp_m_n (expected tu 64 data 6750791/8388608 link 450052/524288, found tu 0, data 0/0 link 0/0)
<7> [488.505100] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in output_types (expected 0x00000100, found 0x00000000)
<7> [488.505193] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in framestart_delay (expected 1, found 0)
<7> [488.505284] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 2880, found 0)
<7> [488.505375] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 3040, found 0)
<7> [488.505465] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 2880, found 0)
<7> [488.505554] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 3040, found 0)
<7> [488.505641] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 2928, found 0)
<7> [488.505728] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 2960, found 0)
<7> [488.505816] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 1800, found 0)
<7> [488.505907] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 1800, found 0)
<7> [488.506005] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 1803, found 0)
<7> [488.506097] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 1809, found 0)
<7> [488.506185] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 1906, found 0)
<7> [488.506271] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 1906, found 0)
<7> [488.506355] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 2880, found 0)
<7> [488.506438] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 3040, found 0)
<7> [488.506519] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 2880, found 0)
<7> [488.506601] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 3040, found 0)
<7> [488.506682] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 2928, found 0)
<7> [488.506762] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 2960, found 0)
<7> [488.506843] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 1800, found 0)
<7> [488.506922] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 1800, found 0)
<7> [488.507010] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 1803, found 0)
<7> [488.507103] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 1809, found 0)
<7> [488.507187] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 1906, found 0)
<7> [488.507265] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 1906, found 0)
<7> [488.507343] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in pixel_multiplier (expected 1, found 0)
<7> [488.507421] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (2) (expected 2, found 0)
<7> [488.507498] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (8) (expected 8, found 0)
<7> [488.507576] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in pipe_bpp (expected 30, found 0)
<7> [488.507653] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 695309, found 0)
<7> [488.507729] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 695309, found 0)
<7> [488.507803] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in port_clock (expected 810000, found 0)
<7> [488.507879] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in min_voltage_level (expected 1, found 0)
<7> [488.507959] xe 0000:00:02.0: [drm:intel_atomic_check [xe]] [CRTC:151:pipe A] fastset requirement not met, forcing full modeset
<7> [488.508034] xe 0000:00:02.0: [drm:intel_dpll_crtc_put [xe]] [CRTC:151:pipe A] releasing DPLL 0
<7> [488.508162] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] Enabled dbuf slices 0xf -> 0x1 (total dbuf slices 0xf), mbus joined? yes->no
<7> [488.508233] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] [CRTC:151:pipe A] dbuf slices 0xf -> 0x0, ddb (0 - 4096) -> (0 - 0), active pipes 0x1 -> 0x0
<7> [488.508351] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.enable (expected yes, found no)
<7> [488.508449] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.active (expected yes, found no)
<7> [488.508533] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in cpu_transcoder (expected 0, found -1)
<7> [488.508615] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in lane_count (expected 4, found 0)
<7> [488.508697] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in dp_m_n (expected tu 64 data 6750791/8388608 link 450052/524288, found tu 0, data 0/0 link 0/0)
<7> [488.508778] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in output_types (expected 0x00000100, found 0x00000000)
<7> [488.508858] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in framestart_delay (expected 1, found 0)
<7> [488.508938] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 2880, found 0)
<7> [488.509048] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 3040, found 0)
<7> [488.509144] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 2880, found 0)
<7> [488.509224] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 3040, found 0)
<7> [488.509303] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 2928, found 0)
<7> [488.509381] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 2960, found 0)
<7> [488.509459] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 1800, found 0)
<7> [488.509536] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 1800, found 0)
<7> [488.509614] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 1803, found 0)
<7> [488.509691] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 1809, found 0)
<7> [488.509767] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 1906, found 0)
<7> [488.509843] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 1906, found 0)
<7> [488.509919] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 2880, found 0)
<7> [488.510018] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 3040, found 0)
<7> [488.510113] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 2880, found 0)
<7> [488.510198] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 3040, found 0)
<7> [488.510277] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 2928, found 0)
<7> [488.510355] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 2960, found 0)
<7> [488.510434] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 1800, found 0)
<7> [488.510512] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 1800, found 0)
<7> [488.510590] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 1803, found 0)
<7> [488.510666] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 1809, found 0)
<7> [488.510743] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 1906, found 0)
<7> [488.510819] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 1906, found 0)
<7> [488.510894] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in pixel_multiplier (expected 1, found 0)
<7> [488.510972] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (2) (expected 2, found 0)
<7> [488.511048] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (8) (expected 8, found 0)
<7> [488.511137] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in pipe_bpp (expected 30, found 0)
<7> [488.511216] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 695309, found 0)
<7> [488.511290] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 695309, found 0)
<7> [488.511365] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in port_clock (expected 810000, found 0)
<7> [488.511439] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in min_voltage_level (expected 1, found 0)
<7> [488.511514] xe 0000:00:02.0: [drm:intel_atomic_check [xe]] [CRTC:151:pipe A] fastset requirement not met, forcing full modeset
<7> [488.511588] xe 0000:00:02.0: [drm:intel_dpll_crtc_put [xe]] [CRTC:151:pipe A] releasing DPLL 0
<7> [488.511711] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.enable (expected yes, found no)
<7> [488.511805] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.active (expected yes, found no)
<7> [488.511896] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in cpu_transcoder (expected 0, found -1)
<7> [488.511990] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in lane_count (expected 4, found 0)
<7> [488.512073] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in dp_m_n (expected tu 64 data 6750791/8388608 link 450052/524288, found tu 0, data 0/0 link 0/0)
<7> [488.512157] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in output_types (expected 0x00000100, found 0x00000000)
<7> [488.512236] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in framestart_delay (expected 1, found 0)
<7> [488.512313] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 2880, found 0)
<7> [488.512389] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 3040, found 0)
<7> [488.512464] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 2880, found 0)
<7> [488.512539] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 3040, found 0)
<7> [488.512615] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 2928, found 0)
<7> [488.512690] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 2960, found 0)
<7> [488.512762] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 1800, found 0)
<7> [488.512836] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 1800, found 0)
<7> [488.512910] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 1803, found 0)
<7> [488.513125] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 1809, found 0)
<7> [488.513209] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 1906, found 0)
<7> [488.513288] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 1906, found 0)
<7> [488.513367] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 2880, found 0)
<7> [488.513444] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 3040, found 0)
<7> [488.513521] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 2880, found 0)
<7> [488.513597] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 3040, found 0)
<7> [488.513672] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 2928, found 0)
<7> [488.513747] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 2960, found 0)
<7> [488.513823] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 1800, found 0)
<7> [488.513898] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 1800, found 0)
<7> [488.514234] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 1803, found 0)
<7> [488.514308] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 1809, found 0)
<7> [488.514383] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 1906, found 0)
<7> [488.514457] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 1906, found 0)
<7> [488.514531] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in pixel_multiplier (expected 1, found 0)
<7> [488.514605] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (2) (expected 2, found 0)
<7> [488.514679] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (8) (expected 8, found 0)
<7> [488.514752] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in pipe_bpp (expected 30, found 0)
<7> [488.514826] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 695309, found 0)
<7> [488.514900] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 695309, found 0)
<7> [488.514977] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in port_clock (expected 810000, found 0)
<7> [488.515049] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in min_voltage_level (expected 1, found 0)
<7> [488.515126] xe 0000:00:02.0: [drm:intel_atomic_check [xe]] [CRTC:151:pipe A] fastset requirement not met, forcing full modeset
<7> [488.515205] xe 0000:00:02.0: [drm:intel_dpll_crtc_put [xe]] [CRTC:151:pipe A] releasing DPLL 0
<7> [488.515296] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] Enabled dbuf slices 0xf -> 0x1 (total dbuf slices 0xf), mbus joined? yes->no
<7> [488.515357] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] [CRTC:151:pipe A] dbuf slices 0xf -> 0x0, ddb (0 - 4096) -> (0 - 0), active pipes 0x1 -> 0x0
<7> [488.515439] xe 0000:00:02.0: [drm:skl_print_plane_ddb_changes [xe]] [PLANE:35:plane 1A] ddb ( 0 - 4011) -> ( 0 - 0), size 4011 -> 0
<7> [488.515503] xe 0000:00:02.0: [drm:skl_print_plane_ddb_changes [xe]] [PLANE:145:cursor A] ddb (4011 - 4096) -> ( 0 - 0), size 85 -> 0
<7> [488.515568] xe 0000:00:02.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:35:plane 1A] level *wm0,*wm1,*wm2,*wm3,*wm4,*wm5, wm6, wm7,*twm,*swm,*stwm -> wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm
<7> [488.515631] xe 0000:00:02.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:35:plane 1A] lines 2, 25, 25, 25, 25, 25, 0, 0, 0, 5, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [488.515695] xe 0000:00:02.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:35:plane 1A] blocks 49, 601, 601, 601, 601, 601, 0, 0, 63, 121, 135 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [488.515752] xe 0000:00:02.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:35:plane 1A] min_ddb 55, 663, 663, 663, 663, 663, 0, 0, 64, 135, 136 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [488.515834] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] [CRTC:151:pipe A] data rate 0 num active planes 0
<7> [488.515922] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 0: max bw 23530 required 0 qgv_peak_bw: 38400
<7> [488.516017] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 1: max bw 36260 required 0 qgv_peak_bw: 38400
<7> [488.516107] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 2: max bw 38000 required 0 qgv_peak_bw: 38400
<7> [488.516196] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 3: max bw 38000 required 0 qgv_peak_bw: 38400
<7> [488.516280] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] Matching peaks QGV bw: 38400 for required data rate: 0
<7> [488.516364] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] [CRTC:151:pipe A] min cdclk: 347655 kHz -> 0 kHz
<7> [488.516448] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] [CRTC:151:pipe A] min voltage level: 1 -> 0
<7> [488.516556] xe 0000:00:02.0: [drm:intel_cdclk_update_dbuf_bw_min_cdclk [xe]] dbuf bandwidth min cdclk: 43457 kHz -> 0 kHz
<7> [488.516641] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] Can change cdclk via crawling and squashing
<7> [488.516723] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] New cdclk calculated to be logical 153600 kHz, actual 153600 kHz
<7> [488.516808] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] New voltage level calculated to be logical 0, actual 0
<7> [488.516923] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [CRTC:151:pipe A] enable: no [modeset]
<7> [488.517026] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:35:plane 1A] fb: [NOFB], visible: no
<7> [488.517113] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:65:plane 2A] fb: [NOFB], visible: no
<7> [488.517202] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:95:plane 3A] fb: [NOFB], visible: no
<7> [488.517285] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:125:plane 4A] fb: [NOFB], visible: no
<7> [488.517367] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:135:plane 5A] fb: [NOFB], visible: no
<7> [488.517448] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:145:cursor A] fb: [NOFB], visible: no
<7> [488.517588] xe 0000:00:02.0: [drm:intel_power_well_enable [xe]] enabling DC_off
<7> [488.517678] xe 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [xe]] Setting DC state from 02 to 00
<7> [488.517813] xe 0000:00:02.0: [drm:intel_psr_disable_locked [xe]] Disabling PSR2
<7> [488.522085] xe 0000:00:02.0: [drm:intel_pps_vdd_on_unlocked [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 turning VDD on
<7> [488.522216] xe 0000:00:02.0: [drm:intel_pps_vdd_on_unlocked [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 PP_STATUS: 0x80000008 PP_CONTROL: 0x0000006f
<7> [488.522808] xe 0000:00:02.0: [drm:intel_alpm_disable [xe]] Disabling ALPM
<7> [488.522911] xe 0000:00:02.0: [drm:intel_edp_backlight_off [xe]]
<7> [488.730181] xe 0000:00:02.0: [drm:intel_backlight_set_pwm_level [xe]] [CONNECTOR:393:eDP-1] set backlight PWM = 0
<7> [488.730805] xe 0000:00:02.0: [drm:intel_disable_transcoder [xe]] disabling pipe A
<7> [488.738387] xe 0000:00:02.0: [drm:intel_pps_off_unlocked [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 turn panel power off
<7> [488.738822] xe 0000:00:02.0: [drm:intel_pps_off_unlocked [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 wait for panel power off time
<7> [488.739284] xe 0000:00:02.0: [drm:wait_panel_status [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 mask: 0xb0000000 value: 0x00000000 PP_STATUS: 0xa0000002 PP_CONTROL: 0x00000060
<7> [488.790422] xe 0000:00:02.0: [drm:wait_panel_status [xe]] Wait complete
<7> [488.791186] xe 0000:00:02.0: [drm:intel_dpll_disable [xe]] disable DPLL 0 (active 0x1, on? 1) for [CRTC:151:pipe A]
<7> [488.791495] xe 0000:00:02.0: [drm:icp_irq_handler [xe]] hotplug event received, stat 0x00010000, dig 0x00000009, pins 0x00000010, long 0x00000000
<7> [488.792276] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] digital hpd on [ENCODER:392:DDI A/PHY A] - short
<7> [488.793047] xe 0000:00:02.0: [drm:intel_dpll_disable [xe]] disabling DPLL 0
<7> [488.793149] xe 0000:00:02.0: [drm:intel_dp_hpd_pulse [xe]] ignoring short hpd on eDP [ENCODER:392:DDI A/PHY A]
<7> [488.793828] xe 0000:00:02.0: [drm:intel_power_well_disable [xe]] disabling AUX_A
<7> [488.794623] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:392:DDI A/PHY A]
<7> [488.795226] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:401:DDI TC1/PHY TC1]
<7> [488.795743] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:403:DP-MST A]
<7> [488.796244] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:404:DP-MST B]
<7> [488.796697] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:405:DP-MST C]
<7> [488.797158] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:413:DDI TC2/PHY TC2]
<7> [488.797610] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:415:DP-MST A]
<7> [488.798095] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:416:DP-MST B]
<7> [488.798534] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:417:DP-MST C]
<7> [488.799010] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:421:DDI TC3/PHY TC3]
<7> [488.799391] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:423:DP-MST A]
<7> [488.799769] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:424:DP-MST B]
<7> [488.800173] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:425:DP-MST C]
<7> [488.800510] xe 0000:00:02.0: [drm:verify_connector_state [xe]] [CONNECTOR:393:eDP-1]
<7> [488.800965] xe 0000:00:02.0: [drm:intel_dbuf_mdclk_cdclk_ratio_update [xe]] Updating dbuf ratio to 3 (mbus joined: no)
<7> [488.801383] xe 0000:00:02.0: [drm:intel_dbuf_mbus_join_update [xe]] Changing mbus joined: yes -> no (pipe: *)
<7> [488.801696] xe 0000:00:02.0: [drm:gen9_dbuf_slices_update [xe]] Updating dbuf slices to 0x1
<7> [488.802321] xe 0000:00:02.0: [drm:intel_power_well_disable [xe]] disabling PW_A
<7> [488.802839] xe 0000:00:02.0: [drm:dss_pipe_gating_enable_disable [xe]] DSS clock gating disabled for pipe_mask=0x1 (CLKGATE_DIS_DSSDSC=0xaa000000)
<7> [488.803456] xe 0000:00:02.0: [drm:intel_modeset_verify_crtc [xe]] [CRTC:151:pipe A]
<7> [488.803847] xe 0000:00:02.0: [drm:intel_set_cdclk [xe]] Post changing CDCLK to 153600 kHz, VCO 614400 kHz, ref 38400 kHz, bypass 19200 kHz, voltage level 0
<7> [488.804395] xe 0000:00:02.0: [drm:intel_dbuf_mdclk_cdclk_ratio_update [xe]] Updating dbuf ratio to 4 (mbus joined: no)
<7> [488.804805] xe 0000:00:02.0: [drm:intel_audio_cdclk_change_post.part.0 [xe]] aud_ts_cdclk set to M=60, N=384
<7> [488.806190] xe 0000:00:02.0: [drm:drm_mode_rmfb_work_fn] Removing [FB:433] from all active usage due to RMFB ioctl
<6> [488.809708] [IGT] kms_vrr: finished subtest seamless-rr-switch-virtual, FAIL
<7> [488.810715] xe 0000:00:02.0: [drm:compute_baseline_pipe_bpp [xe]] [CONNECTOR:393:eDP-1] Limiting target display pipe bpp to 30 (EDID bpp 30, max requested bpp 36, max platform bpp 36)
<7> [488.811014] xe 0000:00:02.0: [drm:intel_dp_compute_config_limits [xe]] [ENCODER:392:DDI A/PHY A][CRTC:151:pipe A] DP link limits: pixel clock 347710 kHz DSC off max lanes 4 max rate 810000 max pipe_bpp 30 min link_bpp 18.0000 max link_bpp 30.0000
<7> [488.811264] xe 0000:00:02.0: [drm:intel_dp_compute_output_format [xe]] DP lane count 4 clock 432000 bpp input 30 compressed 0.0000 HDR no link rate required 1303913 available 1728000
<7> [488.811517] xe 0000:00:02.0: [drm:intel_atomic_check [xe]] [CRTC:151:pipe A] hw max bpp: 30, pipe bpp: 30, dithering: 0
<7> [488.811754] xe 0000:00:02.0: [drm:intel_ddi_compute_config_late [xe]] [ENCODER:392:DDI A/PHY A] [CRTC:151:pipe A]
<7> [488.812035] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.enable (expected no, found yes)
<7> [488.812259] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.active (expected no, found yes)
<7> [488.812468] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in cpu_transcoder (expected -1, found 0)
<7> [488.812665] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in lane_count (expected 0, found 4)
<7> [488.812858] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in dp_m_n (expected tu 0 data 0/0 link 0/0, found tu 64, data 6329869/8388608 link 421991/524288)
<7> [488.813058] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in output_types (expected 0x00000000, found 0x00000100)
<7> [488.813245] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in framestart_delay (expected 0, found 1)
<7> [488.813415] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 0, found 2880)
<7> [488.813582] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 0, found 3040)
<7> [488.813740] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 0, found 2880)
<7> [488.813892] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 0, found 3040)
<7> [488.814052] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 0, found 2928)
<7> [488.814205] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 0, found 2960)
<7> [488.814351] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 0, found 1800)
<7> [488.814492] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 0, found 1800)
<7> [488.814626] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 0, found 1803)
<7> [488.814756] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 0, found 1809)
<7> [488.814880] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 0, found 1906)
<7> [488.815009] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 0, found 1906)
<7> [488.815131] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 0, found 2880)
<7> [488.815248] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 0, found 3040)
<7> [488.815359] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 0, found 2880)
<7> [488.815469] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 0, found 3040)
<7> [488.815575] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 0, found 2928)
<7> [488.815692] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 0, found 2960)
<7> [488.815809] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 0, found 1800)
<7> [488.815919] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 0, found 1800)
<7> [488.816050] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 0, found 1803)
<7> [488.816156] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 0, found 1809)
<7> [488.816258] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 0, found 1906)
<7> [488.816352] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 0, found 1906)
<7> [488.816441] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in pixel_multiplier (expected 0, found 1)
<7> [488.816528] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (2) (expected 0, found 2)
<7> [488.816616] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (8) (expected 0, found 8)
<7> [488.816702] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in dpll_hw_state
<7> [488.816784] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] expected:
<7> [488.816863] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] cx0pll_hw_state: lane_count: 4, ssc_enabled: no, use_c10: yes, tbt_mode: no
<7> [488.816943] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] c10pll_hw_state: fracen: yes,
<7> [488.817218] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] quot: 61440, rem: 0, den: 1,
<7> [488.817327] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] multiplier: 210, tx_clk_div: 0.
<7> [488.817409] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] c10pll_rawhw_state:
<7> [488.817490] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] tx: 0x10, cmn: 0x21
<7> [488.817570] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[0] = 0x34, pll[1] = 0x0, pll[2] = 0x84, pll[3] = 0x1
<7> [488.817651] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[4] = 0x0, pll[5] = 0x0, pll[6] = 0x0, pll[7] = 0x0
<7> [488.817731] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[8] = 0x0, pll[9] = 0x1, pll[10] = 0x0, pll[11] = 0x0
<7> [488.817810] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[12] = 0xf0, pll[13] = 0x0, pll[14] = 0x0, pll[15] = 0x0
<7> [488.817889] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[16] = 0x84, pll[17] = 0xf, pll[18] = 0xe5, pll[19] = 0x23
<7> [488.817967] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] found:
<7> [488.818072] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] cx0pll_hw_state: lane_count: 4, ssc_enabled: no, use_c10: yes, tbt_mode: no
<7> [488.818174] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] c10pll_hw_state: fracen: no,
<7> [488.818274] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] multiplier: 225, tx_clk_div: 1.
<7> [488.818361] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] c10pll_rawhw_state:
<7> [488.818438] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] tx: 0x10, cmn: 0x21
<7> [488.818514] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[0] = 0x4, pll[1] = 0x0, pll[2] = 0xa2, pll[3] = 0x1
<7> [488.818590] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[4] = 0x0, pll[5] = 0x0, pll[6] = 0x0, pll[7] = 0x0
<7> [488.818665] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[8] = 0x0, pll[9] = 0x1, pll[10] = 0x0, pll[11] = 0x0
<7> [488.818740] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[12] = 0x0, pll[13] = 0x0, pll[14] = 0x0, pll[15] = 0x1
<7> [488.818816] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] pll[16] = 0x85, pll[17] = 0xf, pll[18] = 0xe6, pll[19] = 0x23
<7> [488.818892] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in pipe_bpp (expected 0, found 30)
<7> [488.818969] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 0, found 347710)
<7> [488.819074] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 0, found 347710)
<7> [488.819174] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:151:pipe A] fastset requirement not met in port_clock (expected 0, found 432000)
<7> [488.819274] xe 0000:00:02.0: [drm:intel_atomic_check [xe]] [CRTC:151:pipe A] fastset requirement not met, forcing full modeset
<7> [488.819415] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] Enabled dbuf slices 0x1 -> 0xf (total dbuf slices 0xf), mbus joined? no->yes
<7> [488.819489] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] [CRTC:151:pipe A] dbuf slices 0x0 -> 0xf, ddb (0 - 0) -> (0 - 4096), active pipes 0x0 -> 0x1
<7> [488.819563] xe 0000:00:02.0: [drm:skl_print_plane_ddb_changes [xe]] [PLANE:35:plane 1A] ddb ( 0 - 0) -> ( 0 - 4051), size 0 -> 4051
<7> [488.819636] xe 0000:00:02.0: [drm:skl_print_plane_ddb_changes [xe]] [PLANE:145:cursor A] ddb ( 0 - 0) -> (4051 - 4096), size 0 -> 45
<7> [488.819705] xe 0000:00:02.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:35:plane 1A] level wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm -> *wm0,*wm1,*wm2,*wm3,*wm4,*wm5, wm6, wm7,*twm,*swm,*stwm
<7> [488.819765] xe 0000:00:02.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:35:plane 1A] lines 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 1, 13, 13, 13, 13, 13, 0, 0, 0, 3, 0
<7> [488.819823] xe 0000:00:02.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:35:plane 1A] blocks 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 24, 313, 313, 313, 313, 313, 0, 0, 38, 73, 87
<7> [488.819880] xe 0000:00:02.0: [drm:skl_print_plane_wm_changes [xe]] [PLANE:35:plane 1A] min_ddb 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 28, 346, 346, 346, 346, 346, 0, 0, 39, 82, 88
<7> [488.819958] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] [CRTC:151:pipe A] data rate 1390840 num active planes 1
<7> [488.820085] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 0: max bw 23530 required 1461 qgv_peak_bw: 38400
<7> [488.820199] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 1: max bw 36260 required 1461 qgv_peak_bw: 38400
<7> [488.820309] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 2: max bw 38000 required 1461 qgv_peak_bw: 38400
<7> [488.820403] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 3: max bw 38000 required 1461 qgv_peak_bw: 38400
<7> [488.820489] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] Matching peaks QGV bw: 38400 for required data rate: 1461
<7> [488.820574] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] [CRTC:151:pipe A] min cdclk: 0 kHz -> 173855 kHz
<7> [488.820677] xe 0000:00:02.0: [drm:intel_cdclk_update_dbuf_bw_min_cdclk [xe]] dbuf bandwidth min cdclk: 0 kHz -> 21732 kHz
<7> [488.820765] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] Can change cdclk via squashing
<7> [488.820848] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] New cdclk calculated to be logical 192000 kHz, actual 192000 kHz
<7> [488.820931] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] New voltage level calculated to be logical 0, actual 0
<7> [488.821043] xe 0000:00:02.0: [drm:intel_find_dpll [xe]] [CRTC:151:pipe A] allocated DPLL 0
<7> [488.821164] xe 0000:00:02.0: [drm:intel_dpll_crtc_get [xe]] [CRTC:151:pipe A] reserving DPLL 0
<7> [488.821278] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [CRTC:151:pipe A] enable: yes [modeset]
<7> [488.821375] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] active: yes, output_types: EDP (0x100), output format: RGB, sink format: RGB
<7> [488.821462] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] cpu_transcoder: A, pipe bpp: 30, dithering: 0
<7> [488.821547] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] MST master transcoder: <invalid>
<7> [488.821631] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] port sync: master transcoder: <invalid>, slave transcoder bitmask = 0x0
<7> [488.821715] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] joiner: no, pipes: 0x0
<7> [488.821797] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] splitter: disabled, link count 0, overlap 0
<7> [488.821880] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] dp m_n: lanes: 4; data_m: 6329869, data_n: 8388608, link_m: 421991, link_n: 524288, tu: 64
<7> [488.821963] xe 0000:00:02.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> [488.822073] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] fec: disabled, enhanced framing: disabled
<7> [488.822180] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] sdp split: disabled
<7> [488.822283] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] psr: enabled, selective update: enabled, panel replay: disabled, selective fetch: enabled
<7> [488.822364] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] minimum hblank: 0
<7> [488.822443] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] audio: 0, infoframes: 0, infoframes enabled: 0x4
<7> [488.822522] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] DP SDP: VSC, revision 4, length 14
<7> [488.822600] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pixelformat: RGB
<7> [488.822679] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] colorimetry: sRGB
<7> [488.822758] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] bpc: 0
<7> [488.822836] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] dynamic range: VESA range
<7> [488.822919] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] content type: Not defined
<7> [488.823004] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] scanline offset: 1
<7> [488.823024] xe 0000:00:02.0: [drm:intel_power_well_disable [xe]] disabling DC_off
<7> [488.823110] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] framestart delay: 1, MSA timing delay: 0, set context latency: 0
<7> [488.823184] xe 0000:00:02.0: [drm:skl_enable_dc6 [xe]] Enabling DC6
<7> [488.823215] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] vrr: no, fixed rr: yes, vmin: 1906, vmax: 1906, flipline: 1906, pipeline full: 0, guardband: 104 vsync start: 103, vsync end: 97
<7> [488.823308] xe 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [xe]] Setting DC state from 00 to 02
<7> [488.823318] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] vrr: vmin vblank: 1802, vmax vblank: 1802, vmin vtotal: 1906, vmax vtotal: 1906
<7> [488.823402] xe 0000:00:02.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> [488.823437] xe 0000:00:02.0: [drm:intel_power_well_disable [xe]] disabling always-on
<7> [488.823481] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] requested mode: "2880x1800": 60 347710 2880 2928 2960 3040 1800 1803 1809 1906 0x48 0xa
<7> [488.823562] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] adjusted mode: "2880x1800": 60 347710 2880 2928 2960 3040 1800 1803 1809 1906 0x48 0xa
<7> [488.823647] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] crtc timings: clock=347710, hd=2880 hb=2880-3040 hs=2928-2960 ht=3040, vd=1800 vb=1800-1906 vs=1803-1809 vt=1906, flags=0xa
<7> [488.823733] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe mode: "2880x1800": 60 347710 2880 2928 2960 3040 1800 1803 1809 1906 0x40 0xa
<7> [488.823833] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] crtc timings: clock=347710, hd=2880 hb=2880-3040 hs=2928-2960 ht=3040, vd=1800 vb=1800-1906 vs=1803-1809 vt=1906, flags=0xa
<7> [488.823911] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] port clock: 432000, pixel rate 347710, min cdclk 173855, min voltage level 0
<7> [488.823993] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] linetime: 70, ips linetime: 0
<7> [488.824085] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] num_scalers: 2, scaler_users: 0x0, scaler_id: -1, scaling_filter: 0, sharpness_strength: 0
<7> [488.824185] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe src: 2880x1800+0+0
<7> [488.824285] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pch pfit: 0x0+0+0, disabled, force thru: no
<7> [488.824370] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] sharpness strength: 0, sharpness tap size: 0, sharpness enable: 0
<7> [488.824446] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] ips: 0, double wide: 0, drrs: 0
<7> [488.824521] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] cx0pll_hw_state: lane_count: 4, ssc_enabled: no, use_c10: yes, tbt_mode: no
<7> [488.824597] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] c10pll_hw_state: fracen: no,
<7> [488.824673] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] multiplier: 225, tx_clk_div: 1.
<7> [488.824749] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] c10pll_rawhw_state:
<7> [488.824824] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] tx: 0x10, cmn: 0x21
<7> [488.824898] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pll[0] = 0x4, pll[1] = 0x0, pll[2] = 0xa2, pll[3] = 0x1
<7> [488.824973] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pll[4] = 0x0, pll[5] = 0x0, pll[6] = 0x0, pll[7] = 0x0
<7> [488.825192] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pll[8] = 0x0, pll[9] = 0x1, pll[10] = 0x0, pll[11] = 0x0
<7> [488.825310] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pll[12] = 0x0, pll[13] = 0x0, pll[14] = 0x0, pll[15] = 0x1
<7> [488.825411] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pll[16] = 0x85, pll[17] = 0xf, pll[18] = 0xe6, pll[19] = 0x23
<7> [488.825493] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] csc_mode: 0x0 gamma_mode: 0x0 gamma_enable: 0 csc_enable: 0
<7> [488.825572] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pre csc lut: 0 entries, post csc lut: 0 entries
<7> [488.825651] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] output csc: pre offsets: 0x0000 0x0000 0x0000
<7> [488.825728] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [488.825804] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [488.825879] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [488.825957] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] output csc: post offsets: 0x0000 0x0000 0x0000
<7> [488.826052] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe csc: pre offsets: 0x0000 0x0000 0x0000
<7> [488.826153] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [488.826252] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [488.826341] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [488.826419] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe csc: post offsets: 0x0000 0x0000 0x0000
<7> [488.826495] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:35:plane 1A] fb: [FB:394] 2880x1800 format = XR24 little-endian (0x34325258) modifier = 0x0, visible: yes
<7> [488.826573] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] rotation: 0x1, scaler: -1, scaling_filter: 0
<7> [488.826651] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] src: 2880.000000x1800.000000+0.000000+0.000000 dst: 2880x1800+0+0
<7> [488.826732] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:65:plane 2A] fb: [NOFB], visible: no
<7> [488.826815] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:95:plane 3A] fb: [NOFB], visible: no
<7> [488.826898] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:125:plane 4A] fb: [NOFB], visible: no
<7> [488.826979] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:135:plane 5A] fb: [NOFB], visible: no
<7> [488.827099] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:145:cursor A] fb: [NOFB], visible: no
<7> [488.827326] xe 0000:00:02.0: [drm:intel_power_well_enable [xe]] enabling always-on
<7> [488.827421] xe 0000:00:02.0: [drm:intel_power_well_enable [xe]] enabling DC_off
<7> [488.827659] xe 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [xe]] Setting DC state from 02 to 00
<7> [488.827799] xe 0000:00:02.0: [drm:intel_power_well_enable [xe]] enabling PW_A
<7> [488.827950] xe 0000:00:02.0: [drm:dss_pipe_gating_enable_disable [xe]] DSS clock gating enabled for pipe_mask=0x1 (CLKGATE_DIS_DSSDSC=0xa8000000)
<7> [488.828080] xe 0000:00:02.0: [drm:intel_pmdemand_program_params [xe]] initiate pmdemand request values: (0x1800071 0xc01b072)
<7> [488.828219] xe 0000:00:02.0: [drm:intel_set_cdclk [xe]] Pre changing CDCLK to 192000 kHz, VCO 614400 kHz, ref 38400 kHz, bypass 19200 kHz, voltage level 0
<7> [488.828343] xe 0000:00:02.0: [drm:intel_dbuf_mdclk_cdclk_ratio_update [xe]] Updating dbuf ratio to 4 (mbus joined: no)
<7> [488.828432] xe 0000:00:02.0: [drm:intel_audio_cdclk_change_post.part.0 [xe]] aud_ts_cdclk set to M=60, N=480
<7> [488.828519] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:392:DDI A/PHY A]
<7> [488.828592] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:401:DDI TC1/PHY TC1]
<7> [488.828664] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:403:DP-MST A]
<7> [488.828735] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:404:DP-MST B]
<7> [488.828805] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:405:DP-MST C]
<7> [488.828872] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:413:DDI TC2/PHY TC2]
<7> [488.828938] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:415:DP-MST A]
<7> [488.829015] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:416:DP-MST B]
<7> [488.829100] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:417:DP-MST C]
<7> [488.829186] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:421:DDI TC3/PHY TC3]
<7> [488.829272] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:423:DP-MST A]
<7> [488.829362] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:424:DP-MST B]
<7> [488.829441] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:425:DP-MST C]
<7> [488.829542] xe 0000:00:02.0: [drm:gen9_dbuf_slices_update [xe]] Updating dbuf slices to 0xf
<7> [488.829712] xe 0000:00:02.0: [drm:intel_dbuf_mbus_join_update [xe]] Changing mbus joined: no -> yes (pipe: *)
<7> [488.829778] xe 0000:00:02.0: [drm:intel_dbuf_mdclk_cdclk_ratio_update [xe]] Updating dbuf ratio to 8 (mbus joined: yes)
<7> [488.829887] xe 0000:00:02.0: [drm:intel_power_well_enable [xe]] enabling AUX_A
<7> [488.830417] xe 0000:00:02.0: [drm:icp_irq_handler [xe]] hotplug event received, stat 0x00010000, dig 0x0000000a, pins 0x00000010, long 0x00000010
<7> [488.830564] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] digital hpd on [ENCODER:392:DDI A/PHY A] - long
<7> [488.830665] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] Received HPD interrupt on PIN 4 - cnt: 10
<7> [488.830796] xe 0000:00:02.0: [drm:intel_dp_hpd_pulse [xe]] ignoring long hpd on eDP [ENCODER:392:DDI A/PHY A]
<7> [488.831014] xe 0000:00:02.0: [drm:intel_dpll_enable [xe]] enable DPLL 0 (active 0x1, on? 0) for [CRTC:151:pipe A]
<7> [488.831132] xe 0000:00:02.0: [drm:intel_dpll_enable [xe]] enabling DPLL 0
<7> [488.833100] xe 0000:00:02.0: [drm:intel_pps_on_unlocked [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 turn panel power on
<7> [488.833202] xe 0000:00:02.0: [drm:wait_panel_power_cycle [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 wait for panel power cycle (458 ms remaining)
<7> [489.298278] xe 0000:00:02.0: [drm:wait_panel_status [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 mask: 0xb800000f value: 0x00000000 PP_STATUS: 0x08000001 PP_CONTROL: 0x00000060
<7> [489.399292] xe 0000:00:02.0: [drm:wait_panel_status [xe]] Wait complete
<7> [489.399805] xe 0000:00:02.0: [drm:intel_pps_on_unlocked [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 wait for panel power on
<7> [489.400323] xe 0000:00:02.0: [drm:wait_panel_status [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 mask: 0xb000000f value: 0x80000008 PP_STATUS: 0x9000000a PP_CONTROL: 0x00000063
<7> [489.436640] xe 0000:00:02.0: [drm:icp_irq_handler [xe]] hotplug event received, stat 0x00010000, dig 0x0000000a, pins 0x00000010, long 0x00000010
<7> [489.437228] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] digital hpd on [ENCODER:392:DDI A/PHY A] - long
<7> [489.437750] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] Received HPD interrupt on PIN 4 - cnt: 20
<7> [489.438499] xe 0000:00:02.0: [drm:intel_dp_hpd_pulse [xe]] ignoring long hpd on eDP [ENCODER:392:DDI A/PHY A]
<7> [489.610288] xe 0000:00:02.0: [drm:wait_panel_status [xe]] Wait complete
<7> [489.610697] xe 0000:00:02.0: [drm:intel_pps_vdd_on_unlocked [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 turning VDD on
<7> [489.611032] xe 0000:00:02.0: [drm:intel_pps_vdd_on_unlocked [xe]] [ENCODER:392:DDI A/PHY A] PPS 0 PP_STATUS: 0x80000008 PP_CONTROL: 0x0000006b
<7> [489.613262] xe 0000:00:02.0: [drm:drm_dp_read_dpcd_caps [drm_display_helper]] AUX A/DDI A/PHY A: DPCD: 14 1e 44 c1 00 00 01 c0 02 00 02 00 00 0b 80
<7> [489.614791] xe 0000:00:02.0: [drm:intel_dp_start_link_train [xe]] [CONNECTOR:393:eDP-1][ENCODER:392:DDI A/PHY A][DPRX] Reloading eDP link rates
<7> [489.615608] xe 0000:00:02.0: [drm:intel_dp_start_link_train [xe]] [CONNECTOR:393:eDP-1][ENCODER:392:DDI A/PHY A][DPRX] Using LINK_RATE_SET value 05
<7> [489.616749] xe 0000:00:02.0: [drm:intel_dp_set_signal_levels [xe]] [CONNECTOR:393:eDP-1][ENCODER:392:DDI A/PHY A][DPRX] 8b/10b, lanes: 4, vswing levels: 0/0/0/0, pre-emphasis levels: 0/0/0/0
<7> [489.618162] xe 0000:00:02.0: [drm:intel_dp_program_link_training_pattern [xe]] [CONNECTOR:393:eDP-1][ENCODER:392:DDI A/PHY A][DPRX] Using DP training pattern TPS1
<7> [489.619268] xe 0000:00:02.0: [drm:intel_dp_link_train_phy [xe]] [CONNECTOR:393:eDP-1][ENCODER:392:DDI A/PHY A][DPRX] Clock recovery OK
<7> [489.619622] xe 0000:00:02.0: [drm:intel_dp_program_link_training_pattern [xe]] [CONNECTOR:393:eDP-1][ENCODER:392:DDI A/PHY A][DPRX] Using DP training pattern TPS4
<7> [489.621088] xe 0000:00:02.0: [drm:intel_dp_link_train_phy [xe]] [CONNECTOR:393:eDP-1][ENCODER:392:DDI A/PHY A][DPRX] Channel EQ done. DP Training successful
<7> [489.621426] xe 0000:00:02.0: [drm:intel_dp_link_train_phy [xe]] [CONNECTOR:393:eDP-1][ENCODER:392:DDI A/PHY A][DPRX] Link Training passed at link rate = 432000, lane count = 4
<7> [489.622201] xe 0000:00:02.0: [drm:intel_enable_transcoder [xe]] enabling pipe A
<7> [489.622663] xe 0000:00:02.0: [drm:intel_edp_backlight_on [xe]]
<7> [489.623000] xe 0000:00:02.0: [drm:intel_backlight_enable [xe]] pipe A
<7> [489.623433] xe 0000:00:02.0: [drm:intel_backlight_set_pwm_level [xe]] [CONNECTOR:393:eDP-1] set backlight PWM = 4518
<7> [489.656322] xe 0000:00:02.0: [drm:intel_psr_post_plane_update [xe]] Enabling PSR2
<7> [489.657980] xe 0000:00:02.0: [drm:verify_connector_state [xe]] [CONNECTOR:393:eDP-1]
<7> [489.658436] xe 0000:00:02.0: [drm:intel_modeset_verify_crtc [xe]] [CRTC:151:pipe A]
<7> [489.661523] xe 0000:00:02.0: [drm:drm_client_dev_restore] fbdev: ret=0
<6> [489.663042] [IGT] kms_vrr: exiting, ret=98
<6> [489.673629] Console: switching to colour frame buffer device 180x56
Created at 2026-05-15 13:19:00