Results for igt@kms_setmode@basic@pipe-a-edp-1

Result: Fail

i915_display_info7 igt_runner7 results7.json results7-xe-load.json guc_logs7.tar boot7 dmesg7

DetailValue
Duration 4.79 seconds
Hostname 
shard-lnl-5
Igt-Version 
IGT-Version: 2.3-gc785db0fc (x86_64) (Linux: 7.0.0-rc2-lgci-xe-xe-4655-cfc20c776480fda8c-debug+ x86_64)
Out 
Using IGT_SRANDOM=1772658374 for randomisation
Opened device: /dev/dri/card0
Starting subtest: basic
Testing: basic 1 connector combinations
Starting dynamic subtest: pipe-A-eDP-1
  Test id#1 CRTC count 1
    CRTC[150] [Pipe A] Mode: 2880x1800@60Hz Connectors: eDP-1[392]
Expected frametime: 16664us; measured 16678.7us +- 2.961us accuracy 0.00% [0.09 scanlines]
vblank interval differs from modeline! expected 16664.0us, measured 16679us +- 2.961us, difference 14.7us (5.0 sigma, 1.7 scanlines)
Timing check failed on attempt 1, retrying...
Expected frametime: 16664us; measured 16675.3us +- 3.633us accuracy 0.01% [0.11 scanlines]
vblank interval differs from modeline! expected 16664.0us, measured 16675us +- 3.633us, difference 11.3us (3.1 sigma, 1.3 scanlines)
Timing check failed on attempt 2, retrying...
Stack trace:
  #0 ../lib/igt_core.c:2075 __igt_fail_assert()
  #1 ../tests/kms_setmode.c:533 test_one_combination()
  #2 ../tests/kms_setmode.c:976 __igt_unique____real_main1031()
  #3 ../tests/kms_setmode.c:1031 main()
  #4 [__libc_init_first+0x8a]
  #5 [__libc_start_main+0x8b]
  #6 [_start+0x25]
Dynamic subtest pipe-A-eDP-1: FAIL (4.787s)
Err 
Starting subtest: basic
Starting dynamic subtest: pipe-A-eDP-1
(kms_setmode:2229) CRITICAL: Test assertion failure function test_crtc_config, file ../tests/kms_setmode.c:698:
(kms_setmode:2229) CRITICAL: Failed assertion: status
(kms_setmode:2229) CRITICAL: VBlank timing test failed after 2 attempt(s)
Dynamic subtest pipe-A-eDP-1 failed.
**** DEBUG ****
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 28: 0x000000cc
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 29: 0x000002cc
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 30: 0x000000ce
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 31: 0x000000cf
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 0: 0x0000000c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 1: 0x0000000e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 2: 0x0000000f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 3: 0x0000003c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 4: 0x00000032
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 5: 0x0000003e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 6: 0x0000041c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 7: 0x00000033
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 8: 0x00000030
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 9: 0x0000020c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 10: 0x00000230
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 11: 0x0000061c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 12: 0x0000023c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 13: 0x00000000
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 14: 0x00000200
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 15: 0x00000614
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 16: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 17: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 18: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 19: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 20: 0x0000004c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 21: 0x0000024c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 22: 0x0000004e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 23: 0x0000004f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 24: 0x0000008c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 25: 0x0000028c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 26: 0x0000008e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 27: 0x0000008f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 28: 0x000000cc
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 29: 0x000002cc
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 30: 0x000000ce
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 31: 0x000000cf
(kms_setmode:2229) intel_allocator_simple-DEBUG: <ial: 0x5f847eb5bad0, fd: 5> objects: 3, reserved_areas: 0
(kms_setmode:2229) intel_allocator_simple-DEBUG: <ial: 0x5f847eb5bad0, fd: 5> objects: 3, reserved_areas: 0
(kms_setmode:2229) intel_allocator_simple-DEBUG: Using simple allocator
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 0: 0x0000000c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 1: 0x0000000e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 2: 0x0000000f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 3: 0x0000003c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 4: 0x00000032
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 5: 0x0000003e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 6: 0x0000041c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 7: 0x00000033
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 8: 0x00000030
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 9: 0x0000020c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 10: 0x00000230
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 11: 0x0000061c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 12: 0x0000023c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 13: 0x00000000
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 14: 0x00000200
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 15: 0x00000614
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 16: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 17: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 18: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 19: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 20: 0x0000004c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 21: 0x0000024c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 22: 0x0000004e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 23: 0x0000004f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 24: 0x0000008c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 25: 0x0000028c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 26: 0x0000008e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 27: 0x0000008f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 28: 0x000000cc
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 29: 0x000002cc
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 30: 0x000000ce
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 31: 0x000000cf
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 0: 0x0000000c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 1: 0x0000000e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 2: 0x0000000f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 3: 0x0000003c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 4: 0x00000032
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 5: 0x0000003e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 6: 0x0000041c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 7: 0x00000033
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 8: 0x00000030
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 9: 0x0000020c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 10: 0x00000230
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 11: 0x0000061c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 12: 0x0000023c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 13: 0x00000000
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 14: 0x00000200
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 15: 0x00000614
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 16: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 17: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 18: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 19: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 20: 0x0000004c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 21: 0x0000024c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 22: 0x0000004e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 23: 0x0000004f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 24: 0x0000008c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 25: 0x0000028c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 26: 0x0000008e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 27: 0x0000008f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 28: 0x000000cc
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 29: 0x000002cc
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 30: 0x000000ce
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 31: 0x000000cf
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 0: 0x0000000c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 1: 0x0000000e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 2: 0x0000000f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 3: 0x0000003c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 4: 0x00000032
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 5: 0x0000003e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 6: 0x0000041c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 7: 0x00000033
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 8: 0x00000030
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 9: 0x0000020c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 10: 0x00000230
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 11: 0x0000061c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 12: 0x0000023c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 13: 0x00000000
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 14: 0x00000200
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 15: 0x00000614
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 16: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 17: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 18: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 19: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 20: 0x0000004c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 21: 0x0000024c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 22: 0x0000004e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 23: 0x0000004f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 24: 0x0000008c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 25: 0x0000028c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 26: 0x0000008e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 27: 0x0000008f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 28: 0x000000cc
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 29: 0x000002cc
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 30: 0x000000ce
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 31: 0x000000cf
(kms_setmode:2229) intel_allocator_simple-DEBUG: <ial: 0x5f847eb5c0a0, fd: 5> objects: 3, reserved_areas: 0
(kms_setmode:2229) intel_allocator_simple-DEBUG: <ial: 0x5f847eb5c0a0, fd: 5> objects: 3, reserved_areas: 0
(kms_setmode:2229) intel_allocator_simple-DEBUG: Using simple allocator
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 0: 0x0000000c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 1: 0x0000000e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 2: 0x0000000f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 3: 0x0000003c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 4: 0x00000032
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 5: 0x0000003e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 6: 0x0000041c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 7: 0x00000033
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 8: 0x00000030
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 9: 0x0000020c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 10: 0x00000230
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 11: 0x0000061c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 12: 0x0000023c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 13: 0x00000000
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 14: 0x00000200
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 15: 0x00000614
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 16: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 17: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 18: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 19: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 20: 0x0000004c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 21: 0x0000024c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 22: 0x0000004e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 23: 0x0000004f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 24: 0x0000008c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 25: 0x0000028c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 26: 0x0000008e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 27: 0x0000008f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 28: 0x000000cc
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 29: 0x000002cc
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 30: 0x000000ce
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 31: 0x000000cf
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 0: 0x0000000c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 1: 0x0000000e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 2: 0x0000000f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 3: 0x0000003c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 4: 0x00000032
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 5: 0x0000003e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 6: 0x0000041c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 7: 0x00000033
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 8: 0x00000030
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 9: 0x0000020c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 10: 0x00000230
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 11: 0x0000061c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 12: 0x0000023c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 13: 0x00000000
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 14: 0x00000200
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 15: 0x00000614
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 16: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 17: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 18: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 19: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 20: 0x0000004c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 21: 0x0000024c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 22: 0x0000004e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 23: 0x0000004f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 24: 0x0000008c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 25: 0x0000028c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 26: 0x0000008e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 27: 0x0000008f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 28: 0x000000cc
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 29: 0x000002cc
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 30: 0x000000ce
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 31: 0x000000cf
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 0: 0x0000000c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 1: 0x0000000e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 2: 0x0000000f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 3: 0x0000003c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 4: 0x00000032
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 5: 0x0000003e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 6: 0x0000041c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 7: 0x00000033
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 8: 0x00000030
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 9: 0x0000020c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 10: 0x00000230
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 11: 0x0000061c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 12: 0x0000023c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 13: 0x00000000
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 14: 0x00000200
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 15: 0x00000614
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 16: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 17: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 18: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 19: 0x00000000 (reserved)
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 20: 0x0000004c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 21: 0x0000024c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 22: 0x0000004e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 23: 0x0000004f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 24: 0x0000008c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 25: 0x0000028c
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 26: 0x0000008e
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 27: 0x0000008f
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 28: 0x000000cc
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 29: 0x000002cc
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 30: 0x000000ce
(kms_setmode:2229) intel_pat-DEBUG: Parsed PAT entry 31: 0x000000cf
(kms_setmode:2229) intel_allocator_simple-DEBUG: <ial: 0x5f847eb183a0, fd: 5> objects: 3, reserved_areas: 0
(kms_setmode:2229) intel_allocator_simple-DEBUG: <ial: 0x5f847eb183a0, fd: 5> objects: 3, reserved_areas: 0
(kms_setmode:2229) i915/intel_drrs-DEBUG: Manually disabling DRRS. 0
(kms_setmode:2229) i915/intel_drrs-DEBUG: Test requirement passed: dir >= 0
(kms_setmode:2229) INFO: Expected frametime: 16664us; measured 16678.7us +- 2.961us accuracy 0.00% [0.09 scanlines]
(kms_setmode:2229) INFO: vblank interval differs from modeline! expected 16664.0us, measured 16679us +- 2.961us, difference 14.7us (5.0 sigma, 1.7 scanlines)
(kms_setmode:2229) INFO: Timing check failed on attempt 1, retrying...
(kms_setmode:2229) INFO: Expected frametime: 16664us; measured 16675.3us +- 3.633us accuracy 0.01% [0.11 scanlines]
(kms_setmode:2229) INFO: vblank interval differs from modeline! expected 16664.0us, measured 16675us +- 3.633us, difference 11.3us (3.1 sigma, 1.3 scanlines)
(kms_setmode:2229) INFO: Timing check failed on attempt 2, retrying...
(kms_setmode:2229) CRITICAL: Test assertion failure function test_crtc_config, file ../tests/kms_setmode.c:698:
(kms_setmode:2229) CRITICAL: Failed assertion: status
(kms_setmode:2229) CRITICAL: VBlank timing test failed after 2 attempt(s)
(kms_setmode:2229) igt_core-INFO: Stack trace:
(kms_setmode:2229) igt_core-INFO:   #0 ../lib/igt_core.c:2075 __igt_fail_assert()
(kms_setmode:2229) igt_core-INFO:   #1 ../tests/kms_setmode.c:533 test_one_combination()
(kms_setmode:2229) igt_core-INFO:   #2 ../tests/kms_setmode.c:976 __igt_unique____real_main1031()
(kms_setmode:2229) igt_core-INFO:   #3 ../tests/kms_setmode.c:1031 main()
(kms_setmode:2229) igt_core-INFO:   #4 [__libc_init_first+0x8a]
(kms_setmode:2229) igt_core-INFO:   #5 [__libc_start_main+0x8b]
(kms_setmode:2229) igt_core-INFO:   #6 [_start+0x25]
****  END  ****
Dynamic subtest pipe-A-eDP-1: FAIL (4.787s)
Dmesg
<6> [68.066831] Console: switching to colour dummy device 80x25
<6> [68.066989] [IGT] kms_setmode: executing
<6> [68.069320] [IGT] kms_setmode: starting subtest basic
<7> [68.069433] xe 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:150:pipe A]
<7> [68.069756] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.enable (expected yes, found no)
<7> [68.069876] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.active (expected yes, found no)
<7> [68.070051] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in cpu_transcoder (expected 0, found -1)
<7> [68.070168] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in lane_count (expected 4, found 0)
<7> [68.070269] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in dp_m_n (expected tu 64 data 6329869/8388608 link 421991/524288, found tu 0, data 0/0 link 0/0)
<7> [68.070355] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in output_types (expected 0x00000100, found 0x00000000)
<7> [68.070437] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in framestart_delay (expected 1, found 0)
<7> [68.070520] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 2880, found 0)
<7> [68.070600] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 3040, found 0)
<7> [68.070679] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 2880, found 0)
<7> [68.070758] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 3040, found 0)
<7> [68.070836] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 2928, found 0)
<7> [68.070973] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 2960, found 0)
<7> [68.071079] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 1800, found 0)
<7> [68.071185] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 1800, found 0)
<7> [68.071269] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 1803, found 0)
<7> [68.071348] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 1809, found 0)
<7> [68.071426] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 1906, found 0)
<7> [68.071503] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 1906, found 0)
<7> [68.071579] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 2880, found 0)
<7> [68.071655] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 3040, found 0)
<7> [68.071729] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 2880, found 0)
<7> [68.071802] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 3040, found 0)
<7> [68.071876] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 2928, found 0)
<7> [68.071970] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 2960, found 0)
<7> [68.072064] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 1800, found 0)
<7> [68.072158] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 1800, found 0)
<7> [68.072244] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 1803, found 0)
<7> [68.072315] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 1809, found 0)
<7> [68.072387] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 1906, found 0)
<7> [68.072458] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 1906, found 0)
<7> [68.072529] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in pixel_multiplier (expected 1, found 0)
<7> [68.072600] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.flags (2) (expected 2, found 0)
<7> [68.072671] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.flags (8) (expected 8, found 0)
<7> [68.072742] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in pipe_bpp (expected 30, found 0)
<7> [68.072813] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 347710, found 0)
<7> [68.072882] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 347710, found 0)
<7> [68.072977] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in port_clock (expected 432000, found 0)
<7> [68.073070] xe 0000:00:02.0: [drm:intel_atomic_check [xe]] [CRTC:150:pipe A] fastset requirement not met, forcing full modeset
<7> [68.073163] xe 0000:00:02.0: [drm:intel_dpll_crtc_put [xe]] [CRTC:150:pipe A] releasing DPLL 0
<7> [68.073277] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] Enabled dbuf slices 0xf -> 0x1 (total dbuf slices 0xf), mbus joined? yes->no
<7> [68.073337] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] [CRTC:150:pipe A] dbuf slices 0xf -> 0x0, ddb (0 - 4096) -> (0 - 0), active pipes 0x1 -> 0x0
<7> [68.073413] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] [PLANE:34:plane 1A] ddb ( 0 - 4051) -> ( 0 - 0), size 4051 -> 0
<7> [68.073474] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] [PLANE:144:cursor A] ddb (4051 - 4096) -> ( 0 - 0), size 45 -> 0
<7> [68.073531] xe 0000:00:02.0: [drm:skl_print_plane_changes [xe]] [PLANE:34: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> [68.073585] xe 0000:00:02.0: [drm:skl_print_plane_changes [xe]] [PLANE:34:plane 1A] lines 1, 13, 13, 13, 13, 13, 0, 0, 0, 3, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [68.073639] xe 0000:00:02.0: [drm:skl_print_plane_changes [xe]] [PLANE:34:plane 1A] blocks 24, 313, 313, 313, 313, 313, 0, 0, 38, 73, 87 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [68.073691] xe 0000:00:02.0: [drm:skl_print_plane_changes [xe]] [PLANE:34:plane 1A] min_ddb 28, 346, 346, 346, 346, 346, 0, 0, 39, 82, 88 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [68.073759] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] [CRTC:150:pipe A] data rate 0 num active planes 0
<7> [68.073843] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 0: max bw 23530 required 0 qgv_peak_bw: 38400
<7> [68.073936] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 1: max bw 36260 required 0 qgv_peak_bw: 38400
<7> [68.074042] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 2: max bw 38000 required 0 qgv_peak_bw: 38400
<7> [68.074145] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 3: max bw 38000 required 0 qgv_peak_bw: 38400
<7> [68.074235] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] Matching peaks QGV bw: 38400 for required data rate: 0
<7> [68.074313] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] [CRTC:150:pipe A] min cdclk: 173855 kHz -> 0 kHz
<7> [68.074406] xe 0000:00:02.0: [drm:intel_cdclk_update_dbuf_bw_min_cdclk [xe]] dbuf bandwidth min cdclk: 21732 kHz -> 0 kHz
<7> [68.074494] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] Can change cdclk via squashing
<7> [68.074585] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] New cdclk calculated to be logical 153600 kHz, actual 153600 kHz
<7> [68.074668] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] New voltage level calculated to be logical 0, actual 0
<7> [68.074763] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [CRTC:150:pipe A] enable: no [modeset]
<7> [68.074844] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:34:plane 1A] fb: [NOFB], visible: no
<7> [68.074936] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:64:plane 2A] fb: [NOFB], visible: no
<7> [68.075037] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:94:plane 3A] fb: [NOFB], visible: no
<7> [68.075137] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:124:plane 4A] fb: [NOFB], visible: no
<7> [68.075226] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:134:plane 5A] fb: [NOFB], visible: no
<7> [68.075301] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:144:cursor A] fb: [NOFB], visible: no
<7> [68.075409] xe 0000:00:02.0: [drm:intel_power_well_enable [xe]] enabling DC_off
<7> [68.075496] xe 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [xe]] Setting DC state from 02 to 00
<7> [68.075621] xe 0000:00:02.0: [drm:intel_psr_disable_locked [xe]] Disabling PSR2
<7> [68.076650] xe 0000:00:02.0: [drm:intel_alpm_disable [xe]] Disabling ALPM
<7> [68.076798] xe 0000:00:02.0: [drm:intel_edp_backlight_off [xe]]
<7> [68.279891] xe 0000:00:02.0: [drm:intel_backlight_set_pwm_level [xe]] [CONNECTOR:392:eDP-1] set backlight PWM = 0
<7> [68.280357] xe 0000:00:02.0: [drm:intel_disable_transcoder [xe]] disabling pipe A
<7> [68.301595] xe 0000:00:02.0: [drm:intel_pps_off_unlocked [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 turn panel power off
<7> [68.302074] xe 0000:00:02.0: [drm:intel_pps_off_unlocked [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 wait for panel power off time
<7> [68.302027] xe 0000:00:02.0: [drm:icp_irq_handler [xe]] hotplug event received, stat 0x00010000, dig 0x00000009, pins 0x00000010, long 0x00000000
<7> [68.302422] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] digital hpd on [ENCODER:391:DDI A/PHY A] - short
<7> [68.302491] xe 0000:00:02.0: [drm:wait_panel_status [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 mask: 0xb0000000 value: 0x00000000 PP_STATUS: 0xa0000002 PP_CONTROL: 0x00000060
<7> [68.353623] xe 0000:00:02.0: [drm:wait_panel_status [xe]] Wait complete
<7> [68.353947] xe 0000:00:02.0: [drm:intel_dpll_disable [xe]] disable DPLL 0 (active 0x1, on? 1) for [CRTC:150:pipe A]
<7> [68.354266] xe 0000:00:02.0: [drm:intel_dp_hpd_pulse [xe]] ignoring short hpd on eDP [ENCODER:391:DDI A/PHY A]
<7> [68.354655] xe 0000:00:02.0: [drm:icp_irq_handler [xe]] hotplug event received, stat 0x00010000, dig 0x00000009, pins 0x00000010, long 0x00000000
<7> [68.355193] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] digital hpd on [ENCODER:391:DDI A/PHY A] - short
<7> [68.355309] xe 0000:00:02.0: [drm:intel_dpll_disable [xe]] disabling DPLL 0
<7> [68.355671] xe 0000:00:02.0: [drm:intel_power_well_disable [xe]] disabling AUX_A
<7> [68.356052] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:391:DDI A/PHY A]
<7> [68.356271] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:400:DDI TC1/PHY TC1]
<7> [68.356468] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:402:DP-MST A]
<7> [68.356596] xe 0000:00:02.0: [drm:intel_dp_hpd_pulse [xe]] ignoring short hpd on eDP [ENCODER:391:DDI A/PHY A]
<7> [68.356699] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:403:DP-MST B]
<7> [68.356906] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:404:DP-MST C]
<7> [68.357103] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:412:DDI TC2/PHY TC2]
<7> [68.357295] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:414:DP-MST A]
<7> [68.357524] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:415:DP-MST B]
<7> [68.357756] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:416:DP-MST C]
<7> [68.357934] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:420:DDI TC3/PHY TC3]
<7> [68.358108] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:422:DP-MST A]
<7> [68.358280] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:423:DP-MST B]
<7> [68.358476] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:424:DP-MST C]
<7> [68.358677] xe 0000:00:02.0: [drm:verify_connector_state [xe]] [CONNECTOR:392:eDP-1]
<7> [68.358940] xe 0000:00:02.0: [drm:intel_dbuf_mdclk_cdclk_ratio_update [xe]] Updating dbuf ratio to 4 (mbus joined: no)
<7> [68.359127] xe 0000:00:02.0: [drm:intel_dbuf_mbus_join_update [xe]] Changing mbus joined: yes -> no (pipe: *)
<7> [68.359306] xe 0000:00:02.0: [drm:gen9_dbuf_slices_update [xe]] Updating dbuf slices to 0x1
<7> [68.359663] xe 0000:00:02.0: [drm:intel_power_well_disable [xe]] disabling PW_A
<7> [68.359943] 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> [68.360246] xe 0000:00:02.0: [drm:intel_modeset_verify_crtc [xe]] [CRTC:150:pipe A]
<7> [68.360460] 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> [68.360764] xe 0000:00:02.0: [drm:intel_dbuf_mdclk_cdclk_ratio_update [xe]] Updating dbuf ratio to 4 (mbus joined: no)
<7> [68.360973] xe 0000:00:02.0: [drm:intel_audio_cdclk_change_post.part.0 [xe]] aud_ts_cdclk set to M=60, N=384
<7> [68.361603] xe 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:269:pipe B]
<7> [68.361866] xe 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:388:pipe C]
<7> [68.366233] xe 0000:00:02.0: [drm:drm_mode_addfb2] [FB:428]
<7> [68.379622] xe 0000:00:02.0: [drm:intel_power_well_disable [xe]] disabling DC_off
<7> [68.379791] xe 0000:00:02.0: [drm:skl_enable_dc6 [xe]] Enabling DC6
<7> [68.379918] xe 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [xe]] Setting DC state from 00 to 02
<7> [68.380063] xe 0000:00:02.0: [drm:intel_power_well_disable [xe]] disabling always-on
<7> [68.389470] xe 0000:00:02.0: [drm:icp_irq_handler [xe]] hotplug event received, stat 0x00010000, dig 0x0000000a, pins 0x00000010, long 0x00000010
<7> [68.389606] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] digital hpd on [ENCODER:391:DDI A/PHY A] - long
<7> [68.389698] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] Received HPD interrupt on PIN 4 - cnt: 10
<7> [68.389797] xe 0000:00:02.0: [drm:intel_dp_hpd_pulse [xe]] ignoring long hpd on eDP [ENCODER:391:DDI A/PHY A]
<6> [68.423452] [IGT] kms_setmode: starting dynamic subtest pipe-A-eDP-1
<7> [68.424083] xe 0000:00:02.0: [drm:drm_mode_addfb2] [FB:430]
<7> [68.490502] xe 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:150:pipe A]
<7> [68.490547] xe 0000:00:02.0: [drm:drm_mode_setcrtc] [CONNECTOR:392:eDP-1]
<7> [68.490669] xe 0000:00:02.0: [drm:intel_atomic_check [xe]] [CONNECTOR:392:eDP-1] Limiting target display pipe bpp to 30 (EDID bpp 30, max requested bpp 36, max platform bpp 36)
<7> [68.490840] xe 0000:00:02.0: [drm:intel_dp_compute_config_limits [xe]] [ENCODER:391:DDI A/PHY A][CRTC:150: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> [68.490956] xe 0000:00:02.0: [drm:intel_dp_compute_link_config [xe]] DP lane count 4 clock 432000 bpp input 30 compressed 0.0000 HDR no link rate required 1303913 available 1728000
<7> [68.491085] xe 0000:00:02.0: [drm:intel_atomic_check [xe]] [CRTC:150:pipe A] hw max bpp: 30, pipe bpp: 30, dithering: 0
<7> [68.491201] xe 0000:00:02.0: [drm:intel_ddi_compute_config_late [xe]] [ENCODER:391:DDI A/PHY A] [CRTC:150:pipe A]
<7> [68.491316] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.enable (expected no, found yes)
<7> [68.491447] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.active (expected no, found yes)
<7> [68.491555] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in cpu_transcoder (expected -1, found 0)
<7> [68.491661] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in lane_count (expected 0, found 4)
<7> [68.491764] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150: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> [68.491868] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in output_types (expected 0x00000000, found 0x00000100)
<7> [68.491970] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in framestart_delay (expected 0, found 1)
<7> [68.492072] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 0, found 2880)
<7> [68.492174] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 0, found 3040)
<7> [68.492276] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 0, found 2880)
<7> [68.492377] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 0, found 3040)
<7> [68.492487] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 0, found 2928)
<7> [68.492590] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 0, found 2960)
<7> [68.492691] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 0, found 1800)
<7> [68.492793] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 0, found 1800)
<7> [68.492894] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 0, found 1803)
<7> [68.492995] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 0, found 1809)
<7> [68.493097] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 0, found 1906)
<7> [68.493198] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 0, found 1906)
<7> [68.493299] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 0, found 2880)
<7> [68.493400] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 0, found 3040)
<7> [68.493506] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 0, found 2880)
<7> [68.493609] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 0, found 3040)
<7> [68.493710] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 0, found 2928)
<7> [68.493811] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 0, found 2960)
<7> [68.493911] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 0, found 1800)
<7> [68.494013] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 0, found 1800)
<7> [68.494113] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 0, found 1803)
<7> [68.494214] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 0, found 1809)
<7> [68.494316] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 0, found 1906)
<7> [68.494422] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 0, found 1906)
<7> [68.494524] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in pixel_multiplier (expected 0, found 1)
<7> [68.494625] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.flags (2) (expected 0, found 2)
<7> [68.494726] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.flags (8) (expected 0, found 8)
<7> [68.494828] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in pipe_bpp (expected 0, found 30)
<7> [68.494929] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 0, found 347710)
<7> [68.495029] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 0, found 347710)
<7> [68.495130] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in port_clock (expected 0, found 432000)
<7> [68.495231] xe 0000:00:02.0: [drm:intel_atomic_check [xe]] [CRTC:150:pipe A] fastset requirement not met, forcing full modeset
<7> [68.495384] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] Enabled dbuf slices 0x1 -> 0xf (total dbuf slices 0xf), mbus joined? no->yes
<7> [68.495494] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] [CRTC:150:pipe A] dbuf slices 0x0 -> 0xf, ddb (0 - 0) -> (0 - 4096), active pipes 0x0 -> 0x1
<7> [68.495601] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] [PLANE:34:plane 1A] ddb ( 0 - 0) -> ( 0 - 4051), size 0 -> 4051
<7> [68.495675] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] [PLANE:144:cursor A] ddb ( 0 - 0) -> (4051 - 4096), size 0 -> 45
<7> [68.495745] xe 0000:00:02.0: [drm:skl_print_plane_changes [xe]] [PLANE:34: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> [68.495815] xe 0000:00:02.0: [drm:skl_print_plane_changes [xe]] [PLANE:34: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> [68.495885] xe 0000:00:02.0: [drm:skl_print_plane_changes [xe]] [PLANE:34: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> [68.495955] xe 0000:00:02.0: [drm:skl_print_plane_changes [xe]] [PLANE:34: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> [68.496046] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] [CRTC:150:pipe A] data rate 1390840 num active planes 1
<7> [68.496164] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 0: max bw 23530 required 1461 qgv_peak_bw: 38400
<7> [68.496276] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 1: max bw 36260 required 1461 qgv_peak_bw: 38400
<7> [68.496385] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 2: max bw 38000 required 1461 qgv_peak_bw: 38400
<7> [68.496519] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 3: max bw 38000 required 1461 qgv_peak_bw: 38400
<7> [68.496631] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] Matching peaks QGV bw: 38400 for required data rate: 1461
<7> [68.496740] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] [CRTC:150:pipe A] min cdclk: 0 kHz -> 173855 kHz
<7> [68.496872] xe 0000:00:02.0: [drm:intel_cdclk_update_dbuf_bw_min_cdclk [xe]] dbuf bandwidth min cdclk: 0 kHz -> 21732 kHz
<7> [68.496983] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] Can change cdclk via squashing
<7> [68.497090] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] New cdclk calculated to be logical 192000 kHz, actual 192000 kHz
<7> [68.497196] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] New voltage level calculated to be logical 0, actual 0
<7> [68.497323] xe 0000:00:02.0: [drm:intel_find_dpll [xe]] [CRTC:150:pipe A] allocated DPLL 0
<7> [68.497438] xe 0000:00:02.0: [drm:intel_dpll_crtc_get [xe]] [CRTC:150:pipe A] reserving DPLL 0
<7> [68.497561] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [CRTC:150:pipe A] enable: yes [modeset]
<7> [68.497682] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] active: yes, output_types: EDP (0x100), output format: RGB, sink format: RGB
<7> [68.497795] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] cpu_transcoder: A, pipe bpp: 30, dithering: 0
<7> [68.497905] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] MST master transcoder: <invalid>
<7> [68.498014] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] port sync: master transcoder: <invalid>, slave transcoder bitmask = 0x0
<7> [68.498123] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] joiner: no, pipes: 0x0
<7> [68.498232] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] splitter: disabled, link count 0, overlap 0
<7> [68.498342] 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> [68.498457] 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> [68.498571] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] fec: disabled, enhanced framing: disabled
<7> [68.498682] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] sdp split: disabled
<7> [68.498789] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] psr: enabled, selective update: enabled, panel replay: disabled, selective fetch: enabled
<7> [68.498899] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] minimum HBlank: 0
<7> [68.499007] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] audio: 0, infoframes: 0, infoframes enabled: 0x4
<7> [68.499115] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] DP SDP: VSC, revision 4, length 14
<7> [68.499224] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pixelformat: RGB
<7> [68.499333] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] colorimetry: sRGB
<7> [68.499446] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] bpc: 0
<7> [68.499560] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] dynamic range: VESA range
<7> [68.499669] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] content type: Not defined
<7> [68.499778] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] scanline offset: 1
<7> [68.499886] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] framestart delay: 1, MSA timing delay: 0, set context latency: 0
<7> [68.499995] 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> [68.500104] 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> [68.500212] 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> [68.500320] 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> [68.500686] 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> [68.500819] 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> [68.500928] 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> [68.501036] 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> [68.501145] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] port clock: 432000, pipe src: 2880x1800+0+0, pixel rate 347710, min cdclk 173855
<7> [68.501255] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] linetime: 70, ips linetime: 0
<7> [68.501362] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] num_scalers: 2, scaler_users: 0x0, scaler_id: -1, scaling_filter: 0
<7> [68.501784] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pch pfit: 0x0+0+0, disabled, force thru: no
<7> [68.501914] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] ips: 0, double wide: 0, drrs: 0
<7> [68.502021] 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> [68.502129] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] c10pll_hw_state: fracen: no,
<7> [68.502234] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] multiplier: 225, tx_clk_div: 1.
<7> [68.502340] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] c10pll_rawhw_state:
<7> [68.502453] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] tx: 0x10, cmn: 0x21
<7> [68.502565] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pll[0] = 0x4, pll[1] = 0x0, pll[2] = 0xa2, pll[3] = 0x1
<7> [68.502671] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pll[4] = 0x0, pll[5] = 0x0, pll[6] = 0x0, pll[7] = 0x0
<7> [68.502777] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pll[8] = 0x0, pll[9] = 0x1, pll[10] = 0x0, pll[11] = 0x0
<7> [68.502882] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pll[12] = 0x0, pll[13] = 0x0, pll[14] = 0x0, pll[15] = 0x1
<7> [68.502987] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pll[16] = 0x85, pll[17] = 0xf, pll[18] = 0xe6, pll[19] = 0x23
<7> [68.503093] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] csc_mode: 0x0 gamma_mode: 0x0 gamma_enable: 0 csc_enable: 0
<7> [68.503199] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pre csc lut: 0 entries, post csc lut: 0 entries
<7> [68.503304] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] output csc: pre offsets: 0x0000 0x0000 0x0000
<7> [68.503421] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [68.503530] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [68.503636] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [68.503741] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] output csc: post offsets: 0x0000 0x0000 0x0000
<7> [68.503847] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe csc: pre offsets: 0x0000 0x0000 0x0000
<7> [68.503953] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [68.504059] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [68.504166] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [68.504271] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] pipe csc: post offsets: 0x0000 0x0000 0x0000
<7> [68.504376] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] sharpness strength: 0, sharpness tap size: 0, sharpness enable: 0
<7> [68.504495] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:34:plane 1A] fb: [FB:430] 2880x1800 format = XR24 little-endian (0x34325258) modifier = 0x0, visible: yes
<7> [68.504609] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] rotation: 0x1, scaler: -1, scaling_filter: 0
<7> [68.504715] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] src: 2880.000000x1800.000000+0.000000+0.000000 dst: 2880x1800+0+0
<7> [68.504823] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:64:plane 2A] fb: [NOFB], visible: no
<7> [68.504928] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:94:plane 3A] fb: [NOFB], visible: no
<7> [68.505034] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:124:plane 4A] fb: [NOFB], visible: no
<7> [68.505140] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:134:plane 5A] fb: [NOFB], visible: no
<7> [68.505246] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:144:cursor A] fb: [NOFB], visible: no
<7> [68.508351] xe 0000:00:02.0: [drm:intel_power_well_enable [xe]] enabling always-on
<7> [68.508516] xe 0000:00:02.0: [drm:intel_power_well_enable [xe]] enabling DC_off
<7> [68.508787] xe 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [xe]] Setting DC state from 02 to 00
<7> [68.508957] xe 0000:00:02.0: [drm:intel_power_well_enable [xe]] enabling PW_A
<7> [68.509128] 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> [68.509270] 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> [68.509424] xe 0000:00:02.0: [drm:intel_dbuf_mdclk_cdclk_ratio_update [xe]] Updating dbuf ratio to 4 (mbus joined: no)
<7> [68.509564] xe 0000:00:02.0: [drm:intel_audio_cdclk_change_post.part.0 [xe]] aud_ts_cdclk set to M=60, N=480
<7> [68.509686] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:391:DDI A/PHY A]
<7> [68.509774] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:400:DDI TC1/PHY TC1]
<7> [68.509858] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:402:DP-MST A]
<7> [68.509940] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:403:DP-MST B]
<7> [68.510021] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:404:DP-MST C]
<7> [68.510101] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:412:DDI TC2/PHY TC2]
<7> [68.510183] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:414:DP-MST A]
<7> [68.510264] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:415:DP-MST B]
<7> [68.510345] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:416:DP-MST C]
<7> [68.510456] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:420:DDI TC3/PHY TC3]
<7> [68.510552] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:422:DP-MST A]
<7> [68.510633] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:423:DP-MST B]
<7> [68.510713] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:424:DP-MST C]
<7> [68.510824] xe 0000:00:02.0: [drm:gen9_dbuf_slices_update [xe]] Updating dbuf slices to 0xf
<7> [68.511013] xe 0000:00:02.0: [drm:intel_dbuf_mbus_join_update [xe]] Changing mbus joined: no -> yes (pipe: *)
<7> [68.511093] xe 0000:00:02.0: [drm:intel_dbuf_mdclk_cdclk_ratio_update [xe]] Updating dbuf ratio to 8 (mbus joined: yes)
<7> [68.511232] xe 0000:00:02.0: [drm:intel_power_well_enable [xe]] enabling AUX_A
<7> [68.512445] xe 0000:00:02.0: [drm:intel_dpll_enable [xe]] enable DPLL 0 (active 0x1, on? 0) for [CRTC:150:pipe A]
<7> [68.512560] xe 0000:00:02.0: [drm:intel_dpll_enable [xe]] enabling DPLL 0
<7> [68.514951] xe 0000:00:02.0: [drm:intel_pps_on_unlocked [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 turn panel power on
<7> [68.515078] xe 0000:00:02.0: [drm:wait_panel_power_cycle [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 wait for panel power cycle (339 ms remaining)
<7> [68.855443] xe 0000:00:02.0: [drm:wait_panel_status [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 mask: 0xb800000f value: 0x00000000 PP_STATUS: 0x08000001 PP_CONTROL: 0x00000060
<7> [68.896555] xe 0000:00:02.0: [drm:wait_panel_status [xe]] Wait complete
<7> [68.897172] xe 0000:00:02.0: [drm:intel_pps_on_unlocked [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 wait for panel power on
<7> [68.897557] xe 0000:00:02.0: [drm:wait_panel_status [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 mask: 0xb000000f value: 0x80000008 PP_STATUS: 0x9000000a PP_CONTROL: 0x00000063
<7> [68.933934] xe 0000:00:02.0: [drm:icp_irq_handler [xe]] hotplug event received, stat 0x00010000, dig 0x0000000a, pins 0x00000010, long 0x00000010
<7> [68.934472] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] digital hpd on [ENCODER:391:DDI A/PHY A] - long
<7> [68.934863] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] Received HPD interrupt on PIN 4 - cnt: 20
<7> [68.935494] xe 0000:00:02.0: [drm:intel_dp_hpd_pulse [xe]] ignoring long hpd on eDP [ENCODER:391:DDI A/PHY A]
<7> [69.108195] xe 0000:00:02.0: [drm:wait_panel_status [xe]] Wait complete
<7> [69.108896] xe 0000:00:02.0: [drm:intel_pps_vdd_on_unlocked [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 turning VDD on
<7> [69.109308] xe 0000:00:02.0: [drm:intel_pps_vdd_on_unlocked [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 PP_STATUS: 0x80000008 PP_CONTROL: 0x0000006b
<7> [69.111490] 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> [69.113087] xe 0000:00:02.0: [drm:intel_dp_start_link_train [xe]] [CONNECTOR:392:eDP-1][ENCODER:391:DDI A/PHY A][DPRX] Reloading eDP link rates
<7> [69.113917] xe 0000:00:02.0: [drm:intel_dp_start_link_train [xe]] [CONNECTOR:392:eDP-1][ENCODER:391:DDI A/PHY A][DPRX] Using LINK_RATE_SET value 05
<7> [69.115096] xe 0000:00:02.0: [drm:intel_dp_set_signal_levels [xe]] [CONNECTOR:392:eDP-1][ENCODER:391:DDI A/PHY A][DPRX] 8b/10b, lanes: 4, vswing levels: 0/0/0/0, pre-emphasis levels: 0/0/0/0
<7> [69.116469] xe 0000:00:02.0: [drm:intel_dp_program_link_training_pattern [xe]] [CONNECTOR:392:eDP-1][ENCODER:391:DDI A/PHY A][DPRX] Using DP training pattern TPS1
<7> [69.117608] xe 0000:00:02.0: [drm:intel_dp_link_train_phy [xe]] [CONNECTOR:392:eDP-1][ENCODER:391:DDI A/PHY A][DPRX] Clock recovery OK
<7> [69.118007] xe 0000:00:02.0: [drm:intel_dp_program_link_training_pattern [xe]] [CONNECTOR:392:eDP-1][ENCODER:391:DDI A/PHY A][DPRX] Using DP training pattern TPS4
<7> [69.119487] xe 0000:00:02.0: [drm:intel_dp_link_train_phy [xe]] [CONNECTOR:392:eDP-1][ENCODER:391:DDI A/PHY A][DPRX] Channel EQ done. DP Training successful
<7> [69.119877] xe 0000:00:02.0: [drm:intel_dp_link_train_phy [xe]] [CONNECTOR:392:eDP-1][ENCODER:391:DDI A/PHY A][DPRX] Link Training passed at link rate = 432000, lane count = 4
<7> [69.120666] xe 0000:00:02.0: [drm:intel_enable_transcoder [xe]] enabling pipe A
<7> [69.121334] xe 0000:00:02.0: [drm:intel_edp_backlight_on [xe]]
<7> [69.121715] xe 0000:00:02.0: [drm:intel_backlight_enable [xe]] pipe A
<7> [69.122210] xe 0000:00:02.0: [drm:intel_backlight_set_pwm_level [xe]] [CONNECTOR:392:eDP-1] set backlight PWM = 192000
<7> [69.138147] xe 0000:00:02.0: [drm:intel_psr_post_plane_update [xe]] Enabling PSR2
<7> [69.140121] xe 0000:00:02.0: [drm:verify_connector_state [xe]] [CONNECTOR:392:eDP-1]
<7> [69.140573] xe 0000:00:02.0: [drm:intel_modeset_verify_crtc [xe]] [CRTC:150:pipe A]
<7> [69.161799] xe 0000:00:02.0: [drm:intel_power_well_disable [xe]] disabling DC_off
<7> [69.162331] xe 0000:00:02.0: [drm:skl_enable_dc6 [xe]] Enabling DC6
<7> [69.164144] xe 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [xe]] Setting DC state from 00 to 02
<7> [71.692650] xe 0000:00:02.0: [drm:intel_pps_vdd_off_sync_unlocked [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 turning VDD off
<7> [71.693288] xe 0000:00:02.0: [drm:intel_pps_vdd_off_sync_unlocked [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 PP_STATUS: 0x80000008 PP_CONTROL: 0x00000067
<6> [73.210447] [IGT] kms_setmode: finished subtest pipe-A-eDP-1, FAIL
<7> [73.210772] xe 0000:00:02.0: [drm:drm_mode_rmfb_work_fn] Removing [FB:430] from all active usage due to RMFB ioctl
<7> [73.211111] xe 0000:00:02.0: [drm:atomic_remove_fb] Disabling [PLANE:34:plane 1A] because [FB:430] is removed
<7> [73.211178] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] [PLANE:34:plane 1A] ddb ( 0 - 4051) -> ( 0 - 0), size 4051 -> 0
<7> [73.211293] xe 0000:00:02.0: [drm:skl_print_plane_changes [xe]] [PLANE:34: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> [73.211375] xe 0000:00:02.0: [drm:skl_print_plane_changes [xe]] [PLANE:34:plane 1A] lines 1, 13, 13, 13, 13, 13, 0, 0, 0, 3, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [73.211449] xe 0000:00:02.0: [drm:skl_print_plane_changes [xe]] [PLANE:34:plane 1A] blocks 24, 313, 313, 313, 313, 313, 0, 0, 38, 73, 87 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [73.211520] xe 0000:00:02.0: [drm:skl_print_plane_changes [xe]] [PLANE:34:plane 1A] min_ddb 28, 346, 346, 346, 346, 346, 0, 0, 39, 82, 88 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [73.211661] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] [CRTC:150:pipe A] data rate 0 num active planes 0
<7> [73.211784] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 0: max bw 23530 required 0 qgv_peak_bw: 38400
<7> [73.211901] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 1: max bw 36260 required 0 qgv_peak_bw: 38400
<7> [73.212014] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 2: max bw 38000 required 0 qgv_peak_bw: 38400
<7> [73.212126] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] QGV point 3: max bw 38000 required 0 qgv_peak_bw: 38400
<7> [73.212238] xe 0000:00:02.0: [drm:intel_bw_atomic_check [xe]] Matching peaks QGV bw: 38400 for required data rate: 0
<6> [73.212376] xe 0000:00:02.0: [drm] Selective fetch area calculation failed in pipe A
<7> [73.213017] xe 0000:00:02.0: [drm:intel_power_well_enable [xe]] enabling DC_off
<7> [73.213778] xe 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [xe]] Setting DC state from 02 to 00
<7> [73.213945] xe 0000:00:02.0: [drm:intel_psr_disable_locked [xe]] Disabling PSR2
<7> [73.214544] xe 0000:00:02.0: [drm:intel_pps_vdd_on_unlocked [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 turning VDD on
<7> [73.214689] xe 0000:00:02.0: [drm:intel_pps_vdd_on_unlocked [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 PP_STATUS: 0x80000008 PP_CONTROL: 0x0000006f
<7> [73.231734] xe 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:150:pipe A]
<7> [73.231997] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.enable (expected yes, found no)
<7> [73.232312] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.active (expected yes, found no)
<7> [73.232530] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in cpu_transcoder (expected 0, found -1)
<7> [73.232772] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in lane_count (expected 4, found 0)
<7> [73.232959] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in dp_m_n (expected tu 64 data 6329869/8388608 link 421991/524288, found tu 0, data 0/0 link 0/0)
<7> [73.233140] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in output_types (expected 0x00000100, found 0x00000000)
<7> [73.233311] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in framestart_delay (expected 1, found 0)
<7> [73.233481] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 2880, found 0)
<7> [73.233657] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 3040, found 0)
<7> [73.233821] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 2880, found 0)
<7> [73.233983] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 3040, found 0)
<7> [73.234136] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 2928, found 0)
<7> [73.234289] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 2960, found 0)
<7> [73.234441] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 1800, found 0)
<7> [73.234601] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 1800, found 0)
<7> [73.234750] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 1803, found 0)
<7> [73.234893] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 1809, found 0)
<7> [73.235033] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 1906, found 0)
<7> [73.235172] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 1906, found 0)
<7> [73.235307] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 2880, found 0)
<7> [73.235441] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 3040, found 0)
<7> [73.235582] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 2880, found 0)
<7> [73.235720] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 3040, found 0)
<7> [73.235850] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 2928, found 0)
<7> [73.235975] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 2960, found 0)
<7> [73.236100] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 1800, found 0)
<7> [73.236220] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 1800, found 0)
<7> [73.236341] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 1803, found 0)
<7> [73.236462] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 1809, found 0)
<7> [73.236592] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 1906, found 0)
<7> [73.236712] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 1906, found 0)
<7> [73.236826] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in pixel_multiplier (expected 1, found 0)
<7> [73.236941] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.flags (2) (expected 2, found 0)
<7> [73.237054] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.flags (8) (expected 8, found 0)
<7> [73.237167] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in pipe_bpp (expected 30, found 0)
<7> [73.237279] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 347710, found 0)
<7> [73.237391] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 347710, found 0)
<7> [73.237502] xe 0000:00:02.0: [drm:intel_pipe_config_compare [xe]] [CRTC:150:pipe A] fastset requirement not met in port_clock (expected 432000, found 0)
<7> [73.237668] xe 0000:00:02.0: [drm:intel_atomic_check [xe]] [CRTC:150:pipe A] fastset requirement not met, forcing full modeset
<7> [73.237789] xe 0000:00:02.0: [drm:intel_dpll_crtc_put [xe]] [CRTC:150:pipe A] releasing DPLL 0
<7> [73.237960] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] Enabled dbuf slices 0xf -> 0x1 (total dbuf slices 0xf), mbus joined? yes->no
<7> [73.238060] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] [CRTC:150:pipe A] dbuf slices 0xf -> 0x0, ddb (0 - 4096) -> (0 - 0), active pipes 0x1 -> 0x0
<7> [73.238184] xe 0000:00:02.0: [drm:skl_compute_wm [xe]] [PLANE:144:cursor A] ddb (4051 - 4096) -> ( 0 - 0), size 45 -> 0
<7> [73.238297] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] [CRTC:150:pipe A] min cdclk: 173855 kHz -> 0 kHz
<7> [73.238445] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] Can change cdclk via squashing
<7> [73.238593] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] New cdclk calculated to be logical 153600 kHz, actual 153600 kHz
<7> [73.238736] xe 0000:00:02.0: [drm:intel_cdclk_atomic_check [xe]] New voltage level calculated to be logical 0, actual 0
<7> [73.238917] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [CRTC:150:pipe A] enable: no [modeset]
<7> [73.239069] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:34:plane 1A] fb: [NOFB], visible: no
<7> [73.239220] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:64:plane 2A] fb: [NOFB], visible: no
<7> [73.239374] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:94:plane 3A] fb: [NOFB], visible: no
<7> [73.239528] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:124:plane 4A] fb: [NOFB], visible: no
<7> [73.239688] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:134:plane 5A] fb: [NOFB], visible: no
<7> [73.239841] xe 0000:00:02.0: [drm:intel_crtc_state_dump [xe]] [PLANE:144:cursor A] fb: [NOFB], visible: no
<7> [73.240251] xe 0000:00:02.0: [drm:intel_alpm_disable [xe]] Disabling ALPM
<7> [73.240408] xe 0000:00:02.0: [drm:intel_edp_backlight_off [xe]]
<7> [73.443571] xe 0000:00:02.0: [drm:intel_backlight_set_pwm_level [xe]] [CONNECTOR:392:eDP-1] set backlight PWM = 0
<7> [73.444632] xe 0000:00:02.0: [drm:intel_disable_transcoder [xe]] disabling pipe A
<7> [73.448640] xe 0000:00:02.0: [drm:intel_pps_off_unlocked [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 turn panel power off
<7> [73.449011] xe 0000:00:02.0: [drm:icp_irq_handler [xe]] hotplug event received, stat 0x00010000, dig 0x00000009, pins 0x00000010, long 0x00000000
<7> [73.449203] xe 0000:00:02.0: [drm:intel_pps_off_unlocked [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 wait for panel power off time
<7> [73.449765] xe 0000:00:02.0: [drm:wait_panel_status [xe]] [ENCODER:391:DDI A/PHY A] PPS 0 mask: 0xb0000000 value: 0x00000000 PP_STATUS: 0xa0000002 PP_CONTROL: 0x00000060
<7> [73.449717] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] digital hpd on [ENCODER:391:DDI A/PHY A] - short
<7> [73.501742] xe 0000:00:02.0: [drm:icp_irq_handler [xe]] hotplug event received, stat 0x00010000, dig 0x00000009, pins 0x00000010, long 0x00000000
<7> [73.502238] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] digital hpd on [ENCODER:391:DDI A/PHY A] - short
<7> [73.510546] xe 0000:00:02.0: [drm:wait_panel_status [xe]] Wait complete
<7> [73.510976] xe 0000:00:02.0: [drm:intel_dpll_disable [xe]] disable DPLL 0 (active 0x1, on? 1) for [CRTC:150:pipe A]
<7> [73.511031] xe 0000:00:02.0: [drm:intel_dp_hpd_pulse [xe]] ignoring short hpd on eDP [ENCODER:391:DDI A/PHY A]
<7> [73.511693] xe 0000:00:02.0: [drm:intel_dp_hpd_pulse [xe]] ignoring short hpd on eDP [ENCODER:391:DDI A/PHY A]
<7> [73.512649] xe 0000:00:02.0: [drm:intel_dpll_disable [xe]] disabling DPLL 0
<7> [73.513231] xe 0000:00:02.0: [drm:intel_power_well_disable [xe]] disabling AUX_A
<7> [73.513895] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:391:DDI A/PHY A]
<7> [73.514341] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:400:DDI TC1/PHY TC1]
<7> [73.514784] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:402:DP-MST A]
<7> [73.515182] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:403:DP-MST B]
<7> [73.515597] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:404:DP-MST C]
<7> [73.515993] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:412:DDI TC2/PHY TC2]
<7> [73.516409] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:414:DP-MST A]
<7> [73.516751] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:415:DP-MST B]
<7> [73.517093] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:416:DP-MST C]
<7> [73.517455] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:420:DDI TC3/PHY TC3]
<7> [73.517802] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:422:DP-MST A]
<7> [73.518145] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:423:DP-MST B]
<7> [73.518508] xe 0000:00:02.0: [drm:intel_modeset_verify_disabled [xe]] [ENCODER:424:DP-MST C]
<7> [73.518853] xe 0000:00:02.0: [drm:verify_connector_state [xe]] [CONNECTOR:392:eDP-1]
<7> [73.519295] xe 0000:00:02.0: [drm:intel_dbuf_mdclk_cdclk_ratio_update [xe]] Updating dbuf ratio to 4 (mbus joined: no)
<7> [73.519643] xe 0000:00:02.0: [drm:intel_dbuf_mbus_join_update [xe]] Changing mbus joined: yes -> no (pipe: *)
<7> [73.519960] xe 0000:00:02.0: [drm:gen9_dbuf_slices_update [xe]] Updating dbuf slices to 0x1
<7> [73.520542] xe 0000:00:02.0: [drm:intel_power_well_disable [xe]] disabling PW_A
<7> [73.520997] 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> [73.521562] xe 0000:00:02.0: [drm:intel_modeset_verify_crtc [xe]] [CRTC:150:pipe A]
<7> [73.521980] 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> [73.522471] xe 0000:00:02.0: [drm:intel_dbuf_mdclk_cdclk_ratio_update [xe]] Updating dbuf ratio to 4 (mbus joined: no)
<7> [73.522786] xe 0000:00:02.0: [drm:intel_audio_cdclk_change_post.part.0 [xe]] aud_ts_cdclk set to M=60, N=384
<7> [73.523739] xe 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:150:pipe A]
<7> [73.524197] xe 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:269:pipe B]
<7> [73.524563] xe 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:388:pipe C]
<7> [73.526817] xe 0000:00:02.0: [drm:drm_mode_addfb2] [FB:430]
<7> [73.536839] xe 0000:00:02.0: [drm:icp_irq_handler [xe]] hotplug event received, stat 0x00010000, dig 0x0000000a, pins 0x00000010, long 0x00000010
<7> [73.537034] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] digital hpd on [ENCODER:391:DDI A/PHY A] - long
<7> [73.537135] xe 0000:00:02.0: [drm:intel_hpd_irq_handler [xe]] Received HPD interrupt on PIN 4 - cnt: 10
<7> [73.537235] xe 0000:00:02.0: [drm:intel_dp_hpd_pulse [xe]] ignoring long hpd on eDP [ENCODER:391:DDI A/PHY A]
<7> [73.543391] xe 0000:00:02.0: [drm:intel_power_well_disable [xe]] disabling DC_off
<7> [73.543562] xe 0000:00:02.0: [drm:skl_enable_dc6 [xe]] Enabling DC6
<7> [73.543693] xe 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [xe]] Setting DC state from 00 to 02
<7> [73.543838] xe 0000:00:02.0: [drm:intel_power_well_disable [xe]] disabling always-on
Created at 2026-03-05 05:13:03