[58.563229] Initializing watchdogs [58.563275] /dev/watchdog0 [58.576611] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics] [58.580716] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [58.582954] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [58.586339] [001/132] (960s left) gem_softpin (allocator-fork) [58.683421] Starting subtest: allocator-fork [60.898424] Subtest allocator-fork: SUCCESS (2.219s) [61.033938] [002/132] (958s left) syncobj_timeline (multi-wait-all-available-signaled) [61.093066] Starting subtest: multi-wait-all-available-signaled [61.095512] Subtest multi-wait-all-available-signaled: SUCCESS (0.001s) [61.182623] [003/132] (957s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-gtt) [61.286663] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-gtt [61.290750] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [61.386196] [004/132] (957s left) kms_dirtyfb (fbc-dirtyfb-ioctl) [61.480593] Starting subtest: fbc-dirtyfb-ioctl [61.482804] Starting dynamic subtest: A-eDP-1 [64.132197] Dynamic subtest A-eDP-1: SUCCESS (2.656s) [64.134637] Subtest fbc-dirtyfb-ioctl: SUCCESS (2.657s) [65.007063] [005/132] (954s left) syncobj_timeline (etime-single-wait-all-for-submit-submitted) [65.070629] Starting subtest: etime-single-wait-all-for-submit-submitted [65.177965] Subtest etime-single-wait-all-for-submit-submitted: SUCCESS (0.104s) [65.266419] [006/132] (954s left) kms_psr (fbc-psr2-basic) [65.356663] Starting subtest: fbc-psr2-basic [65.358698] Starting dynamic subtest: eDP-1 [65.363028] Dynamic subtest eDP-1: SKIP (0.000s) [65.367333] Subtest fbc-psr2-basic: SKIP (0.000s) [65.439132] [007/132] (953s left) kms_cursor_edge_walk (128x128-top-edge) [65.538185] Starting subtest: 128x128-top-edge [65.540624] Starting dynamic subtest: pipe-A-eDP-1 [68.968385] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.432s) [68.979762] Starting dynamic subtest: pipe-D-eDP-1 [72.086930] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.120s) [72.089200] Subtest 128x128-top-edge: SUCCESS (6.554s) [72.905201] [008/132] (946s left) kms_psr (psr-suspend) [73.001727] Starting subtest: psr-suspend [73.003999] Starting dynamic subtest: eDP-1 [90.609351] Dynamic subtest eDP-1: SUCCESS (2.975s) [90.611748] Subtest psr-suspend: SUCCESS (2.975s) [91.452156] [009/132] (927s left) kms_cursor_crc (cursor-alpha-opaque) [91.578021] Starting subtest: cursor-alpha-opaque [91.579919] Starting dynamic subtest: pipe-A-eDP-1 [92.202152] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.634s) [92.210025] Starting dynamic subtest: pipe-D-eDP-1 [93.501637] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.312s) [93.503919] Subtest cursor-alpha-opaque: SUCCESS (1.948s) [94.297736] [010/132] (925s left) gem_exec_balancer (parallel-ordering) [94.562266] Starting subtest: parallel-ordering [95.493262] Subtest parallel-ordering: SUCCESS (0.942s) [95.602691] [011/132] (923s left) gem_userptr_blits (access-control) [95.678714] Starting subtest: access-control [95.683031] Subtest access-control: SKIP (0.000s) [95.777515] [012/132] (923s left) syncobj_wait (wait-all-for-submit-complex) [95.823679] Starting subtest: wait-all-for-submit-complex [96.037148] Subtest wait-all-for-submit-complex: SUCCESS (0.215s) [96.104905] [013/132] (923s left) kms_psr (pr-sprite-plane-onoff) [96.197486] Starting subtest: pr-sprite-plane-onoff [96.201787] Subtest pr-sprite-plane-onoff: SKIP (0.000s) [96.269383] [014/132] (923s left) kms_async_flips (async-flip-hang) [96.362441] Starting subtest: async-flip-hang [96.733772] Starting dynamic subtest: pipe-A-eDP-1 [112.080131] Dynamic subtest pipe-A-eDP-1: SUCCESS (15.396s) [112.474051] Starting dynamic subtest: pipe-B-eDP-1 [128.026970] Dynamic subtest pipe-B-eDP-1: SUCCESS (15.564s) [128.403309] Starting dynamic subtest: pipe-C-eDP-1 [144.020343] Dynamic subtest pipe-C-eDP-1: SUCCESS (15.624s) [144.414990] Starting dynamic subtest: pipe-D-eDP-1 [160.023059] Dynamic subtest pipe-D-eDP-1: SUCCESS (15.617s) [160.025999] Subtest async-flip-hang: SUCCESS (63.726s) [161.261903] [015/132] (858s left) kms_plane_lowres (tiling-y) [161.355521] Starting subtest: tiling-y [161.359700] Subtest tiling-y: SKIP (0.000s) [161.423320] [016/132] (858s left) i915_drm_fdinfo (busy) [161.462416] Starting subtest: busy [161.464377] Starting dynamic subtest: rcs0 [161.493738] Dynamic subtest rcs0: SKIP (0.029s) [161.501481] Starting dynamic subtest: bcs0 [161.505503] Dynamic subtest bcs0: SKIP (0.000s) [161.516075] Starting dynamic subtest: vcs0 [161.520597] Dynamic subtest vcs0: SKIP (0.000s) [161.528065] Starting dynamic subtest: vcs1 [161.531983] Dynamic subtest vcs1: SKIP (0.000s) [161.539218] Starting dynamic subtest: vecs0 [161.543250] Dynamic subtest vecs0: SKIP (0.000s) [161.551033] Starting dynamic subtest: ccs0 [161.554953] Dynamic subtest ccs0: SKIP (0.000s) [161.558832] Subtest busy: SKIP (0.032s) [161.591858] [017/132] (858s left) gem_userptr_blits (sync-unmap-cycles) [161.655792] Starting subtest: sync-unmap-cycles [167.023151] Subtest sync-unmap-cycles: SUCCESS (5.370s) [167.149678] [018/132] (852s left) kms_cursor_legacy (cursorb-vs-flipa-atomic-transitions) [167.272031] Starting subtest: cursorB-vs-flipA-atomic-transitions [167.275929] Subtest cursorB-vs-flipA-atomic-transitions: SKIP (0.001s) [167.416230] [019/132] (852s left) kms_ccs (crc-primary-basic-4-tiled-bmg-ccs) [167.494251] Starting subtest: crc-primary-basic-4-tiled-bmg-ccs [167.498057] Subtest crc-primary-basic-4-tiled-bmg-ccs: SKIP (0.000s) [168.583810] [020/132] (851s left) prime_vgem (basic-fence-flip) [168.727475] Starting subtest: basic-fence-flip [169.011915] Subtest basic-fence-flip: SUCCESS (0.285s) [169.111296] [FACT prime_vgem (basic-fence-flip)] new: kernel.kmod_is_loaded.vgem: true [169.114502] [021/132] (850s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt) [169.216187] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt [176.566274] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SUCCESS (7.356s) [176.691145] [022/132] (843s left) kms_prop_blob (invalid-get-prop) [176.741857] Starting subtest: invalid-get-prop [176.743839] Subtest invalid-get-prop: SUCCESS (0.000s) [176.853519] [023/132] (843s left) gem_exec_params (invalid-fence-in-submit) [176.919298] Starting subtest: invalid-fence-in-submit [176.923849] Subtest invalid-fence-in-submit: SUCCESS (0.003s) [177.049603] [024/132] (842s left) dmabuf_sync_file (export-before-signal) [177.085651] Starting subtest: export-before-signal [177.087499] Subtest export-before-signal: SUCCESS (0.001s) [177.138663] [025/132] (842s left) gem_unref_active_buffers [177.344786] [026/132] (842s left) gem_exec_whisper (basic-queues-all) [177.420645] Starting subtest: basic-queues-all [188.373094] Subtest basic-queues-all: SUCCESS (10.951s) [188.555069] [027/132] (831s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-plflip-blt) [188.655724] Starting subtest: psr-1p-primscrn-indfb-plflip-blt [196.079430] Subtest psr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.424s) [196.205412] [028/132] (823s left) kms_addfb_basic (no-handle) [196.274010] Starting subtest: no-handle [196.276353] Subtest no-handle: SUCCESS (0.000s) [196.404957] [029/132] (823s left) kms_chamelium_edid (dp-mode-timings) [196.794929] Subtest dp-mode-timings: SKIP (0.000s) [197.618133] [030/132] (822s left) kms_rotation_crc (bad-pixel-format) [197.703325] Starting subtest: bad-pixel-format [197.707437] Subtest bad-pixel-format: SKIP (0.001s) [197.777151] [031/132] (822s left) kms_flip (2x-flip-vs-panning) [197.875535] Starting subtest: 2x-flip-vs-panning [197.884539] Subtest 2x-flip-vs-panning: SKIP (0.011s) [197.964259] [032/132] (822s left) gem_render_copy (yf-tiled-ccs-to-yf-tiled) [198.018615] Starting subtest: yf-tiled-ccs-to-yf-tiled [198.022925] Subtest yf-tiled-ccs-to-yf-tiled: SKIP (0.000s) [198.201222] [033/132] (822s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-async-flip) [198.308007] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-async-flip [199.087976] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SUCCESS (0.781s) [199.248859] [034/132] (821s left) gem_exec_fence (invalid-timeline-fence-array) [199.798028] Starting subtest: invalid-timeline-fence-array [199.803762] Subtest invalid-timeline-fence-array: SUCCESS (0.006s) [201.628852] [035/132] (818s left) i915_pm_freq_api (freq-reset) [201.686700] Starting subtest: freq-reset [201.688931] Starting dynamic subtest: gt0 [201.889269] Dynamic subtest gt0: SUCCESS (0.201s) [201.899778] Starting dynamic subtest: gt1 [202.069156] Dynamic subtest gt1: SUCCESS (0.178s) [202.072123] Subtest freq-reset: SUCCESS (0.380s) [202.144027] [036/132] (818s left) gem_render_copy (y-tiled-ccs-to-y-tiled) [202.199410] Starting subtest: y-tiled-ccs-to-y-tiled [202.203956] Subtest y-tiled-ccs-to-y-tiled: SKIP (0.000s) [202.418263] [037/132] (818s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-rc-ccs) [202.512192] Starting subtest: crc-primary-suspend-4-tiled-mtl-rc-ccs [202.514171] Starting dynamic subtest: pipe-A-eDP-1 [219.376438] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.415s) [219.386472] Starting dynamic subtest: pipe-B-eDP-1 [236.356202] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.463s) [236.366637] Starting dynamic subtest: pipe-C-eDP-1 [253.340957] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.362s) [253.350372] Starting dynamic subtest: pipe-D-eDP-1 [270.334644] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.338s) [270.336856] Subtest crc-primary-suspend-4-tiled-mtl-rc-ccs: SUCCESS (8.583s) [271.549736] [038/132] (748s left) kms_cursor_crc (cursor-random-64x21) [271.772789] Starting subtest: cursor-random-64x21 [271.816447] Subtest cursor-random-64x21: SKIP (0.040s) [272.048659] [039/132] (748s left) gem_ctx_shared (q-smoketest) [272.126765] Starting subtest: Q-smoketest [272.129544] Starting dynamic subtest: rcs0 [277.639029] Dynamic subtest rcs0: SUCCESS (5.507s) [277.648624] Starting dynamic subtest: bcs0 [283.128468] Dynamic subtest bcs0: SUCCESS (5.513s) [283.138489] Starting dynamic subtest: vcs0 [288.594344] Dynamic subtest vcs0: SUCCESS (5.478s) [288.604020] Starting dynamic subtest: vcs1 [294.084844] Dynamic subtest vcs1: SUCCESS (5.486s) [294.095998] Starting dynamic subtest: vecs0 [299.556501] Dynamic subtest vecs0: SUCCESS (5.479s) [299.573276] Starting dynamic subtest: ccs0 [305.088172] Dynamic subtest ccs0: SUCCESS (5.524s) [305.090910] Subtest Q-smoketest: SUCCESS (32.993s) [305.226369] [040/132] (715s left) kms_ccs (random-ccs-data-4-tiled-dg2-rc-ccs) [305.330924] Starting subtest: random-ccs-data-4-tiled-dg2-rc-ccs [305.333551] Starting dynamic subtest: pipe-A-eDP-1 [305.361034] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [305.372635] Starting dynamic subtest: pipe-B-eDP-1 [305.400746] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [305.409609] Starting dynamic subtest: pipe-C-eDP-1 [305.437195] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [305.445677] Starting dynamic subtest: pipe-D-eDP-1 [305.475056] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [305.480704] Subtest random-ccs-data-4-tiled-dg2-rc-ccs: SKIP (0.004s) [307.631548] [041/132] (713s left) kms_selftest (drm_cmdline_parser) [307.667764] Starting subtest: drm_cmdline_parser [307.719372] Starting dynamic subtest: drm_test_cmdline_force_d_only [307.803853] Dynamic subtest drm_test_cmdline_force_d_only: SUCCESS (0.082s) [307.818897] Starting dynamic subtest: drm_test_cmdline_force_D_only_dvi [307.901865] Dynamic subtest drm_test_cmdline_force_D_only_dvi: SUCCESS (0.098s) [307.912826] Starting dynamic subtest: drm_test_cmdline_force_D_only_hdmi [308.003296] Dynamic subtest drm_test_cmdline_force_D_only_hdmi: SUCCESS (0.100s) [308.014052] Starting dynamic subtest: drm_test_cmdline_force_D_only_not_digital [308.096834] Dynamic subtest drm_test_cmdline_force_D_only_not_digital: SUCCESS (0.092s) [308.107646] Starting dynamic subtest: drm_test_cmdline_force_e_only [308.190458] Dynamic subtest drm_test_cmdline_force_e_only: SUCCESS (0.095s) [308.198901] Starting dynamic subtest: drm_test_cmdline_res [308.277047] Dynamic subtest drm_test_cmdline_res: SUCCESS (0.085s) [308.288537] Starting dynamic subtest: drm_test_cmdline_res_vesa [308.359768] Dynamic subtest drm_test_cmdline_res_vesa: SUCCESS (0.081s) [308.368257] Starting dynamic subtest: drm_test_cmdline_res_vesa_rblank [308.450185] Dynamic subtest drm_test_cmdline_res_vesa_rblank: SUCCESS (0.090s) [308.460058] Starting dynamic subtest: drm_test_cmdline_res_rblank [308.534814] Dynamic subtest drm_test_cmdline_res_rblank: SUCCESS (0.084s) [308.545577] Starting dynamic subtest: drm_test_cmdline_res_bpp [308.623251] Dynamic subtest drm_test_cmdline_res_bpp: SUCCESS (0.087s) [308.631638] Starting dynamic subtest: drm_test_cmdline_res_refresh [308.711602] Dynamic subtest drm_test_cmdline_res_refresh: SUCCESS (0.088s) [308.719683] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh [308.808468] Dynamic subtest drm_test_cmdline_res_bpp_refresh: SUCCESS (0.096s) [308.817662] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_interlaced [308.897985] Dynamic subtest drm_test_cmdline_res_bpp_refresh_interlaced: SUCCESS (0.087s) [308.906511] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_margins [308.987627] Dynamic subtest drm_test_cmdline_res_bpp_refresh_margins: SUCCESS (0.092s) [308.996877] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_off [309.085530] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_off: SUCCESS (0.095s) [309.097459] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on [309.176379] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on: SUCCESS (0.088s) [309.186043] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on_analog [309.256709] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on_analog: SUCCESS (0.082s) [309.266034] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on_digital [309.346468] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on_digital: SUCCESS (0.087s) [309.354584] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_interlaced_margins_force_on [309.429055] Dynamic subtest drm_test_cmdline_res_bpp_refresh_interlaced_margins_force_on: SUCCESS (0.084s) [309.437766] Starting dynamic subtest: drm_test_cmdline_res_margins_force_on [309.517671] Dynamic subtest drm_test_cmdline_res_margins_force_on: SUCCESS (0.086s) [309.527326] Starting dynamic subtest: drm_test_cmdline_res_vesa_margins [309.610375] Dynamic subtest drm_test_cmdline_res_vesa_margins: SUCCESS (0.092s) [309.619036] Starting dynamic subtest: drm_test_cmdline_name [309.712686] Dynamic subtest drm_test_cmdline_name: SUCCESS (0.100s) [309.724117] Starting dynamic subtest: drm_test_cmdline_name_bpp [309.839090] Dynamic subtest drm_test_cmdline_name_bpp: SUCCESS (0.123s) [309.849366] Starting dynamic subtest: drm_test_cmdline_name_option [309.925053] Dynamic subtest drm_test_cmdline_name_option: SUCCESS (0.087s) [309.935034] Starting dynamic subtest: drm_test_cmdline_name_bpp_option [310.004328] Dynamic subtest drm_test_cmdline_name_bpp_option: SUCCESS (0.079s) [310.013048] Starting dynamic subtest: drm_test_cmdline_rotate_0 [310.108453] Dynamic subtest drm_test_cmdline_rotate_0: SUCCESS (0.104s) [310.117544] Starting dynamic subtest: drm_test_cmdline_rotate_90 [310.203072] Dynamic subtest drm_test_cmdline_rotate_90: SUCCESS (0.093s) [310.212083] Starting dynamic subtest: drm_test_cmdline_rotate_180 [310.292951] Dynamic subtest drm_test_cmdline_rotate_180: SUCCESS (0.089s) [310.302695] Starting dynamic subtest: drm_test_cmdline_rotate_270 [310.388328] Dynamic subtest drm_test_cmdline_rotate_270: SUCCESS (0.093s) [310.397179] Starting dynamic subtest: drm_test_cmdline_hmirror [310.472812] Dynamic subtest drm_test_cmdline_hmirror: SUCCESS (0.085s) [310.481891] Starting dynamic subtest: drm_test_cmdline_vmirror [310.567196] Dynamic subtest drm_test_cmdline_vmirror: SUCCESS (0.092s) [310.576075] Starting dynamic subtest: drm_test_cmdline_margin_options [310.652874] Dynamic subtest drm_test_cmdline_margin_options: SUCCESS (0.084s) [310.662776] Starting dynamic subtest: drm_test_cmdline_multiple_options [310.740292] Dynamic subtest drm_test_cmdline_multiple_options: SUCCESS (0.088s) [310.749308] Starting dynamic subtest: drm_test_cmdline_bpp_extra_and_option [310.826696] Dynamic subtest drm_test_cmdline_bpp_extra_and_option: SUCCESS (0.086s) [310.837107] Starting dynamic subtest: drm_test_cmdline_extra_and_option [310.920472] Dynamic subtest drm_test_cmdline_extra_and_option: SUCCESS (0.094s) [310.929421] Starting dynamic subtest: drm_test_cmdline_freestanding_options [311.014940] Dynamic subtest drm_test_cmdline_freestanding_options: SUCCESS (0.093s) [311.025742] Starting dynamic subtest: drm_test_cmdline_freestanding_force_e_and_options [311.101814] Dynamic subtest drm_test_cmdline_freestanding_force_e_and_options: SUCCESS (0.084s) [311.111877] Starting dynamic subtest: drm_test_cmdline_panel_orientation [311.190409] Dynamic subtest drm_test_cmdline_panel_orientation: SUCCESS (0.088s) [311.201043] Starting dynamic subtest: drm_test_cmdline_invalid [311.300730] Dynamic subtest drm_test_cmdline_invalid: SUCCESS (0.110s) [311.310516] Starting dynamic subtest: drm_test_cmdline_tv_options [311.399773] Dynamic subtest drm_test_cmdline_tv_options: SUCCESS (0.099s) [311.401983] Subtest drm_cmdline_parser: SUCCESS (3.734s) [311.539673] [042/132] (709s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf) [311.647302] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf [311.649226] Starting dynamic subtest: pipe-A-eDP-1 [311.743617] Dynamic subtest pipe-A-eDP-1: SKIP (0.099s) [311.753422] Starting dynamic subtest: pipe-B-eDP-1 [312.899645] Dynamic subtest pipe-B-eDP-1: SKIP (1.153s) [312.904492] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf: SKIP (1.255s) [314.077651] [043/132] (706s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs) [314.175901] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs [314.178202] Starting dynamic subtest: pipe-A-eDP-1 [314.904669] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.719s) [314.913646] Starting dynamic subtest: pipe-B-eDP-1 [316.677968] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.772s) [316.687024] Starting dynamic subtest: pipe-C-eDP-1 [318.420113] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.740s) [318.431071] Starting dynamic subtest: pipe-D-eDP-1 [320.153643] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.734s) [320.155968] Subtest random-ccs-data-4-tiled-mtl-rc-ccs: SUCCESS (5.970s) [321.300789] [044/132] (699s left) gem_exec_schedule (reorder-wide) [321.483858] Subtest reorder-wide: SKIP (0.000s) [321.666412] [045/132] (699s left) kms_plane (pixel-format-linear-modifier-source-clamping) [321.764521] Starting subtest: pixel-format-linear-modifier-source-clamping [321.793316] Starting dynamic subtest: pipe-A-plane-0 [325.513983] Dynamic subtest pipe-A-plane-0: SUCCESS (3.722s) [325.524974] Starting dynamic subtest: pipe-A-plane-3 [327.236037] Dynamic subtest pipe-A-plane-3: SUCCESS (1.720s) [328.391034] Starting dynamic subtest: pipe-B-plane-0 [332.093440] Dynamic subtest pipe-B-plane-0: SUCCESS (3.711s) [332.104352] Starting dynamic subtest: pipe-B-plane-3 [334.037883] Dynamic subtest pipe-B-plane-3: SUCCESS (1.944s) [334.348597] Subtest pixel-format-linear-modifier-source-clamping: SUCCESS (12.584s) [335.153798] [046/132] (685s left) gem_render_copy (y-tiled-to-vebox-yf-tiled) [335.219067] Starting subtest: y-tiled-to-vebox-yf-tiled [335.224899] Subtest y-tiled-to-vebox-yf-tiled: SKIP (0.000s) [335.402171] [047/132] (685s left) gem_mmap_wc (read-write-distinct) [335.457622] Subtest read-write-distinct: SKIP (0.000s) [335.518842] [048/132] (685s left) gem_exec_whisper (basic-fds) [335.580722] Starting subtest: basic-fds [341.377638] Subtest basic-fds: SUCCESS (5.799s) [341.558402] [049/132] (679s left) gem_create (create-ext-placement-each) [341.728073] Starting subtest: create-ext-placement-each [341.730834] Subtest create-ext-placement-each: SUCCESS (0.000s) [341.849513] [050/132] (679s left) gem_softpin (overlap) [341.908965] Starting subtest: overlap [342.777025] Subtest overlap: SUCCESS (0.867s) [342.890554] [051/132] (678s left) sysfs_timeslice_duration (idempotent) [342.949485] Starting subtest: idempotent [342.951892] Starting dynamic subtest: vecs0 [342.954582] Dynamic subtest vecs0: SUCCESS (0.000s) [342.963776] Starting dynamic subtest: ccs0 [342.966041] Dynamic subtest ccs0: SUCCESS (0.000s) [342.974758] Starting dynamic subtest: vcs0 [342.977125] Dynamic subtest vcs0: SUCCESS (0.000s) [342.985524] Starting dynamic subtest: bcs0 [342.987785] Dynamic subtest bcs0: SUCCESS (0.000s) [342.996214] Starting dynamic subtest: rcs0 [342.998476] Dynamic subtest rcs0: SUCCESS (0.000s) [343.007455] Starting dynamic subtest: vcs1 [343.009908] Dynamic subtest vcs1: SUCCESS (0.000s) [343.012659] Subtest idempotent: SUCCESS (0.006s) [343.074105] [052/132] (678s left) gem_exec_flush (basic-uc-ro-default) [343.136172] Starting subtest: basic-uc-ro-default [348.599564] Subtest basic-uc-ro-default: SUCCESS (5.465s) [348.791439] [053/132] (672s left) kms_pipe_b_c_ivb (pipe-b-double-modeset-then-modeset-pipe-c) [348.855857] Subtest pipe-B-double-modeset-then-modeset-pipe-C: SKIP (0.000s) [348.921880] [054/132] (672s left) prime_mmap (test_refcounting) [348.976648] Starting subtest: test_refcounting [348.978922] Starting dynamic subtest: test_refcounting-smem [349.005884] Dynamic subtest test_refcounting-smem: SUCCESS (0.030s) [349.008798] Subtest test_refcounting: SUCCESS (0.031s) [349.113319] [055/132] (672s left) kms_joiner (invalid-modeset-ultra-joiner) [349.224360] Starting subtest: invalid-modeset-ultra-joiner [349.229468] Subtest invalid-modeset-ultra-joiner: SKIP (0.000s) [349.290444] [056/132] (672s left) gem_sync (basic-each) [349.367294] Starting subtest: basic-each [351.599036] Subtest basic-each: SUCCESS (2.246s) [351.796776] [057/132] (669s left) gem_exec_balancer (noheartbeat) [352.053186] Starting subtest: noheartbeat [352.059518] Subtest noheartbeat: SKIP (0.000s) [352.162923] [058/132] (669s left) syncobj_wait (single-wait-for-submit-submitted) [352.208947] Starting subtest: single-wait-for-submit-submitted [352.313419] Subtest single-wait-for-submit-submitted: SUCCESS (0.104s) [352.410303] [059/132] (669s left) gem_madvise (dontneed-before-mmap) [352.447036] Starting subtest: dontneed-before-mmap [352.467087] Subtest dontneed-before-mmap: SUCCESS (0.023s) [352.570720] [060/132] (668s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-move) [352.678392] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-move [352.683270] Subtest fbcpsr-2p-scndscrn-cur-indfb-move: SKIP (0.000s) [352.762809] [061/132] (668s left) prime_mmap (test_dup) [352.824057] Starting subtest: test_dup [352.826945] Starting dynamic subtest: test_dup-smem [352.854412] Dynamic subtest test_dup-smem: SUCCESS (0.032s) [352.857037] Subtest test_dup: SUCCESS (0.033s) [352.928021] [062/132] (668s left) gem_mmap_gtt (cpuset-big-copy-odd) [352.986034] Subtest cpuset-big-copy-odd: SKIP (0.000s) [353.059847] [063/132] (668s left) perf_pmu (busy-double-start) [353.101488] Starting subtest: busy-double-start [353.103871] Starting dynamic subtest: rcs0 [356.750962] Dynamic subtest rcs0: FAIL (3.584s) [356.760983] Starting dynamic subtest: bcs0 [360.252281] Dynamic subtest bcs0: SUCCESS (3.570s) [360.263958] Starting dynamic subtest: vcs0 [364.422405] Dynamic subtest vcs0: SUCCESS (4.169s) [364.434653] Starting dynamic subtest: vcs1 [368.372068] Dynamic subtest vcs1: SUCCESS (3.947s) [368.383828] Starting dynamic subtest: vecs0 [372.424560] Dynamic subtest vecs0: SUCCESS (4.049s) [372.435883] Starting dynamic subtest: ccs0 [376.064725] Dynamic subtest ccs0: FAIL (3.565s) [376.066910] Subtest busy-double-start: FAIL (22.895s) [376.113509] [064/132] (645s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-submitted) [376.172269] Starting subtest: multi-wait-all-for-submit-unsubmitted-submitted [376.272142] Subtest multi-wait-all-for-submit-unsubmitted-submitted: SUCCESS (0.101s) [376.352123] [065/132] (645s left) gem_fenced_exec_thrash (no-spare-fences-interruptible) [376.412928] Subtest no-spare-fences-interruptible: SKIP (0.000s) [376.485133] [066/132] (645s left) gen9_exec_parse (allowed-single) [376.547685] Subtest allowed-single: SKIP (0.000s) [376.615762] [067/132] (645s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted-signaled) [376.669676] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled [376.672293] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.000s) [376.764935] [068/132] (645s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-20x20) [376.859823] Starting subtest: planes-downscale-factor-0-75-upscale-20x20 [376.862599] Starting dynamic subtest: pipe-A [376.923100] Dynamic subtest pipe-A: SUCCESS (0.065s) [376.933577] Starting dynamic subtest: pipe-B [378.072215] Dynamic subtest pipe-B: SUCCESS (1.148s) [378.081652] Starting dynamic subtest: pipe-C [379.186698] Dynamic subtest pipe-C: SUCCESS (1.112s) [379.195970] Starting dynamic subtest: pipe-D [380.328636] Dynamic subtest pipe-D: SUCCESS (1.141s) [380.331201] Subtest planes-downscale-factor-0-75-upscale-20x20: SUCCESS (3.471s) [381.469741] [069/132] (640s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-cpu) [381.568841] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-cpu [381.573966] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s) [381.652292] [070/132] (640s left) syncobj_eventfd (invalid-bad-flags) [381.708206] Starting subtest: invalid-bad-flags [381.710938] Subtest invalid-bad-flags: SUCCESS (0.000s) [381.802732] [071/132] (640s left) kms_busy (extended-modeset-hang-newfb-with-reset) [381.915683] Starting subtest: extended-modeset-hang-newfb-with-reset [381.917819] Starting dynamic subtest: pipe-A [396.035332] Dynamic subtest pipe-A: SUCCESS (14.119s) [396.046613] Starting dynamic subtest: pipe-D [411.537886] Dynamic subtest pipe-D: SUCCESS (15.501s) [411.540786] Subtest extended-modeset-hang-newfb-with-reset: SUCCESS (29.625s) [412.354067] [072/132] (609s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip) [412.453324] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip [412.458839] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SKIP (0.000s) [412.544624] [073/132] (609s left) syncobj_timeline (multi-wait-available-unsubmitted-submitted) [412.609304] Starting subtest: multi-wait-available-unsubmitted-submitted [412.611783] Subtest multi-wait-available-unsubmitted-submitted: SUCCESS (0.000s) [412.724606] [074/132] (609s left) kms_big_fb (4-tiled-8bpp-rotate-0) [412.827327] Starting subtest: 4-tiled-8bpp-rotate-0 [414.108970] Subtest 4-tiled-8bpp-rotate-0: SUCCESS (1.283s) [414.232221] [075/132] (607s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180) [414.326566] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180 [414.330695] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s) [414.419956] [076/132] (607s left) kms_chamelium_hpd (hdmi-hpd-storm-disable) [414.797046] Subtest hdmi-hpd-storm-disable: SKIP (0.000s) [415.579339] [077/132] (606s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-downscaling) [415.677118] Starting subtest: flip-64bpp-ytile-to-16bpp-ytile-downscaling [415.682706] Subtest flip-64bpp-ytile-to-16bpp-ytile-downscaling: SKIP (0.000s) [415.751606] [078/132] (606s left) gem_exec_gttfill (basic) [415.818859] Starting subtest: basic [418.505861] Subtest basic: SUCCESS (2.687s) [418.698793] [079/132] (603s left) gem_exec_schedule (preempt-hang) [418.937556] Starting subtest: preempt-hang [418.940189] Starting dynamic subtest: rcs0 [419.198753] Dynamic subtest rcs0: SUCCESS (0.261s) [419.209720] Starting dynamic subtest: bcs0 [419.448596] Dynamic subtest bcs0: SUCCESS (0.246s) [419.457762] Starting dynamic subtest: vcs0 [419.673789] Dynamic subtest vcs0: SUCCESS (0.225s) [419.683938] Starting dynamic subtest: vcs1 [419.908916] Dynamic subtest vcs1: SUCCESS (0.234s) [419.919441] Starting dynamic subtest: vecs0 [420.133656] Dynamic subtest vecs0: SUCCESS (0.224s) [420.143597] Starting dynamic subtest: ccs0 [420.380098] Dynamic subtest ccs0: SUCCESS (0.248s) [420.382734] Subtest preempt-hang: SUCCESS (1.444s) [420.941035] [080/132] (601s left) kms_vblank (query-idle) [421.043777] Starting subtest: query-idle [421.045950] Starting dynamic subtest: pipe-A-eDP-1 [422.799614] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.755s) [422.819043] Starting dynamic subtest: pipe-D-eDP-1 [425.234758] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.434s) [425.237739] Subtest query-idle: SUCCESS (4.194s) [426.053420] [081/132] (596s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt) [426.148809] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt [426.152950] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [426.280689] [082/132] (596s left) kms_flip (2x-flip-vs-dpms-on-nop) [426.375057] Starting subtest: 2x-flip-vs-dpms-on-nop [426.383699] Subtest 2x-flip-vs-dpms-on-nop: SKIP (0.011s) [426.463150] [083/132] (596s left) gem_busy (parallel) [426.651099] Starting subtest: parallel [426.653970] Starting dynamic subtest: rcs0 [427.893257] Dynamic subtest rcs0: SUCCESS (1.242s) [427.905153] Starting dynamic subtest: bcs0 [429.875936] Dynamic subtest bcs0: SUCCESS (1.981s) [429.888514] Starting dynamic subtest: vcs0 [431.861859] Dynamic subtest vcs0: SUCCESS (1.982s) [431.874040] Starting dynamic subtest: vcs1 [433.846037] Dynamic subtest vcs1: SUCCESS (1.981s) [433.858956] Starting dynamic subtest: vecs0 [435.892460] Dynamic subtest vecs0: SUCCESS (2.044s) [435.906247] Starting dynamic subtest: ccs0 [437.877226] Dynamic subtest ccs0: SUCCESS (1.982s) [437.880021] Subtest parallel: SUCCESS (11.230s) [438.122447] [084/132] (584s left) kms_frontbuffer_tracking (fbcpsr-shrfb-scaledprimary) [438.216070] Starting subtest: fbcpsr-shrfb-scaledprimary [445.095023] Subtest fbcpsr-shrfb-scaledprimary: SUCCESS (6.884s) [445.234848] [085/132] (577s left) i915_pm_rps (min-max-config-loaded) [445.296504] Starting subtest: min-max-config-loaded [445.300947] Subtest min-max-config-loaded: SKIP (0.000s) [445.397546] [086/132] (577s left) kms_content_protection (legacy) [445.531049] Starting subtest: legacy [445.536865] Subtest legacy: SKIP (0.000s) [445.665445] [087/132] (576s left) perf (stress-open-close) [445.816788] Starting subtest: stress-open-close [445.819576] Starting dynamic subtest: 0-rcs0 [447.981783] Dynamic subtest 0-rcs0: SUCCESS (2.167s) [447.991715] Starting dynamic subtest: 1-vecs0 [450.145354] Dynamic subtest 1-vecs0: SUCCESS (2.163s) [450.147781] Subtest stress-open-close: SUCCESS (4.332s) [450.193102] [088/132] (572s left) gem_mmap_wc (bad-object) [450.248920] Subtest bad-object: SKIP (0.000s) [450.308323] [089/132] (572s left) kms_color_pipeline (plane-lut1d-ctm3x4) [450.403888] Starting subtest: plane-lut1d-ctm3x4 [450.550019] Starting dynamic subtest: pipe-A-plane-0 [450.872425] Dynamic subtest pipe-A-plane-0: FAIL (0.168s) [450.881392] Starting dynamic subtest: pipe-A-plane-1 [451.069486] Dynamic subtest pipe-A-plane-1: FAIL (0.161s) [451.078766] Starting dynamic subtest: pipe-A-plane-2 [451.318637] Dynamic subtest pipe-A-plane-2: FAIL (0.178s) [452.310329] Starting dynamic subtest: pipe-B-plane-0 [452.770644] Dynamic subtest pipe-B-plane-0: FAIL (0.141s) [452.780269] Starting dynamic subtest: pipe-B-plane-1 [453.144798] Dynamic subtest pipe-B-plane-1: FAIL (0.166s) [453.154884] Starting dynamic subtest: pipe-B-plane-2 [453.500436] Dynamic subtest pipe-B-plane-2: FAIL (0.700s) [454.541293] Starting dynamic subtest: pipe-C-plane-0 [455.102976] Dynamic subtest pipe-C-plane-0: FAIL (0.152s) [455.114034] Starting dynamic subtest: pipe-C-plane-1 [455.543576] Dynamic subtest pipe-C-plane-1: FAIL (0.686s) [455.555562] Starting dynamic subtest: pipe-C-plane-2 [455.962985] Dynamic subtest pipe-C-plane-2: FAIL (0.160s) [456.783685] Starting dynamic subtest: pipe-D-plane-0 [457.444075] Dynamic subtest pipe-D-plane-0: FAIL (0.129s) [457.455609] Starting dynamic subtest: pipe-D-plane-1 [457.980680] Dynamic subtest pipe-D-plane-1: FAIL (0.688s) [457.991611] Starting dynamic subtest: pipe-D-plane-2 [458.486456] Dynamic subtest pipe-D-plane-2: FAIL (0.610s) [458.503560] Subtest plane-lut1d-ctm3x4: FAIL (8.102s) [459.338156] [090/132] (563s left) kms_lease (empty-lease) [459.435499] Starting subtest: empty-lease [459.437961] Starting dynamic subtest: pipe-A-eDP-1 [459.440522] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s) [459.451036] Starting dynamic subtest: pipe-B-eDP-1 [459.453753] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [459.463612] Starting dynamic subtest: pipe-C-eDP-1 [459.465979] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s) [459.475312] Starting dynamic subtest: pipe-D-eDP-1 [459.477911] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s) [459.480609] Subtest empty-lease: SUCCESS (0.009s) [459.558602] [091/132] (563s left) gem_ctx_persistence (legacy-engines-cleanup) [459.613907] Starting subtest: legacy-engines-cleanup [459.616892] Starting dynamic subtest: render [459.680947] Dynamic subtest render: SUCCESS (0.066s) [459.694068] Starting dynamic subtest: bsd1 [459.725853] Dynamic subtest bsd1: SUCCESS (0.043s) [459.738742] Starting dynamic subtest: bsd2 [459.770248] Dynamic subtest bsd2: SUCCESS (0.043s) [459.782686] Starting dynamic subtest: blt [459.814389] Dynamic subtest blt: SUCCESS (0.042s) [459.825848] Starting dynamic subtest: vebox [459.854344] Dynamic subtest vebox: SUCCESS (0.037s) [459.857207] Subtest legacy-engines-cleanup: SUCCESS (0.240s) [459.933335] [092/132] (562s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-cpu) [460.022863] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-cpu [466.647678] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-cpu: SUCCESS (6.630s) [466.761913] [093/132] (556s left) kms_fb_coherency (memset-crc) [466.849521] Starting subtest: memset-crc [466.852328] Starting dynamic subtest: mmap-offset-wc [467.310819] Dynamic subtest mmap-offset-wc: SUCCESS (0.464s) [467.607590] Starting dynamic subtest: mmap-offset-uc [473.664644] Dynamic subtest mmap-offset-uc: SUCCESS (6.069s) [473.953038] Subtest memset-crc: SUCCESS (7.108s) [474.819755] [094/132] (548s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-wc) [474.917492] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-wc [478.871051] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-wc: SUCCESS (3.960s) [480.026533] [095/132] (542s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-gtt) [480.128718] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-gtt [480.133837] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [480.228499] [096/132] (542s left) kms_big_fb (yf-tiled-16bpp-rotate-180) [480.337671] Starting subtest: yf-tiled-16bpp-rotate-180 [480.342700] Subtest yf-tiled-16bpp-rotate-180: SKIP (0.000s) [480.442061] [097/132] (542s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs) [480.536483] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs [480.538535] Starting dynamic subtest: pipe-A-eDP-1 [480.673296] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.129s) [480.685374] Starting dynamic subtest: pipe-B-eDP-1 [480.707553] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [480.717036] Starting dynamic subtest: pipe-C-eDP-1 [480.738195] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.002s) [480.747219] Starting dynamic subtest: pipe-D-eDP-1 [480.767738] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.002s) [480.769964] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs: SUCCESS (0.138s) [482.981277] [098/132] (540s left) gem_exec_flush (basic-batch-kernel-default-wb) [483.055359] Starting subtest: basic-batch-kernel-default-wb [490.611937] Subtest basic-batch-kernel-default-wb: SUCCESS (7.560s) [490.807805] [099/132] (532s left) syncobj_timeline (wait-all-delayed-signal) [490.862888] Starting subtest: wait-all-delayed-signal [490.963495] Subtest wait-all-delayed-signal: SUCCESS (0.102s) [491.060306] [100/132] (532s left) kms_frontbuffer_tracking (fbcpsr-tiling-linear) [491.158658] Starting subtest: fbcpsr-tiling-linear [497.764924] Subtest fbcpsr-tiling-linear: SUCCESS (6.611s) [497.890965] [101/132] (525s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-cpu) [497.986287] Starting subtest: fbc-rgb565-draw-mmap-cpu [502.023949] Subtest fbc-rgb565-draw-mmap-cpu: SUCCESS (4.042s) [503.224409] [102/132] (520s left) api_intel_bb (reset-flags) [503.288383] Starting subtest: reset-flags [503.297050] Subtest reset-flags: SUCCESS (0.012s) [503.415649] [103/132] (519s left) gem_watchdog (default-physical) [503.485440] Starting subtest: default-physical [505.242577] Subtest default-physical: SUCCESS (1.770s) [505.327717] [104/132] (517s left) kms_flip (2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible) [505.438859] Starting subtest: 2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible [505.449127] Subtest 2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible: SKIP (0.010s) [505.526896] [105/132] (517s left) kms_atomic_transition (plane-all-transition-nonblocking) [505.630074] Starting subtest: plane-all-transition-nonblocking [505.632481] Starting dynamic subtest: pipe-A-eDP-1 [508.122541] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.494s) [508.428905] Starting dynamic subtest: pipe-B-eDP-1 [511.647536] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.228s) [511.943496] Subtest plane-all-transition-nonblocking: SUCCESS (6.317s) [512.765503] [106/132] (510s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt) [512.876692] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt [512.881940] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [512.971828] [107/132] (510s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-blt) [513.076339] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-blt [513.080855] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s) [513.163890] [108/132] (510s left) gem_exec_reloc (basic-wc-gtt) [513.225911] Subtest basic-wc-gtt: SKIP (0.000s) [513.304378] [109/132] (510s left) kms_big_fb (x-tiled-32bpp-rotate-90) [513.404742] Starting subtest: x-tiled-32bpp-rotate-90 [513.423910] Subtest x-tiled-32bpp-rotate-90: SKIP (0.019s) [513.542781] [110/132] (510s left) gem_mmap_gtt (isolation) [513.608477] Subtest isolation: SKIP (0.000s) [513.672395] [111/132] (509s left) kms_pipe_crc_basic (suspend-read-crc) [513.765776] Starting subtest: suspend-read-crc [513.767902] Starting dynamic subtest: pipe-A-eDP-1 [532.027911] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.495s) [532.038347] Starting dynamic subtest: pipe-B-eDP-1 [550.065043] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.096s) [550.075198] Starting dynamic subtest: pipe-C-eDP-1 [568.024573] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.121s) [568.035187] Starting dynamic subtest: pipe-D-eDP-1 [586.013000] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.054s) [586.015363] Subtest suspend-read-crc: SUCCESS (11.772s) [586.827800] [112/132] (436s left) kms_psr (psr-cursor-mmap-gtt) [586.927264] Starting subtest: psr-cursor-mmap-gtt [586.929616] Starting dynamic subtest: eDP-1 [588.614655] Dynamic subtest eDP-1: SUCCESS (1.703s) [588.616555] Subtest psr-cursor-mmap-gtt: SUCCESS (1.704s) [589.459646] [113/132] (434s left) gem_ctx_persistence (engines-cleanup) [589.514456] Starting subtest: engines-cleanup [589.516472] Starting dynamic subtest: rcs0 [589.577184] Dynamic subtest rcs0: SUCCESS (0.064s) [589.590355] Starting dynamic subtest: bcs0 [589.595206] Dynamic subtest bcs0: SUCCESS (0.015s) [589.604417] Starting dynamic subtest: vcs0 [589.657353] Dynamic subtest vcs0: SUCCESS (0.064s) [589.669623] Starting dynamic subtest: vcs1 [589.690313] Dynamic subtest vcs1: SUCCESS (0.031s) [589.702237] Starting dynamic subtest: vecs0 [589.725225] Dynamic subtest vecs0: SUCCESS (0.034s) [589.734898] Starting dynamic subtest: ccs0 [589.763318] Dynamic subtest ccs0: SUCCESS (0.036s) [589.765588] Subtest engines-cleanup: SUCCESS (0.253s) [589.856858] [114/132] (433s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc) [589.945805] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc [589.949984] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s) [590.026794] [115/132] (433s left) kms_plane (plane-position-hole-dpms) [590.119964] Starting subtest: plane-position-hole-dpms [590.621326] Starting dynamic subtest: pipe-A-plane-1 [593.007134] Dynamic subtest pipe-A-plane-1: SUCCESS (2.399s) [593.019891] Starting dynamic subtest: pipe-A-plane-2 [595.363173] Dynamic subtest pipe-A-plane-2: SUCCESS (2.366s) [595.378367] Starting dynamic subtest: pipe-A-plane-3 [597.707640] Dynamic subtest pipe-A-plane-3: SUCCESS (2.350s) [597.717494] Starting dynamic subtest: pipe-A-plane-4 [600.065294] Dynamic subtest pipe-A-plane-4: SUCCESS (2.367s) [600.076003] Starting dynamic subtest: pipe-A-plane-5 [600.092322] Dynamic subtest pipe-A-plane-5: SUCCESS (0.025s) [601.264782] Starting dynamic subtest: pipe-B-plane-1 [603.690657] Dynamic subtest pipe-B-plane-1: SUCCESS (2.439s) [603.701608] Starting dynamic subtest: pipe-B-plane-2 [606.031321] Dynamic subtest pipe-B-plane-2: SUCCESS (2.344s) [606.046273] Starting dynamic subtest: pipe-B-plane-3 [608.396245] Dynamic subtest pipe-B-plane-3: SUCCESS (2.364s) [608.406163] Starting dynamic subtest: pipe-B-plane-4 [610.753040] Dynamic subtest pipe-B-plane-4: SUCCESS (2.360s) [610.764183] Starting dynamic subtest: pipe-B-plane-5 [610.778098] Dynamic subtest pipe-B-plane-5: SUCCESS (0.023s) [610.780395] Subtest plane-position-hole-dpms: SUCCESS (20.718s) [611.575545] [116/132] (412s left) kms_psr (fbc-psr2-sprite-plane-onoff) [611.665617] Starting subtest: fbc-psr2-sprite-plane-onoff [611.668000] Starting dynamic subtest: eDP-1 [611.672398] Dynamic subtest eDP-1: SKIP (0.000s) [611.676914] Subtest fbc-psr2-sprite-plane-onoff: SKIP (0.001s) [611.739620] [117/132] (412s left) kms_pm_dc (dc5-psr) [612.841120] Starting subtest: dc5-psr [616.615174] Subtest dc5-psr: SUCCESS (3.773s) [616.986711] [118/132] (406s left) syncobj_wait (single-wait-signaled) [617.059747] Starting subtest: single-wait-signaled [617.062119] Subtest single-wait-signaled: SUCCESS (0.000s) [617.171108] [119/132] (406s left) syncobj_wait (invalid-multi-wait-all-unsubmitted) [617.241796] Starting subtest: invalid-multi-wait-all-unsubmitted [617.244238] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s) [617.365553] [120/132] (406s left) api_intel_bb (blit-reloc-purge-cache) [617.413049] Starting subtest: blit-reloc-purge-cache [617.417276] Subtest blit-reloc-purge-cache: SKIP (0.000s) [617.545926] [121/132] (406s left) i915_suspend (basic-s3-without-i915) [617.580731] Starting subtest: basic-s3-without-i915 [620.821273] Subtest basic-s3-without-i915: SKIP (3.233s) [622.425407] [122/132] (401s left) perf_pmu (multi-client) [622.473980] Starting subtest: multi-client [622.476209] Starting dynamic subtest: rcs0 [623.560811] Dynamic subtest rcs0: SUCCESS (1.084s) [623.572261] Starting dynamic subtest: bcs0 [624.611901] Dynamic subtest bcs0: SUCCESS (1.048s) [624.623627] Starting dynamic subtest: vcs0 [625.663458] Dynamic subtest vcs0: SUCCESS (1.048s) [625.673999] Starting dynamic subtest: vcs1 [627.477534] Dynamic subtest vcs1: SUCCESS (1.811s) [627.487906] Starting dynamic subtest: vecs0 [629.461475] Dynamic subtest vecs0: SUCCESS (1.982s) [629.471095] Starting dynamic subtest: ccs0 [631.449976] Dynamic subtest ccs0: SUCCESS (1.985s) [631.452735] Subtest multi-client: SUCCESS (8.975s) [631.567466] [123/132] (392s left) drm_read (empty-block) [631.731564] Starting subtest: empty-block [632.730138] Subtest empty-block: SUCCESS (1.000s) [632.853384] [124/132] (391s left) kms_flip (flip-vs-fences-interruptible) [632.953039] Starting subtest: flip-vs-fences-interruptible [632.957844] Subtest flip-vs-fences-interruptible: SKIP (0.000s) [633.055619] [125/132] (391s left) kms_flip (2x-flip-vs-dpms-off-vs-modeset-interruptible) [633.148594] Starting subtest: 2x-flip-vs-dpms-off-vs-modeset-interruptible [633.159912] Subtest 2x-flip-vs-dpms-off-vs-modeset-interruptible: SKIP (0.010s) [633.240316] [126/132] (391s left) kms_psr (fbc-pr-cursor-plane-move) [633.323814] Starting subtest: fbc-pr-cursor-plane-move [633.328298] Subtest fbc-pr-cursor-plane-move: SKIP (0.000s) [633.395818] [127/132] (390s left) kms_cursor_legacy (cursorb-vs-flipa-legacy) [633.519229] Starting subtest: cursorB-vs-flipA-legacy [633.523644] Subtest cursorB-vs-flipA-legacy: SKIP (0.001s) [633.675568] [128/132] (390s left) kms_pipe_crc_basic (bad-source) [633.762156] Starting subtest: bad-source [633.763991] Subtest bad-source: SUCCESS (0.000s) [633.832179] [129/132] (390s left) kms_flip (2x-flip-vs-absolute-wf_vblank) [633.921873] Starting subtest: 2x-flip-vs-absolute-wf_vblank [633.933374] Subtest 2x-flip-vs-absolute-wf_vblank: SKIP (0.012s) [634.012117] [130/132] (390s left) kms_atomic (plane-primary-legacy) [634.101570] Starting subtest: plane-primary-legacy [634.103793] Starting dynamic subtest: pipe-A-eDP-1 [634.561188] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.457s) [634.563046] Subtest plane-primary-legacy: SUCCESS (0.458s) [635.437260] [131/132] (389s left) gem_ctx_param (set-priority-invalid-size) [635.492891] Starting subtest: set-priority-invalid-size [635.495812] Subtest set-priority-invalid-size: SUCCESS (0.000s) [635.566204] [132/132] (388s left) gem_ctx_param (invalid-size-set) [635.627521] Starting subtest: invalid-size-set [635.629525] Subtest invalid-size-set: SUCCESS (0.001s) [635.724620] Closing watchdogs results: parsing output: 0/ for test: gem_softpin results: parsing output: 1/ for test: syncobj_timeline results: parsing output: 2/ for test: kms_frontbuffer_tracking results: parsing output: 3/ for test: kms_dirtyfb results: parsing output: 4/ for test: syncobj_timeline results: parsing output: 5/ for test: kms_psr results: parsing output: 6/ for test: kms_cursor_edge_walk results: parsing output: 7/ for test: kms_psr results: parsing output: 8/ for test: kms_cursor_crc results: parsing output: 9/ for test: gem_exec_balancer results: parsing output: 10/ for test: gem_userptr_blits results: parsing output: 11/ for test: syncobj_wait results: parsing output: 12/ for test: kms_psr results: parsing output: 13/ for test: kms_async_flips results: parsing output: 14/ for test: kms_plane_lowres results: parsing output: 15/ for test: i915_drm_fdinfo results: parsing output: 16/ for test: gem_userptr_blits results: parsing output: 17/ for test: kms_cursor_legacy results: parsing output: 18/ for test: kms_ccs results: parsing output: 19/ for test: prime_vgem results: parsing output: 20/ for test: kms_frontbuffer_tracking results: parsing output: 21/ for test: kms_prop_blob results: parsing output: 22/ for test: gem_exec_params results: parsing output: 23/ for test: dmabuf_sync_file results: parsing output: 24/ for test: gem_unref_active_buffers results: parsing output: 25/ for test: gem_exec_whisper results: parsing output: 26/ for test: kms_frontbuffer_tracking results: parsing output: 27/ for test: kms_addfb_basic results: parsing output: 28/ for test: kms_chamelium_edid results: parsing output: 29/ for test: kms_rotation_crc results: parsing output: 30/ for test: kms_flip results: parsing output: 31/ for test: gem_render_copy results: parsing output: 32/ for test: kms_big_fb results: parsing output: 33/ for test: gem_exec_fence results: parsing output: 34/ for test: i915_pm_freq_api results: parsing output: 35/ for test: gem_render_copy results: parsing output: 36/ for test: kms_ccs results: parsing output: 37/ for test: kms_cursor_crc results: parsing output: 38/ for test: gem_ctx_shared results: parsing output: 39/ for test: kms_ccs results: parsing output: 40/ for test: kms_selftest results: parsing output: 41/ for test: kms_psr2_sf results: parsing output: 42/ for test: kms_ccs results: parsing output: 43/ for test: gem_exec_schedule results: parsing output: 44/ for test: kms_plane results: parsing output: 45/ for test: gem_render_copy results: parsing output: 46/ for test: gem_mmap_wc results: parsing output: 47/ for test: gem_exec_whisper results: parsing output: 48/ for test: gem_create results: parsing output: 49/ for test: gem_softpin results: parsing output: 50/ for test: sysfs_timeslice_duration results: parsing output: 51/ for test: gem_exec_flush results: parsing output: 52/ for test: kms_pipe_b_c_ivb results: parsing output: 53/ for test: prime_mmap results: parsing output: 54/ for test: kms_joiner results: parsing output: 55/ for test: gem_sync results: parsing output: 56/ for test: gem_exec_balancer results: parsing output: 57/ for test: syncobj_wait results: parsing output: 58/ for test: gem_madvise results: parsing output: 59/ for test: kms_frontbuffer_tracking results: parsing output: 60/ for test: prime_mmap results: parsing output: 61/ for test: gem_mmap_gtt results: parsing output: 62/ for test: perf_pmu results: parsing output: 63/ for test: syncobj_wait results: parsing output: 64/ for test: gem_fenced_exec_thrash results: parsing output: 65/ for test: gen9_exec_parse results: parsing output: 66/ for test: syncobj_wait results: parsing output: 67/ for test: kms_plane_scaling results: parsing output: 68/ for test: kms_frontbuffer_tracking results: parsing output: 69/ for test: syncobj_eventfd results: parsing output: 70/ for test: kms_busy results: parsing output: 71/ for test: kms_big_fb results: parsing output: 72/ for test: syncobj_timeline results: parsing output: 73/ for test: kms_big_fb results: parsing output: 74/ for test: kms_big_fb results: parsing output: 75/ for test: kms_chamelium_hpd results: parsing output: 76/ for test: kms_flip_scaled_crc results: parsing output: 77/ for test: gem_exec_gttfill results: parsing output: 78/ for test: gem_exec_schedule results: parsing output: 79/ for test: kms_vblank results: parsing output: 80/ for test: kms_frontbuffer_tracking results: parsing output: 81/ for test: kms_flip results: parsing output: 82/ for test: gem_busy results: parsing output: 83/ for test: kms_frontbuffer_tracking results: parsing output: 84/ for test: i915_pm_rps results: parsing output: 85/ for test: kms_content_protection results: parsing output: 86/ for test: perf results: parsing output: 87/ for test: gem_mmap_wc results: parsing output: 88/ for test: kms_color_pipeline results: parsing output: 89/ for test: kms_lease results: parsing output: 90/ for test: gem_ctx_persistence results: parsing output: 91/ for test: kms_frontbuffer_tracking results: parsing output: 92/ for test: kms_fb_coherency results: parsing output: 93/ for test: kms_frontbuffer_tracking results: parsing output: 94/ for test: kms_frontbuffer_tracking results: parsing output: 95/ for test: kms_big_fb results: parsing output: 96/ for test: kms_ccs results: parsing output: 97/ for test: gem_exec_flush results: parsing output: 98/ for test: syncobj_timeline results: parsing output: 99/ for test: kms_frontbuffer_tracking results: parsing output: 100/ for test: kms_frontbuffer_tracking results: parsing output: 101/ for test: api_intel_bb results: parsing output: 102/ for test: gem_watchdog results: parsing output: 103/ for test: kms_flip results: parsing output: 104/ for test: kms_atomic_transition results: parsing output: 105/ for test: kms_frontbuffer_tracking results: parsing output: 106/ for test: kms_frontbuffer_tracking results: parsing output: 107/ for test: gem_exec_reloc results: parsing output: 108/ for test: kms_big_fb results: parsing output: 109/ for test: gem_mmap_gtt results: parsing output: 110/ for test: kms_pipe_crc_basic results: parsing output: 111/ for test: kms_psr results: parsing output: 112/ for test: gem_ctx_persistence results: parsing output: 113/ for test: kms_frontbuffer_tracking results: parsing output: 114/ for test: kms_plane results: parsing output: 115/ for test: kms_psr results: parsing output: 116/ for test: kms_pm_dc results: parsing output: 117/ for test: syncobj_wait results: parsing output: 118/ for test: syncobj_wait results: parsing output: 119/ for test: api_intel_bb results: parsing output: 120/ for test: i915_suspend results: parsing output: 121/ for test: perf_pmu results: parsing output: 122/ for test: drm_read results: parsing output: 123/ for test: kms_flip results: parsing output: 124/ for test: kms_flip results: parsing output: 125/ for test: kms_psr results: parsing output: 126/ for test: kms_cursor_legacy results: parsing output: 127/ for test: kms_pipe_crc_basic results: parsing output: 128/ for test: kms_flip results: parsing output: 129/ for test: kms_atomic results: parsing output: 130/ for test: gem_ctx_param results: parsing output: 131/ for test: gem_ctx_param Done.