[69.926747] Initializing watchdogs [69.926826] /dev/watchdog0 [69.956304] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:4905 Intel Dg1 (Gen12) DG1 [Iris Xe MAX Graphics] [69.970306] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0 [69.974914] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [69.978550] [001/134] (960s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-blt) [71.484714] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-blt [71.487945] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s) [71.854172] [002/134] (958s left) gem_exec_params (secure-non-master) [71.934257] Starting subtest: secure-non-master [71.937273] Subtest secure-non-master: SKIP (0.000s) [72.124610] [003/134] (958s left) tools_test (tools_test) [72.183437] Starting subtest: tools_test [72.299115] Subtest tools_test: SUCCESS (0.125s) [72.470781] [004/134] (958s left) kms_selftest (drm_cmdline_parser) [72.517936] Starting subtest: drm_cmdline_parser [72.529650] Starting dynamic subtest: drm_test_cmdline_force_d_only [72.630256] Dynamic subtest drm_test_cmdline_force_d_only: SUCCESS (0.100s) [72.667044] Starting dynamic subtest: drm_test_cmdline_force_D_only_dvi [72.729774] Dynamic subtest drm_test_cmdline_force_D_only_dvi: SUCCESS (0.099s) [72.764977] Starting dynamic subtest: drm_test_cmdline_force_D_only_hdmi [72.818078] Dynamic subtest drm_test_cmdline_force_D_only_hdmi: SUCCESS (0.084s) [72.853949] Starting dynamic subtest: drm_test_cmdline_force_D_only_not_digital [72.906463] Dynamic subtest drm_test_cmdline_force_D_only_not_digital: SUCCESS (0.090s) [72.940569] Starting dynamic subtest: drm_test_cmdline_force_e_only [72.999055] Dynamic subtest drm_test_cmdline_force_e_only: SUCCESS (0.082s) [73.034439] Starting dynamic subtest: drm_test_cmdline_res [73.083714] Dynamic subtest drm_test_cmdline_res: SUCCESS (0.090s) [73.116829] Starting dynamic subtest: drm_test_cmdline_res_vesa [73.166186] Dynamic subtest drm_test_cmdline_res_vesa: SUCCESS (0.083s) [73.193613] Starting dynamic subtest: drm_test_cmdline_res_vesa_rblank [73.241107] Dynamic subtest drm_test_cmdline_res_vesa_rblank: SUCCESS (0.072s) [73.272287] Starting dynamic subtest: drm_test_cmdline_res_rblank [73.326234] Dynamic subtest drm_test_cmdline_res_rblank: SUCCESS (0.084s) [73.362351] Starting dynamic subtest: drm_test_cmdline_res_bpp [73.413656] Dynamic subtest drm_test_cmdline_res_bpp: SUCCESS (0.088s) [73.446503] Starting dynamic subtest: drm_test_cmdline_res_refresh [73.506899] Dynamic subtest drm_test_cmdline_res_refresh: SUCCESS (0.088s) [73.540794] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh [73.581886] Dynamic subtest drm_test_cmdline_res_bpp_refresh: SUCCESS (0.075s) [73.605076] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_interlaced [73.670127] Dynamic subtest drm_test_cmdline_res_bpp_refresh_interlaced: SUCCESS (0.089s) [73.700154] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_margins [73.740204] Dynamic subtest drm_test_cmdline_res_bpp_refresh_margins: SUCCESS (0.069s) [73.761386] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_off [73.825980] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_off: SUCCESS (0.083s) [73.862189] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on [73.919943] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on: SUCCESS (0.091s) [73.954596] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on_analog [74.003851] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on_analog: SUCCESS (0.084s) [74.039177] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on_digital [74.096039] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on_digital: SUCCESS (0.091s) [74.127526] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_interlaced_margins_force_on [74.186973] Dynamic subtest drm_test_cmdline_res_bpp_refresh_interlaced_margins_force_on: SUCCESS (0.087s) [74.222909] Starting dynamic subtest: drm_test_cmdline_res_margins_force_on [74.276338] Dynamic subtest drm_test_cmdline_res_margins_force_on: SUCCESS (0.087s) [74.310659] Starting dynamic subtest: drm_test_cmdline_res_vesa_margins [74.367088] Dynamic subtest drm_test_cmdline_res_vesa_margins: SUCCESS (0.089s) [74.403350] Starting dynamic subtest: drm_test_cmdline_name [74.459348] Dynamic subtest drm_test_cmdline_name: SUCCESS (0.091s) [74.494431] Starting dynamic subtest: drm_test_cmdline_name_bpp [74.543252] Dynamic subtest drm_test_cmdline_name_bpp: SUCCESS (0.082s) [74.579189] Starting dynamic subtest: drm_test_cmdline_name_option [74.635051] Dynamic subtest drm_test_cmdline_name_option: SUCCESS (0.092s) [74.669889] Starting dynamic subtest: drm_test_cmdline_name_bpp_option [74.728888] Dynamic subtest drm_test_cmdline_name_bpp_option: SUCCESS (0.090s) [74.761650] Starting dynamic subtest: drm_test_cmdline_rotate_0 [74.811872] Dynamic subtest drm_test_cmdline_rotate_0: SUCCESS (0.084s) [74.840536] Starting dynamic subtest: drm_test_cmdline_rotate_90 [74.908758] Dynamic subtest drm_test_cmdline_rotate_90: SUCCESS (0.093s) [74.941158] Starting dynamic subtest: drm_test_cmdline_rotate_180 [74.982755] Dynamic subtest drm_test_cmdline_rotate_180: SUCCESS (0.074s) [75.010775] Starting dynamic subtest: drm_test_cmdline_rotate_270 [75.070479] Dynamic subtest drm_test_cmdline_rotate_270: SUCCESS (0.086s) [75.099699] Starting dynamic subtest: drm_test_cmdline_hmirror [75.143973] Dynamic subtest drm_test_cmdline_hmirror: SUCCESS (0.074s) [75.175631] Starting dynamic subtest: drm_test_cmdline_vmirror [75.250237] Dynamic subtest drm_test_cmdline_vmirror: SUCCESS (0.102s) [75.284640] Starting dynamic subtest: drm_test_cmdline_margin_options [75.339236] Dynamic subtest drm_test_cmdline_margin_options: SUCCESS (0.089s) [75.347359] Starting dynamic subtest: drm_test_cmdline_multiple_options [75.428043] Dynamic subtest drm_test_cmdline_multiple_options: SUCCESS (0.086s) [75.463252] Starting dynamic subtest: drm_test_cmdline_bpp_extra_and_option [75.519442] Dynamic subtest drm_test_cmdline_bpp_extra_and_option: SUCCESS (0.090s) [75.551819] Starting dynamic subtest: drm_test_cmdline_extra_and_option [75.601319] Dynamic subtest drm_test_cmdline_extra_and_option: SUCCESS (0.081s) [75.635148] Starting dynamic subtest: drm_test_cmdline_freestanding_options [75.704853] Dynamic subtest drm_test_cmdline_freestanding_options: SUCCESS (0.100s) [75.712998] Starting dynamic subtest: drm_test_cmdline_freestanding_force_e_and_options [75.794521] Dynamic subtest drm_test_cmdline_freestanding_force_e_and_options: SUCCESS (0.090s) [75.829287] Starting dynamic subtest: drm_test_cmdline_panel_orientation [75.888712] Dynamic subtest drm_test_cmdline_panel_orientation: SUCCESS (0.092s) [75.921424] Starting dynamic subtest: drm_test_cmdline_invalid [76.007812] Dynamic subtest drm_test_cmdline_invalid: SUCCESS (0.117s) [76.036122] Starting dynamic subtest: drm_test_cmdline_tv_options [76.095663] Dynamic subtest drm_test_cmdline_tv_options: SUCCESS (0.086s) [76.097882] Subtest drm_cmdline_parser: SUCCESS (3.576s) [76.327404] [005/134] (954s left) gem_exec_suspend (basic-s0) [76.383147] Starting subtest: basic-S0 [76.384767] Starting dynamic subtest: smem [96.243715] Dynamic subtest smem: SUCCESS (5.414s) [96.253198] Starting dynamic subtest: lmem0 [116.220629] Dynamic subtest lmem0: SUCCESS (5.133s) [116.222279] Subtest basic-S0: SUCCESS (10.548s) [120.519621] [006/134] (914s left) kms_content_protection (uevent) [122.064661] Starting subtest: uevent [122.074725] Subtest uevent: SKIP (0.005s) [122.304183] [007/134] (912s left) gem_eio (in-flight-suspend) [122.495995] Starting subtest: in-flight-suspend [165.655511] Subtest in-flight-suspend: SUCCESS (17.242s) [170.239054] [FACT gem_eio (in-flight-suspend)] new: kernel.kmod_is_loaded.vgem: true [170.244718] [008/134] (867s left) gem_spin_batch (resubmit-all) [170.299563] Starting subtest: resubmit-all [170.300918] Starting dynamic subtest: rcs0 [170.321513] Dynamic subtest rcs0: SUCCESS (0.022s) [170.333837] Starting dynamic subtest: bcs0 [170.335513] Dynamic subtest bcs0: SUCCESS (0.003s) [170.346825] Starting dynamic subtest: vcs0 [170.348481] Dynamic subtest vcs0: SUCCESS (0.002s) [170.359505] Starting dynamic subtest: vcs1 [170.361101] Dynamic subtest vcs1: SUCCESS (0.002s) [170.372166] Starting dynamic subtest: vecs0 [170.373798] Dynamic subtest vecs0: SUCCESS (0.002s) [170.375410] Subtest resubmit-all: SUCCESS (0.033s) [170.646327] [009/134] (867s left) kms_psr (psr-cursor-plane-onoff) [172.135264] Subtest psr-cursor-plane-onoff: SKIP (0.000s) [172.211367] [010/134] (866s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-render) [173.702536] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-render [173.705056] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-render: SKIP (0.000s) [173.952021] [011/134] (864s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-pwrite) [175.443823] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-pwrite [175.447184] Subtest fbc-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [175.675514] [012/134] (862s left) kms_psr2_sf (fbc-psr2-cursor-plane-update-sf) [177.170758] Subtest fbc-psr2-cursor-plane-update-sf: SKIP (0.000s) [177.342768] [013/134] (861s left) kms_psr2_sf (psr2-overlay-primary-update-sf-dmg-area) [178.839107] Subtest psr2-overlay-primary-update-sf-dmg-area: SKIP (0.000s) [178.911800] [014/134] (859s left) kms_pm_rpm (basic-pci-d3-state) [183.273059] Starting subtest: basic-pci-d3-state [184.498468] Subtest basic-pci-d3-state: SUCCESS (1.228s) [185.460428] [015/134] (853s left) gem_ctx_exec (basic-norecovery) [185.507612] Starting subtest: basic-norecovery [185.783035] Subtest basic-norecovery: SUCCESS (0.274s) [185.991111] [016/134] (853s left) gem_pxp (protected-encrypted-src-copy-not-readible) [188.554738] Starting subtest: protected-encrypted-src-copy-not-readible [188.558912] Subtest protected-encrypted-src-copy-not-readible: SKIP (0.000s) [188.734505] [017/134] (850s left) kms_flip (absolute-wf_vblank) [190.222611] Starting subtest: absolute-wf_vblank [190.229307] Starting dynamic subtest: A-HDMI-A4 [198.126493] Dynamic subtest A-HDMI-A4: SUCCESS (7.897s) [198.139822] Starting dynamic subtest: B-HDMI-A4 [205.805553] Dynamic subtest B-HDMI-A4: SUCCESS (7.678s) [205.817752] Starting dynamic subtest: C-HDMI-A4 [213.489666] Dynamic subtest C-HDMI-A4: SUCCESS (7.683s) [213.502192] Starting dynamic subtest: D-HDMI-A4 [221.174810] Dynamic subtest D-HDMI-A4: SUCCESS (7.684s) [221.176545] Subtest absolute-wf_vblank: SUCCESS (30.953s) [221.435452] [018/134] (817s left) prime_mmap (test_refcounting) [221.502312] Starting subtest: test_refcounting [221.503727] Starting dynamic subtest: test_refcounting-smem [221.562170] Dynamic subtest test_refcounting-smem: SUCCESS (0.061s) [221.573292] Starting dynamic subtest: test_refcounting-lmem0 [221.622174] Dynamic subtest test_refcounting-lmem0: SUCCESS (0.060s) [221.623614] Subtest test_refcounting: SUCCESS (0.122s) [221.855063] [019/134] (817s left) gem_exec_schedule (pi-common) [222.069756] Starting subtest: pi-common [222.071727] Starting dynamic subtest: rcs0 [222.109261] Dynamic subtest rcs0: SUCCESS (0.041s) [222.121104] Starting dynamic subtest: bcs0 [222.141775] Dynamic subtest bcs0: SUCCESS (0.032s) [222.153388] Starting dynamic subtest: vcs0 [222.171508] Dynamic subtest vcs0: SUCCESS (0.029s) [222.183105] Starting dynamic subtest: vcs1 [222.201189] Dynamic subtest vcs1: SUCCESS (0.029s) [222.215734] Starting dynamic subtest: vecs0 [222.231116] Dynamic subtest vecs0: SUCCESS (0.029s) [222.232909] Subtest pi-common: SUCCESS (0.163s) [222.552364] [020/134] (816s left) perf (unprivileged-single-ctx-counters) [222.731800] Starting subtest: unprivileged-single-ctx-counters [222.737716] Subtest unprivileged-single-ctx-counters: SKIP (0.000s) [222.811279] [021/134] (816s left) api_intel_allocator (fork-simple-stress-signal) [222.865282] Starting subtest: fork-simple-stress-signal [228.289230] Subtest fork-simple-stress-signal: SUCCESS (5.432s) [228.492855] [022/134] (811s left) kms_flip (flip-vs-panning-vs-hang) [229.976571] Starting subtest: flip-vs-panning-vs-hang [229.979762] Starting dynamic subtest: A-HDMI-A4 [280.692922] Dynamic subtest A-HDMI-A4: SUCCESS (50.715s) [280.704971] Starting dynamic subtest: D-HDMI-A4 [330.670922] Dynamic subtest D-HDMI-A4: SUCCESS (49.980s) [330.672635] Subtest flip-vs-panning-vs-hang: SUCCESS (100.700s) [330.897956] [023/134] (708s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-exceed-sf) [332.394400] Subtest psr2-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s) [332.455821] [024/134] (707s left) syncobj_wait (invalid-multi-wait-unsubmitted-submitted) [332.502966] Starting subtest: invalid-multi-wait-unsubmitted-submitted [332.504827] Subtest invalid-multi-wait-unsubmitted-submitted: SUCCESS (0.000s) [332.682032] [025/134] (707s left) gem_exec_create (basic) [332.740131] Starting subtest: basic [332.741450] Starting dynamic subtest: smem [334.834760] Dynamic subtest smem: SUCCESS (2.095s) [334.846721] Starting dynamic subtest: lmem0 [336.929501] Dynamic subtest lmem0: SUCCESS (2.094s) [336.930962] Subtest basic: SUCCESS (4.190s) [337.212159] [026/134] (702s left) gem_ctx_persistence (smoketest) [337.264570] Starting subtest: smoketest [375.789076] Subtest smoketest: SUCCESS (38.525s) [375.979413] [027/134] (664s left) gem_ctx_bad_destroy (invalid-pad) [376.024145] Starting subtest: invalid-pad [376.025803] Subtest invalid-pad: SUCCESS (0.000s) [376.179891] [028/134] (663s left) kms_cursor_legacy (cursora-vs-flipb-legacy) [377.666464] Starting subtest: cursorA-vs-flipB-legacy [377.669592] Subtest cursorA-vs-flipB-legacy: SKIP (0.002s) [377.823839] [029/134] (662s left) kms_atomic_interruptible (legacy-setmode) [379.318523] Starting subtest: legacy-setmode [379.320075] Starting dynamic subtest: pipe-A-HDMI-A-4 [385.524214] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (6.205s) [385.525598] Subtest legacy-setmode: SUCCESS (6.206s) [385.762783] [030/134] (654s left) kms_cdclk (mode-transition) [385.809050] Subtest mode-transition: SKIP (0.000s) [385.883132] [031/134] (654s left) kms_big_fb (linear-8bpp-rotate-270) [387.398432] Starting subtest: linear-8bpp-rotate-270 [387.495879] Subtest linear-8bpp-rotate-270: SKIP (0.096s) [387.721869] [032/134] (652s left) perf_pmu (faulting-read) [387.777849] Starting subtest: faulting-read [387.779605] Starting dynamic subtest: fixed [387.781270] Dynamic subtest fixed: SUCCESS (0.001s) [387.783162] Subtest faulting-read: SUCCESS (0.002s) [387.958153] [033/134] (652s left) kms_psr (fbc-psr2-primary-render) [389.444659] Subtest fbc-psr2-primary-render: SKIP (0.000s) [389.519892] [034/134] (651s left) gem_exec_schedule (deep) [389.734805] Starting subtest: deep [389.736960] Starting dynamic subtest: rcs0 [405.270680] Dynamic subtest rcs0: SUCCESS (15.535s) [405.283570] Starting dynamic subtest: bcs0 [420.903176] Dynamic subtest bcs0: SUCCESS (15.632s) [420.916099] Starting dynamic subtest: vcs0 [436.915244] Dynamic subtest vcs0: SUCCESS (16.012s) [436.928140] Starting dynamic subtest: vcs1 [452.993848] Dynamic subtest vcs1: SUCCESS (16.078s) [453.007622] Starting dynamic subtest: vecs0 [469.101563] Dynamic subtest vecs0: SUCCESS (16.108s) [469.102875] Subtest deep: SUCCESS (79.368s) [469.927682] [035/134] (570s left) kms_selftest (drm_plane_helper) [469.972214] Starting subtest: drm_plane_helper [470.045636] Starting dynamic subtest: drm_test_check_plane_state [470.115845] Dynamic subtest drm_test_check_plane_state: SUCCESS (0.072s) [470.136002] Starting dynamic subtest: drm_test_check_invalid_plane_state [470.196839] Dynamic subtest drm_test_check_invalid_plane_state: SUCCESS (0.080s) [470.198472] Subtest drm_plane_helper: SUCCESS (0.223s) [470.463864] [036/134] (570s left) syncobj_basic (bad-pad-fd-to-handle) [470.510065] Starting subtest: bad-pad-fd-to-handle [470.511675] Subtest bad-pad-fd-to-handle: SUCCESS (0.000s) [470.713392] [037/134] (570s left) gem_lmem_swapping (parallel-random-engines) [475.131074] Starting subtest: parallel-random-engines [475.133424] Starting dynamic subtest: lmem0 [518.419934] Dynamic subtest lmem0: SUCCESS (43.288s) [518.422150] Subtest parallel-random-engines: SUCCESS (43.289s) [519.487543] [FACT gem_lmem_swapping (parallel-random-engines)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0 [519.488705] [FACT gem_lmem_swapping (parallel-random-engines)] deleted: kernel.kmod_is_loaded.i915: true [519.491149] [038/134] (521s left) kms_mmap_write_crc (main) [524.250132] Starting subtest: main [524.252852] Starting dynamic subtest: pipe-A-HDMI-A-4 [527.974640] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (3.721s) [527.976262] Subtest main: SUCCESS (3.723s) [528.226211] [FACT kms_mmap_write_crc (main)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0 [528.229238] [FACT kms_mmap_write_crc (main)] new: kernel.kmod_is_loaded.i915: true [528.233338] [039/134] (512s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-pwrite) [529.726544] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-pwrite [529.729532] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [529.995933] [040/134] (511s left) kms_addfb_basic (addfb25-yf-tiled-legacy) [531.482277] Starting subtest: addfb25-yf-tiled-legacy [531.483903] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s) [531.734910] [041/134] (509s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc) [533.227173] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc [533.230235] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s) [533.516532] [042/134] (508s left) gem_ctx_exec (basic) [533.563810] Starting subtest: basic [533.571416] Subtest basic: SUCCESS (0.008s) [533.757186] [043/134] (507s left) kms_atomic (test-only) [535.243627] Starting subtest: test-only [535.489341] Starting dynamic subtest: pipe-A-HDMI-A-4 [536.011130] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.522s) [536.012693] Subtest test-only: SUCCESS (0.769s) [536.237308] [044/134] (505s left) gem_set_tiling_vs_gtt [536.363872] [045/134] (505s left) kms_big_fb (yf-tiled-16bpp-rotate-0) [537.867340] Starting subtest: yf-tiled-16bpp-rotate-0 [537.870973] Subtest yf-tiled-16bpp-rotate-0: SKIP (0.000s) [538.124668] [046/134] (503s left) kms_getfb (getfb2-handle-zero) [539.610987] Starting subtest: getfb2-handle-zero [539.612629] Subtest getfb2-handle-zero: SUCCESS (0.000s) [539.874545] [047/134] (502s left) syncobj_timeline (single-wait-all-for-submit-available-submitted) [539.920714] Starting subtest: single-wait-all-for-submit-available-submitted [539.925198] Subtest single-wait-all-for-submit-available-submitted: SUCCESS (0.000s) [540.109977] [048/134] (502s left) gem_exec_reloc (basic-wc-cpu) [540.166166] Subtest basic-wc-cpu: SKIP (0.000s) [540.273958] [049/134] (501s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-onoff) [541.768858] Starting subtest: psr-1p-primscrn-spr-indfb-onoff [541.772125] Subtest psr-1p-primscrn-spr-indfb-onoff: SKIP (0.000s) [542.025114] [050/134] (500s left) gem_basic (multigpu-create-close) [542.087181] Starting subtest: multigpu-create-close [542.092005] Subtest multigpu-create-close: SKIP (0.000s) [542.276525] [051/134] (500s left) kms_frontbuffer_tracking (fbc-suspend) [543.768593] Starting subtest: fbc-suspend [590.084410] Subtest fbc-suspend: SUCCESS (22.505s) [594.309094] [052/134] (452s left) gem_wait (wait) [594.372555] Starting subtest: wait [594.374355] Starting dynamic subtest: all-engines [595.483203] Dynamic subtest all-engines: SUCCESS (1.110s) [595.499016] Starting dynamic subtest: rcs0 [596.541229] Dynamic subtest rcs0: SUCCESS (1.056s) [596.555264] Starting dynamic subtest: bcs0 [597.594784] Dynamic subtest bcs0: SUCCESS (1.053s) [597.608672] Starting dynamic subtest: vcs0 [598.649736] Dynamic subtest vcs0: SUCCESS (1.054s) [598.663632] Starting dynamic subtest: vcs1 [599.705372] Dynamic subtest vcs1: SUCCESS (1.053s) [599.725641] Starting dynamic subtest: vecs0 [600.766312] Dynamic subtest vecs0: SUCCESS (1.057s) [600.768782] Subtest wait: SUCCESS (6.396s) [601.087346] [053/134] (445s left) gem_exec_reloc (basic-wc-active) [601.137454] Subtest basic-wc-active: SKIP (0.000s) [601.260170] [054/134] (445s left) kms_pm_rpm (pc8-residency) [605.084227] Starting subtest: pc8-residency [605.087638] Subtest pc8-residency: SKIP (0.000s) [606.030646] [055/134] (440s left) kms_dsc (dsc-with-bpc-formats) [607.530195] Starting subtest: dsc-with-bpc-formats [607.626418] Subtest dsc-with-bpc-formats: SKIP (0.005s) [607.755381] [056/134] (439s left) kms_psr (pr-cursor-plane-move) [609.281352] Subtest pr-cursor-plane-move: SKIP (0.000s) [609.349119] [057/134] (437s left) kms_vblank (ts-continuation-dpms-suspend) [610.833261] Starting subtest: ts-continuation-dpms-suspend [610.834896] Starting dynamic subtest: pipe-A-HDMI-A-4 [632.236471] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (10.031s) [632.253969] Starting dynamic subtest: pipe-D-HDMI-A-4 [654.210030] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (9.559s) [654.211315] Subtest ts-continuation-dpms-suspend: SUCCESS (19.596s) [660.449942] [058/134] (392s left) syncobj_timeline (multi-wait-available-unsubmitted-signaled) [660.496789] Starting subtest: multi-wait-available-unsubmitted-signaled [660.498283] Subtest multi-wait-available-unsubmitted-signaled: SUCCESS (0.001s) [660.677344] [059/134] (392s left) kms_cursor_legacy (basic-flip-before-cursor-legacy) [662.169566] Starting subtest: basic-flip-before-cursor-legacy [663.182480] Subtest basic-flip-before-cursor-legacy: SUCCESS (1.012s) [663.382902] [060/134] (389s left) kms_chamelium_hpd (dp-hpd-for-each-pipe) [664.913791] Subtest dp-hpd-for-each-pipe: SKIP (0.000s) [665.029641] [061/134] (388s left) gem_exec_params (invalid-flag) [665.080356] Starting subtest: invalid-flag [665.082209] Subtest invalid-flag: SUCCESS (0.000s) [665.302882] [062/134] (388s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-pwrite) [666.797472] Starting subtest: psr-2p-primscrn-spr-indfb-draw-pwrite [666.803049] Subtest psr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [666.985587] [063/134] (386s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted-signaled) [667.032443] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled [667.034384] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.001s) [667.234772] [064/134] (386s left) prime_vgem (wait) [667.316831] Starting subtest: wait [667.318574] Starting dynamic subtest: rcs0 [667.360267] Dynamic subtest rcs0: SUCCESS (0.043s) [667.373443] Starting dynamic subtest: bcs0 [667.403135] Dynamic subtest bcs0: SUCCESS (0.042s) [667.415476] Starting dynamic subtest: vcs0 [667.442804] Dynamic subtest vcs0: SUCCESS (0.039s) [667.461374] Starting dynamic subtest: vcs1 [667.484968] Dynamic subtest vcs1: SUCCESS (0.041s) [667.499742] Starting dynamic subtest: vecs0 [667.525445] Dynamic subtest vecs0: SUCCESS (0.039s) [667.527078] Subtest wait: SUCCESS (0.209s) [667.734784] [065/134] (386s left) gem_exec_capture (capture) [667.788572] Starting subtest: capture [667.790113] Starting dynamic subtest: rcs0-smem [668.670366] Dynamic subtest rcs0-smem: SUCCESS (0.883s) [668.682792] Starting dynamic subtest: rcs0-lmem0 [669.531814] Dynamic subtest rcs0-lmem0: SUCCESS (0.860s) [669.543741] Starting dynamic subtest: bcs0-smem [670.900624] Dynamic subtest bcs0-smem: SUCCESS (1.367s) [670.912606] Starting dynamic subtest: bcs0-lmem0 [671.994071] Dynamic subtest bcs0-lmem0: SUCCESS (1.094s) [672.006059] Starting dynamic subtest: vcs0-smem [672.856425] Dynamic subtest vcs0-smem: SUCCESS (0.858s) [672.868367] Starting dynamic subtest: vcs0-lmem0 [673.712637] Dynamic subtest vcs0-lmem0: SUCCESS (0.855s) [673.724608] Starting dynamic subtest: vcs1-smem [674.567357] Dynamic subtest vcs1-smem: SUCCESS (0.855s) [674.579435] Starting dynamic subtest: vcs1-lmem0 [675.424453] Dynamic subtest vcs1-lmem0: SUCCESS (0.856s) [675.436519] Starting dynamic subtest: vecs0-smem [676.855788] Dynamic subtest vecs0-smem: FAIL (1.387s) [676.867343] Starting dynamic subtest: vecs0-lmem0 [677.846187] Dynamic subtest vecs0-lmem0: FAIL (0.985s) [677.847972] Subtest capture: FAIL (10.010s) [677.965960] [066/134] (375s left) kms_cursor_crc (cursor-rapid-movement-512x512) [679.716076] Starting subtest: cursor-rapid-movement-512x512 [679.719312] Subtest cursor-rapid-movement-512x512: SKIP (0.001s) [680.052722] [067/134] (373s left) kms_flip (2x-flip-vs-wf_vblank) [681.539606] Starting subtest: 2x-flip-vs-wf_vblank [681.556511] Subtest 2x-flip-vs-wf_vblank: SKIP (0.017s) [681.771376] [068/134] (372s left) i915_pm_freq_api (freq-suspend) [681.823799] Starting subtest: freq-suspend [681.825173] Starting dynamic subtest: gt0 [698.130187] Dynamic subtest gt0: SUCCESS (1.690s) [698.132061] Subtest freq-suspend: SUCCESS (1.691s) [705.425954] [069/134] (355s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt) [706.931474] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt [706.934758] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [707.154022] [070/134] (354s left) kms_chamelium_frames (hdmi-aspect-ratio) [708.684732] Subtest hdmi-aspect-ratio: SKIP (0.000s) [708.797098] [071/134] (352s left) kms_cursor_crc (cursor-sliding-max-size) [710.585274] Starting subtest: cursor-sliding-max-size [710.589666] Subtest cursor-sliding-max-size: SKIP (0.000s) [710.848767] [072/134] (350s left) kms_color_pipeline (plane-ctm3x4-lut1d) [712.341649] Starting subtest: plane-ctm3x4-lut1d [712.382479] Starting dynamic subtest: pipe-A-HDMI-A-4 [712.798092] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.416s) [712.934663] Starting dynamic subtest: pipe-B-HDMI-A-4 [713.288843] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.365s) [713.419271] Starting dynamic subtest: pipe-C-HDMI-A-4 [713.773917] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.365s) [713.901517] Starting dynamic subtest: pipe-D-HDMI-A-4 [714.238492] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.348s) [714.296086] Subtest plane-ctm3x4-lut1d: SUCCESS (1.954s) [714.536955] [073/134] (347s left) kms_frontbuffer_tracking (psr-1p-pri-indfb-multidraw) [716.029502] Starting subtest: psr-1p-pri-indfb-multidraw [716.032712] Subtest psr-1p-pri-indfb-multidraw: SKIP (0.000s) [716.279692] [074/134] (345s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-render) [717.791448] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-render [717.794663] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s) [718.038404] [075/134] (343s left) syncobj_timeline (invalid-query-illegal-handle) [718.086284] Starting subtest: invalid-query-illegal-handle [718.088299] Subtest invalid-query-illegal-handle: SUCCESS (0.000s) [718.232852] [076/134] (343s left) kms_ccs (crc-primary-basic-4-tiled-mtl-mc-ccs) [719.717007] Starting subtest: crc-primary-basic-4-tiled-mtl-mc-ccs [719.718539] Starting dynamic subtest: pipe-A-HDMI-A-4 [719.734068] Dynamic subtest pipe-A-HDMI-A-4: SKIP (0.001s) [719.746621] Starting dynamic subtest: pipe-B-HDMI-A-4 [719.762735] Dynamic subtest pipe-B-HDMI-A-4: SKIP (0.001s) [719.774518] Starting dynamic subtest: pipe-C-HDMI-A-4 [719.790826] Dynamic subtest pipe-C-HDMI-A-4: SKIP (0.001s) [719.803147] Starting dynamic subtest: pipe-D-HDMI-A-4 [719.830432] Dynamic subtest pipe-D-HDMI-A-4: SKIP (0.001s) [719.833186] Subtest crc-primary-basic-4-tiled-mtl-mc-ccs: SKIP (0.013s) [720.015755] [077/134] (342s left) kms_addfb_basic (too-high) [721.504093] Starting subtest: too-high [721.505447] Subtest too-high: SUCCESS (0.001s) [721.755784] [078/134] (340s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-gtt) [723.246660] Starting subtest: psr-rgb565-draw-mmap-gtt [723.250175] Subtest psr-rgb565-draw-mmap-gtt: SKIP (0.000s) [723.441346] [079/134] (338s left) gem_mmap_offset (mmap-unmap) [723.500616] Starting subtest: mmap-unmap [723.502336] Starting dynamic subtest: lmem0 [724.697113] Dynamic subtest lmem0: SUCCESS (1.207s) [724.709500] Starting dynamic subtest: smem0 [726.438568] Dynamic subtest smem0: SUCCESS (1.741s) [726.440108] Subtest mmap-unmap: SUCCESS (2.950s) [726.666022] [080/134] (335s left) gem_pread (exhaustion) [726.711348] Subtest exhaustion: SKIP (0.000s) [726.814005] [081/134] (335s left) kms_joiner (invalid-modeset-ultra-joiner) [728.300449] Starting subtest: invalid-modeset-ultra-joiner [728.303112] Subtest invalid-modeset-ultra-joiner: SKIP (0.000s) [728.482976] [082/134] (334s left) i915_drm_fdinfo (basics) [728.533232] Starting subtest: basics [728.534764] Subtest basics: SUCCESS (0.000s) [728.726565] [083/134] (333s left) gem_ccs (ctrl-surf-copy-new-ctx) [728.778384] Starting subtest: ctrl-surf-copy-new-ctx [728.781283] Subtest ctrl-surf-copy-new-ctx: SKIP (0.000s) [728.931779] [084/134] (333s left) kms_plane (pixel-format-x-tiled-modifier-source-clamping) [730.417279] Starting subtest: pixel-format-x-tiled-modifier-source-clamping [730.453544] Starting dynamic subtest: pipe-A-plane-0 [731.520819] Dynamic subtest pipe-A-plane-0: SUCCESS (1.066s) [731.562970] Starting dynamic subtest: pipe-A-plane-3 [732.421298] Dynamic subtest pipe-A-plane-3: SUCCESS (0.897s) [732.464038] Starting dynamic subtest: pipe-A-plane-5 [733.122215] Dynamic subtest pipe-A-plane-5: SUCCESS (0.697s) [733.161553] Starting dynamic subtest: pipe-A-plane-7 [733.165290] Dynamic subtest pipe-A-plane-7: SKIP (0.000s) [733.284383] Starting dynamic subtest: pipe-B-plane-0 [734.224681] Dynamic subtest pipe-B-plane-0: SUCCESS (0.950s) [734.240823] Starting dynamic subtest: pipe-B-plane-3 [735.058571] Dynamic subtest pipe-B-plane-3: SUCCESS (0.830s) [735.103863] Starting dynamic subtest: pipe-B-plane-5 [735.710140] Dynamic subtest pipe-B-plane-5: SUCCESS (0.646s) [735.753766] Starting dynamic subtest: pipe-B-plane-7 [735.757178] Dynamic subtest pipe-B-plane-7: SKIP (0.000s) [735.765358] Subtest pixel-format-x-tiled-modifier-source-clamping: SUCCESS (5.347s) [736.072483] [085/134] (326s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-onoff) [737.570227] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-onoff [737.573345] Subtest fbcpsr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s) [737.823484] [086/134] (325s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-downscaling) [739.309344] Starting subtest: flip-64bpp-linear-to-16bpp-linear-downscaling [739.310772] Starting dynamic subtest: pipe-A-valid-mode [740.544437] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.234s) [740.545973] Subtest flip-64bpp-linear-to-16bpp-linear-downscaling: SUCCESS (1.237s) [740.778212] [087/134] (322s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-msflip-blt) [742.270723] Starting subtest: fbc-2p-primscrn-shrfb-msflip-blt [742.273636] Subtest fbc-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s) [742.490899] [088/134] (320s left) kms_draw_crc (fill-fb) [743.979693] Starting subtest: fill-fb [744.528104] Subtest fill-fb: SUCCESS (0.550s) [744.753689] [089/134] (318s left) kms_big_fb (y-tiled-8bpp-rotate-0) [746.256078] Starting subtest: y-tiled-8bpp-rotate-0 [747.897321] Subtest y-tiled-8bpp-rotate-0: SUCCESS (1.640s) [748.100667] [090/134] (315s left) gem_render_copy (yf-tiled-to-vebox-linear) [748.152457] Starting subtest: yf-tiled-to-vebox-linear [748.154049] Starting dynamic subtest: smem [748.230472] Dynamic subtest smem: SUCCESS (0.077s) [748.243124] Starting dynamic subtest: lmem0 [748.357263] Dynamic subtest lmem0: SUCCESS (0.125s) [748.358871] Subtest yf-tiled-to-vebox-linear: SUCCESS (0.205s) [748.688664] [091/134] (314s left) syncobj_wait (invalid-reset-illegal-handle) [748.734545] Starting subtest: invalid-reset-illegal-handle [748.736297] Subtest invalid-reset-illegal-handle: SUCCESS (0.000s) [748.901519] [092/134] (314s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-blt) [750.393700] Starting subtest: psr-1p-offscreen-pri-indfb-draw-blt [750.397227] Subtest psr-1p-offscreen-pri-indfb-draw-blt: SKIP (0.000s) [750.607070] [093/134] (313s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip) [752.111506] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip [752.114864] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SKIP (0.000s) [752.359204] [094/134] (311s left) api_intel_bb (full-batch) [752.406392] Starting subtest: full-batch [752.424435] Subtest full-batch: SUCCESS (0.019s) [752.656160] [095/134] (311s left) kms_psr (fbc-psr-basic) [754.142386] Subtest fbc-psr-basic: SKIP (0.000s) [754.225403] [096/134] (309s left) gem_exercise_blt (fast-copy-emit) [754.276797] Starting subtest: fast-copy-emit [754.278427] Starting dynamic subtest: linear-smem-smem-emit [754.310269] Dynamic subtest linear-smem-smem-emit: SUCCESS (0.033s) [754.322793] Starting dynamic subtest: linear-smem-lmem0-emit [754.329520] Dynamic subtest linear-smem-lmem0-emit: SUCCESS (0.015s) [754.342131] Starting dynamic subtest: linear-lmem0-smem-emit [754.388418] Dynamic subtest linear-lmem0-smem-emit: SUCCESS (0.060s) [754.401009] Starting dynamic subtest: linear-lmem0-lmem0-emit [754.448767] Dynamic subtest linear-lmem0-lmem0-emit: SUCCESS (0.059s) [754.461117] Starting dynamic subtest: ymajor-smem-smem-emit [754.465516] Dynamic subtest ymajor-smem-smem-emit: SUCCESS (0.015s) [754.477786] Starting dynamic subtest: ymajor-smem-lmem0-emit [754.481942] Dynamic subtest ymajor-smem-lmem0-emit: SUCCESS (0.014s) [754.494539] Starting dynamic subtest: ymajor-lmem0-smem-emit [754.541468] Dynamic subtest ymajor-lmem0-smem-emit: SUCCESS (0.059s) [754.554025] Starting dynamic subtest: ymajor-lmem0-lmem0-emit [754.601876] Dynamic subtest ymajor-lmem0-lmem0-emit: SUCCESS (0.059s) [754.613913] Starting dynamic subtest: tile4-smem-smem-emit [754.618018] Dynamic subtest tile4-smem-smem-emit: SUCCESS (0.014s) [754.630159] Starting dynamic subtest: tile4-smem-lmem0-emit [754.633418] Dynamic subtest tile4-smem-lmem0-emit: SUCCESS (0.014s) [754.645179] Starting dynamic subtest: tile4-lmem0-smem-emit [754.692916] Dynamic subtest tile4-lmem0-smem-emit: SUCCESS (0.059s) [754.706942] Starting dynamic subtest: tile4-lmem0-lmem0-emit [754.752364] Dynamic subtest tile4-lmem0-lmem0-emit: SUCCESS (0.058s) [754.764576] Starting dynamic subtest: tile64-smem-smem-emit [754.768563] Dynamic subtest tile64-smem-smem-emit: SUCCESS (0.015s) [754.782945] Starting dynamic subtest: tile64-smem-lmem0-emit [754.784236] Dynamic subtest tile64-smem-lmem0-emit: SUCCESS (0.014s) [754.796453] Starting dynamic subtest: tile64-lmem0-smem-emit [754.845038] Dynamic subtest tile64-lmem0-smem-emit: SUCCESS (0.059s) [754.856997] Starting dynamic subtest: tile64-lmem0-lmem0-emit [754.904770] Dynamic subtest tile64-lmem0-lmem0-emit: SUCCESS (0.058s) [754.906095] Subtest fast-copy-emit: SUCCESS (0.629s) [755.153842] [097/134] (308s left) sysfs_heartbeat_interval (mixed) [755.204402] Starting subtest: mixed [755.205855] Starting dynamic subtest: vecs0 [760.505533] Dynamic subtest vecs0: SUCCESS (5.299s) [760.519169] Starting dynamic subtest: vcs0 [765.790663] Dynamic subtest vcs0: SUCCESS (5.279s) [765.806127] Starting dynamic subtest: bcs0 [770.897315] Dynamic subtest bcs0: SUCCESS (5.107s) [770.914175] Starting dynamic subtest: rcs0 [776.195214] Dynamic subtest rcs0: SUCCESS (5.293s) [776.215518] Starting dynamic subtest: vcs1 [781.504407] Dynamic subtest vcs1: SUCCESS (5.307s) [781.505999] Subtest mixed: SUCCESS (26.299s) [781.705109] [098/134] (282s left) kms_cursor_legacy (cursor-vs-flip-legacy) [783.194564] Starting subtest: cursor-vs-flip-legacy [814.503583] Subtest cursor-vs-flip-legacy: SUCCESS (31.313s) [814.721478] [099/134] (249s left) gem_exec_schedule (semaphore-resolve) [814.785074] Starting subtest: semaphore-resolve [814.844457] Subtest semaphore-resolve: SUCCESS (0.061s) [815.366495] [100/134] (249s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-render) [816.857979] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-render [816.860936] Subtest fbc-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s) [817.103034] [101/134] (247s left) kms_cursor_legacy (torture-bo) [818.590836] Starting subtest: torture-bo [818.592387] Starting dynamic subtest: pipe-A [824.181227] Dynamic subtest pipe-A: SUCCESS (5.588s) [824.194884] Starting dynamic subtest: pipe-B [829.669292] Dynamic subtest pipe-B: SUCCESS (5.487s) [829.682332] Starting dynamic subtest: pipe-C [835.137895] Dynamic subtest pipe-C: SUCCESS (5.467s) [835.150824] Starting dynamic subtest: pipe-D [840.615475] Dynamic subtest pipe-D: SUCCESS (5.474s) [840.628573] Starting dynamic subtest: all-pipes [846.084049] Dynamic subtest all-pipes: SUCCESS (5.470s) [846.085742] Subtest torture-bo: SUCCESS (27.493s) [846.312397] [102/134] (218s left) gem_ctx_shared (q-independent) [846.370225] Starting subtest: Q-independent [846.372001] Starting dynamic subtest: rcs0 [846.523486] Dynamic subtest rcs0: SUCCESS (0.151s) [846.536164] Starting dynamic subtest: bcs0 [846.613351] Dynamic subtest bcs0: SUCCESS (0.092s) [846.626343] Starting dynamic subtest: vcs0 [846.710041] Dynamic subtest vcs0: SUCCESS (0.095s) [846.723073] Starting dynamic subtest: vcs1 [846.816138] Dynamic subtest vcs1: SUCCESS (0.104s) [846.828739] Starting dynamic subtest: vecs0 [846.922391] Dynamic subtest vecs0: SUCCESS (0.105s) [846.923685] Subtest Q-independent: SUCCESS (0.555s) [847.322203] [103/134] (217s left) gem_exec_fence (syncobj-timeline-invalid-wait) [847.888043] Starting subtest: syncobj-timeline-invalid-wait [847.889459] Subtest syncobj-timeline-invalid-wait: SUCCESS (0.002s) [848.206229] [104/134] (216s left) gem_render_copy (y-tiled-ccs-to-x-tiled) [848.257457] Starting subtest: y-tiled-ccs-to-x-tiled [848.258960] Starting dynamic subtest: smem [848.350396] Dynamic subtest smem: SUCCESS (0.092s) [848.366631] Starting dynamic subtest: lmem0 [849.283076] Dynamic subtest lmem0: SUCCESS (0.928s) [849.284844] Subtest y-tiled-ccs-to-x-tiled: SUCCESS (1.023s) [849.566752] [105/134] (215s left) drm_read (short-buffer-wakeup) [851.114653] Starting subtest: short-buffer-wakeup [883.332286] Subtest short-buffer-wakeup: SUCCESS (32.214s) [883.596803] [106/134] (181s left) kms_atomic_transition (plane-use-after-nonblocking-unbind-fencing) [885.081503] Starting subtest: plane-use-after-nonblocking-unbind-fencing [885.085088] Starting dynamic subtest: pipe-A-HDMI-A-4 [885.180159] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.097s) [885.249565] Starting dynamic subtest: pipe-B-HDMI-A-4 [885.413024] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.175s) [885.452493] Subtest plane-use-after-nonblocking-unbind-fencing: SUCCESS (0.370s) [885.680068] [107/134] (179s left) syncobj_timeline (device-submit-unordered) [885.738744] Starting subtest: device-submit-unordered [885.740401] Subtest device-submit-unordered: SUCCESS (0.000s) [885.907990] [108/134] (179s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-mc-ccs) [887.396294] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-mc-ccs [887.398220] Starting dynamic subtest: pipe-A-HDMI-A-4 [887.431057] Dynamic subtest pipe-A-HDMI-A-4: SKIP (0.003s) [887.444161] Starting dynamic subtest: pipe-B-HDMI-A-4 [887.479432] Dynamic subtest pipe-B-HDMI-A-4: SKIP (0.003s) [887.491956] Starting dynamic subtest: pipe-C-HDMI-A-4 [887.529799] Dynamic subtest pipe-C-HDMI-A-4: SKIP (0.003s) [887.542471] Starting dynamic subtest: pipe-D-HDMI-A-4 [887.584462] Dynamic subtest pipe-D-HDMI-A-4: SKIP (0.003s) [887.588104] Subtest crc-sprite-planes-basic-4-tiled-mtl-mc-ccs: SKIP (0.021s) [887.667212] [109/134] (177s left) kms_pipe_crc_basic (nonblocking-crc) [889.153266] Starting subtest: nonblocking-crc [889.154916] Starting dynamic subtest: pipe-A-HDMI-A-4 [889.874861] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.722s) [889.893153] Starting dynamic subtest: pipe-B-HDMI-A-4 [890.473260] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.594s) [890.488283] Starting dynamic subtest: pipe-C-HDMI-A-4 [891.053072] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.577s) [891.069391] Starting dynamic subtest: pipe-D-HDMI-A-4 [891.661741] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.604s) [891.663171] Subtest nonblocking-crc: SUCCESS (2.510s) [891.895927] [110/134] (173s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt) [893.386844] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt [893.389460] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [893.642373] [111/134] (171s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-gtt) [895.159113] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-gtt [895.172380] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [895.375470] [112/134] (170s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping) [896.862274] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping [896.891606] Starting dynamic subtest: pipe-A-plane-0 [896.896380] Dynamic subtest pipe-A-plane-0: SKIP (0.000s) [896.908736] Starting dynamic subtest: pipe-A-plane-3 [896.911255] Dynamic subtest pipe-A-plane-3: SKIP (0.000s) [896.924107] Starting dynamic subtest: pipe-A-plane-5 [896.926720] Dynamic subtest pipe-A-plane-5: SKIP (0.000s) [896.939748] Starting dynamic subtest: pipe-A-plane-7 [896.942312] Dynamic subtest pipe-A-plane-7: SKIP (0.000s) [897.041558] Starting dynamic subtest: pipe-B-plane-0 [897.044799] Dynamic subtest pipe-B-plane-0: SKIP (0.000s) [897.057287] Starting dynamic subtest: pipe-B-plane-3 [897.060127] Dynamic subtest pipe-B-plane-3: SKIP (0.000s) [897.072699] Starting dynamic subtest: pipe-B-plane-5 [897.075509] Dynamic subtest pipe-B-plane-5: SKIP (0.000s) [897.088067] Starting dynamic subtest: pipe-B-plane-7 [897.090891] Dynamic subtest pipe-B-plane-7: SKIP (0.000s) [897.096050] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping: SKIP (0.225s) [897.281629] [113/134] (168s left) kms_plane_scaling (plane-downscale-factor-0-5-with-rotation) [898.767653] Starting subtest: plane-downscale-factor-0-5-with-rotation [898.769178] Starting dynamic subtest: pipe-A [899.239282] Dynamic subtest pipe-A: SKIP (0.469s) [899.252870] Starting dynamic subtest: pipe-B [899.677730] Dynamic subtest pipe-B: SKIP (0.437s) [899.690544] Starting dynamic subtest: pipe-C [900.119753] Dynamic subtest pipe-C: SKIP (0.441s) [900.132861] Starting dynamic subtest: pipe-D [900.562106] Dynamic subtest pipe-D: SKIP (0.438s) [900.564885] Subtest plane-downscale-factor-0-5-with-rotation: SKIP (1.791s) [900.765113] [114/134] (165s left) perf_pmu (busy-hang) [900.823111] Starting subtest: busy-hang [900.824736] Starting dynamic subtest: rcs0 [902.069324] Dynamic subtest rcs0: SUCCESS (1.248s) [902.082463] Starting dynamic subtest: bcs0 [903.269821] Dynamic subtest bcs0: SUCCESS (1.198s) [903.285833] Starting dynamic subtest: vcs0 [904.481850] Dynamic subtest vcs0: SUCCESS (1.208s) [904.497966] Starting dynamic subtest: vcs1 [905.688015] Dynamic subtest vcs1: SUCCESS (1.202s) [905.704071] Starting dynamic subtest: vecs0 [906.887853] Dynamic subtest vecs0: SUCCESS (1.196s) [906.891946] Subtest busy-hang: SUCCESS (6.069s) [907.024306] [115/134] (158s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-rc-ccs) [908.508018] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-rc-ccs [908.512200] Starting dynamic subtest: pipe-A-HDMI-A-4 [908.527460] Dynamic subtest pipe-A-HDMI-A-4: SKIP (0.001s) [908.541428] Starting dynamic subtest: pipe-B-HDMI-A-4 [908.557067] Dynamic subtest pipe-B-HDMI-A-4: SKIP (0.001s) [908.570462] Starting dynamic subtest: pipe-C-HDMI-A-4 [908.588899] Dynamic subtest pipe-C-HDMI-A-4: SKIP (0.001s) [908.602140] Starting dynamic subtest: pipe-D-HDMI-A-4 [908.619141] Dynamic subtest pipe-D-HDMI-A-4: SKIP (0.001s) [908.622473] Subtest crc-primary-rotation-180-4-tiled-mtl-rc-ccs: SKIP (0.014s) [908.800141] [116/134] (157s left) kms_cursor_crc (cursor-offscreen-128x42) [910.480765] Starting subtest: cursor-offscreen-128x42 [910.488111] Starting dynamic subtest: pipe-A-HDMI-A-4 [913.000939] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (2.510s) [913.036489] Starting dynamic subtest: pipe-D-HDMI-A-4 [915.422072] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (2.389s) [915.423465] Subtest cursor-offscreen-128x42: SUCCESS (4.932s) [915.888198] [117/134] (150s left) kms_plane_scaling (planes-upscale-20x20-downscale-factor-0-75) [917.377286] Starting subtest: planes-upscale-20x20-downscale-factor-0-75 [917.378690] Starting dynamic subtest: pipe-A [917.504914] Dynamic subtest pipe-A: SUCCESS (0.129s) [917.526338] Starting dynamic subtest: pipe-B [917.666836] Dynamic subtest pipe-B: SUCCESS (0.160s) [917.680694] Starting dynamic subtest: pipe-C [917.807952] Dynamic subtest pipe-C: SUCCESS (0.140s) [917.821930] Starting dynamic subtest: pipe-D [917.948876] Dynamic subtest pipe-D: SUCCESS (0.140s) [917.950295] Subtest planes-upscale-20x20-downscale-factor-0-75: SUCCESS (0.574s) [918.200642] [118/134] (147s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-0) [919.706497] Starting subtest: linear-max-hw-stride-64bpp-rotate-0 [920.809016] Subtest linear-max-hw-stride-64bpp-rotate-0: SUCCESS (1.099s) [921.045824] [119/134] (145s left) syncobj_basic (bad-pad-handle-to-fd) [921.092852] Starting subtest: bad-pad-handle-to-fd [921.094481] Subtest bad-pad-handle-to-fd: SUCCESS (0.000s) [921.244266] [120/134] (145s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions) [922.731924] Starting subtest: cursorA-vs-flipB-atomic-transitions [922.734926] Subtest cursorA-vs-flipB-atomic-transitions: SKIP (0.002s) [922.929990] [121/134] (143s left) kms_frontbuffer_tracking (psr-2p-rte) [924.439370] Starting subtest: psr-2p-rte [924.442402] Subtest psr-2p-rte: SKIP (0.000s) [924.695417] [122/134] (141s left) kms_frontbuffer_tracking (psr-shrfb-scaledprimary) [926.189513] Starting subtest: psr-shrfb-scaledprimary [926.192574] Subtest psr-shrfb-scaledprimary: SKIP (0.000s) [926.433211] [123/134] (140s left) gen7_exec_parse (cmd-crossing-page) [926.484199] Subtest cmd-crossing-page: SKIP (0.000s) [926.572287] [124/134] (140s left) kms_frontbuffer_tracking (fbc-1p-rte) [928.071101] Starting subtest: fbc-1p-rte [931.593492] Subtest fbc-1p-rte: SUCCESS (3.524s) [931.918216] [125/134] (135s left) gem_mmap_wc (write) [931.969011] Subtest write: SKIP (0.000s) [932.038757] [126/134] (134s left) kms_busy (extended-modeset-hang-newfb) [933.530279] Starting subtest: extended-modeset-hang-newfb [933.534645] Starting dynamic subtest: pipe-A [949.097506] Dynamic subtest pipe-A: SUCCESS (15.565s) [949.114748] Starting dynamic subtest: pipe-D [964.643060] Dynamic subtest pipe-D: SUCCESS (15.529s) [964.644529] Subtest extended-modeset-hang-newfb: SUCCESS (31.103s) [964.844582] [127/134] (102s left) i915_pm_rpm (gem-evict-pwrite) [968.365483] Starting subtest: gem-evict-pwrite [968.370383] Subtest gem-evict-pwrite: SKIP (0.000s) [969.329572] [128/134] ( 97s left) kms_ccs (bad-pixel-format-y-tiled-gen12-rc-ccs) [970.828148] Starting subtest: bad-pixel-format-y-tiled-gen12-rc-ccs [970.832498] Starting dynamic subtest: pipe-A-HDMI-A-4 [970.847039] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.001s) [970.860794] Starting dynamic subtest: pipe-B-HDMI-A-4 [970.875598] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.001s) [970.888990] Starting dynamic subtest: pipe-C-HDMI-A-4 [970.903998] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.001s) [970.917427] Starting dynamic subtest: pipe-D-HDMI-A-4 [970.929198] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.001s) [970.930581] Subtest bad-pixel-format-y-tiled-gen12-rc-ccs: SUCCESS (0.013s) [971.118453] [129/134] ( 96s left) i915_suspend (basic-s2idle-without-i915) [971.161895] Starting subtest: basic-s2idle-without-i915 [991.366642] Subtest basic-s2idle-without-i915: SUCCESS (5.585s) [995.484342] [130/134] ( 75s left) kms_flip_scaled_crc (flip-32bpp-xtile-to-64bpp-xtile-upscaling) [996.973590] Starting subtest: flip-32bpp-xtile-to-64bpp-xtile-upscaling [996.975124] Starting dynamic subtest: pipe-A-valid-mode [998.107594] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.128s) [998.109020] Subtest flip-32bpp-xtile-to-64bpp-xtile-upscaling: SUCCESS (1.131s) [998.306724] [131/134] ( 73s left) kms_big_fb (4-tiled-addfb) [999.810792] Starting subtest: 4-tiled-addfb [999.814342] Subtest 4-tiled-addfb: SKIP (0.000s) [1000.077765] [132/134] ( 71s left) kms_setmode (basic-clone-single-crtc) [1000.122761] Starting subtest: basic-clone-single-crtc [1000.127645] Subtest basic-clone-single-crtc: SKIP (0.000s) [1000.325466] [133/134] ( 71s left) gem_exec_balancer (full-late-pulse) [1000.385617] Starting subtest: full-late-pulse [1002.778830] Subtest full-late-pulse: SUCCESS (2.393s) [1003.272470] [134/134] ( 68s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-render) [1004.762709] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-render [1004.765652] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s) [1004.992416] Closing watchdogs results: parsing output: 0/ for test: kms_frontbuffer_tracking results: parsing output: 1/ for test: gem_exec_params results: parsing output: 2/ for test: tools_test results: parsing output: 3/ for test: kms_selftest results: parsing output: 4/ for test: gem_exec_suspend results: parsing output: 5/ for test: kms_content_protection results: parsing output: 6/ for test: gem_eio results: parsing output: 7/ for test: gem_spin_batch results: parsing output: 8/ for test: kms_psr results: parsing output: 9/ for test: kms_frontbuffer_tracking results: parsing output: 10/ for test: kms_frontbuffer_tracking results: parsing output: 11/ for test: kms_psr2_sf results: parsing output: 12/ for test: kms_psr2_sf results: parsing output: 13/ for test: kms_pm_rpm results: parsing output: 14/ for test: gem_ctx_exec results: parsing output: 15/ for test: gem_pxp results: parsing output: 16/ for test: kms_flip results: parsing output: 17/ for test: prime_mmap results: parsing output: 18/ for test: gem_exec_schedule results: parsing output: 19/ for test: perf results: parsing output: 20/ for test: api_intel_allocator results: parsing output: 21/ for test: kms_flip results: parsing output: 22/ for test: kms_psr2_sf results: parsing output: 23/ for test: syncobj_wait results: parsing output: 24/ for test: gem_exec_create results: parsing output: 25/ for test: gem_ctx_persistence results: parsing output: 26/ for test: gem_ctx_bad_destroy results: parsing output: 27/ for test: kms_cursor_legacy results: parsing output: 28/ for test: kms_atomic_interruptible results: parsing output: 29/ for test: kms_cdclk results: parsing output: 30/ for test: kms_big_fb results: parsing output: 31/ for test: perf_pmu results: parsing output: 32/ for test: kms_psr results: parsing output: 33/ for test: gem_exec_schedule results: parsing output: 34/ for test: kms_selftest results: parsing output: 35/ for test: syncobj_basic results: parsing output: 36/ for test: gem_lmem_swapping results: parsing output: 37/ for test: kms_mmap_write_crc results: parsing output: 38/ for test: kms_frontbuffer_tracking results: parsing output: 39/ for test: kms_addfb_basic results: parsing output: 40/ for test: kms_frontbuffer_tracking results: parsing output: 41/ for test: gem_ctx_exec results: parsing output: 42/ for test: kms_atomic results: parsing output: 43/ for test: gem_set_tiling_vs_gtt results: parsing output: 44/ for test: kms_big_fb results: parsing output: 45/ for test: kms_getfb results: parsing output: 46/ for test: syncobj_timeline results: parsing output: 47/ for test: gem_exec_reloc results: parsing output: 48/ for test: kms_frontbuffer_tracking results: parsing output: 49/ for test: gem_basic results: parsing output: 50/ for test: kms_frontbuffer_tracking results: parsing output: 51/ for test: gem_wait results: parsing output: 52/ for test: gem_exec_reloc results: parsing output: 53/ for test: kms_pm_rpm results: parsing output: 54/ for test: kms_dsc results: parsing output: 55/ for test: kms_psr results: parsing output: 56/ for test: kms_vblank results: parsing output: 57/ for test: syncobj_timeline results: parsing output: 58/ for test: kms_cursor_legacy results: parsing output: 59/ for test: kms_chamelium_hpd results: parsing output: 60/ for test: gem_exec_params results: parsing output: 61/ for test: kms_frontbuffer_tracking results: parsing output: 62/ for test: syncobj_timeline results: parsing output: 63/ for test: prime_vgem results: parsing output: 64/ for test: gem_exec_capture results: parsing output: 65/ for test: kms_cursor_crc results: parsing output: 66/ for test: kms_flip results: parsing output: 67/ for test: i915_pm_freq_api results: parsing output: 68/ for test: kms_frontbuffer_tracking results: parsing output: 69/ for test: kms_chamelium_frames results: parsing output: 70/ for test: kms_cursor_crc results: parsing output: 71/ for test: kms_color_pipeline results: parsing output: 72/ for test: kms_frontbuffer_tracking results: parsing output: 73/ for test: kms_frontbuffer_tracking results: parsing output: 74/ for test: syncobj_timeline results: parsing output: 75/ for test: kms_ccs results: parsing output: 76/ for test: kms_addfb_basic results: parsing output: 77/ for test: kms_frontbuffer_tracking results: parsing output: 78/ for test: gem_mmap_offset results: parsing output: 79/ for test: gem_pread results: parsing output: 80/ for test: kms_joiner results: parsing output: 81/ for test: i915_drm_fdinfo results: parsing output: 82/ for test: gem_ccs results: parsing output: 83/ for test: kms_plane results: parsing output: 84/ for test: kms_frontbuffer_tracking results: parsing output: 85/ for test: kms_flip_scaled_crc results: parsing output: 86/ for test: kms_frontbuffer_tracking results: parsing output: 87/ for test: kms_draw_crc results: parsing output: 88/ for test: kms_big_fb results: parsing output: 89/ for test: gem_render_copy results: parsing output: 90/ for test: syncobj_wait results: parsing output: 91/ for test: kms_frontbuffer_tracking results: parsing output: 92/ for test: kms_big_fb results: parsing output: 93/ for test: api_intel_bb results: parsing output: 94/ for test: kms_psr results: parsing output: 95/ for test: gem_exercise_blt results: parsing output: 96/ for test: sysfs_heartbeat_interval results: parsing output: 97/ for test: kms_cursor_legacy results: parsing output: 98/ for test: gem_exec_schedule results: parsing output: 99/ for test: kms_frontbuffer_tracking results: parsing output: 100/ for test: kms_cursor_legacy results: parsing output: 101/ for test: gem_ctx_shared results: parsing output: 102/ for test: gem_exec_fence results: parsing output: 103/ for test: gem_render_copy results: parsing output: 104/ for test: drm_read results: parsing output: 105/ for test: kms_atomic_transition results: parsing output: 106/ for test: syncobj_timeline results: parsing output: 107/ for test: kms_ccs results: parsing output: 108/ for test: kms_pipe_crc_basic results: parsing output: 109/ for test: kms_frontbuffer_tracking results: parsing output: 110/ for test: kms_frontbuffer_tracking results: parsing output: 111/ for test: kms_plane results: parsing output: 112/ for test: kms_plane_scaling results: parsing output: 113/ for test: perf_pmu results: parsing output: 114/ for test: kms_ccs results: parsing output: 115/ for test: kms_cursor_crc results: parsing output: 116/ for test: kms_plane_scaling results: parsing output: 117/ for test: kms_big_fb results: parsing output: 118/ for test: syncobj_basic results: parsing output: 119/ for test: kms_cursor_legacy results: parsing output: 120/ for test: kms_frontbuffer_tracking results: parsing output: 121/ for test: kms_frontbuffer_tracking results: parsing output: 122/ for test: gen7_exec_parse results: parsing output: 123/ for test: kms_frontbuffer_tracking results: parsing output: 124/ for test: gem_mmap_wc results: parsing output: 125/ for test: kms_busy results: parsing output: 126/ for test: i915_pm_rpm results: parsing output: 127/ for test: kms_ccs results: parsing output: 128/ for test: i915_suspend results: parsing output: 129/ for test: kms_flip_scaled_crc results: parsing output: 130/ for test: kms_big_fb results: parsing output: 131/ for test: kms_setmode results: parsing output: 132/ for test: gem_exec_balancer results: parsing output: 133/ for test: kms_frontbuffer_tracking Done.