[38.432365] Initializing watchdogs [38.432404] /dev/watchdog0 [38.438421] [001/142] (960s left) gem_tiled_fence_blits (basic) [38.500044] Subtest basic: SKIP (0.000s) [38.535515] [002/142] (960s left) gem_pread (bench) [38.591483] Subtest bench: SKIP (0.000s) [38.622947] [003/142] (960s left) kms_prime (d3hot) [39.175417] Subtest D3hot: SKIP (0.000s) [39.253793] [004/142] (959s left) gem_mmap_wc (write-cpu-read-wc) [39.301905] Subtest write-cpu-read-wc: SKIP (0.000s) [39.320164] [005/142] (959s left) gem_madvise (dontneed-after-mmap) [39.377628] Starting subtest: dontneed-after-mmap [39.381929] Subtest dontneed-after-mmap: SUCCESS (0.002s) [39.466941] [006/142] (959s left) kms_frontbuffer_tracking (psr-2p-scndscrn-indfb-msflip-blt) [39.534226] Starting subtest: psr-2p-scndscrn-indfb-msflip-blt [39.537892] Subtest psr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s) [39.622579] [007/142] (959s left) kms_dsc (dsc-with-formats) [39.674615] Starting subtest: dsc-with-formats [39.678388] Subtest dsc-with-formats: SKIP (0.001s) [39.721129] [008/142] (959s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-25) [39.781477] Starting subtest: planes-unity-scaling-downscale-factor-0-25 [39.783684] Starting dynamic subtest: pipe-A-eDP-1 [39.793212] Dynamic subtest pipe-A-eDP-1: SKIP (0.012s) [39.797879] Starting dynamic subtest: pipe-B-eDP-1 [39.811379] Dynamic subtest pipe-B-eDP-1: SKIP (0.016s) [39.819091] Starting dynamic subtest: pipe-C-eDP-1 [39.826804] Dynamic subtest pipe-C-eDP-1: SKIP (0.015s) [39.835212] Starting dynamic subtest: pipe-D-eDP-1 [39.842738] Dynamic subtest pipe-D-eDP-1: SKIP (0.015s) [39.846164] Subtest planes-unity-scaling-downscale-factor-0-25: SKIP (0.062s) [39.911239] [009/142] (959s left) gem_userptr_blits (sync-unmap) [39.969334] Starting subtest: sync-unmap [39.988660] Subtest sync-unmap: SUCCESS (0.018s) [40.089923] [010/142] (959s left) kms_pipe_crc_basic (read-crc) [40.165937] Starting subtest: read-crc [40.168043] Starting dynamic subtest: pipe-A-eDP-1 [40.912976] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.744s) [40.923150] Starting dynamic subtest: pipe-B-eDP-1 [42.405726] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.490s) [42.415391] Starting dynamic subtest: pipe-C-eDP-1 [43.801875] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.395s) [43.812227] Starting dynamic subtest: pipe-D-eDP-1 [45.215960] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.412s) [45.218076] Subtest read-crc: SUCCESS (5.048s) [46.118162] [011/142] (953s left) kms_ccs (pipe-b-bad-rotation-90-4_tiled_mtl_rc_ccs_cc) [46.514753] Starting subtest: pipe-B-bad-rotation-90-4_tiled_mtl_rc_ccs_cc [47.346362] Subtest pipe-B-bad-rotation-90-4_tiled_mtl_rc_ccs_cc: SUCCESS (0.830s) [48.521075] [012/142] (950s left) kms_psr2_sf (overlay-plane-update-sf-dmg-area) [53.676402] Starting subtest: overlay-plane-update-sf-dmg-area [53.678993] Starting dynamic subtest: pipe-A-eDP-1 [60.576142] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.896s) [60.586458] Starting dynamic subtest: pipe-B-eDP-1 [67.414698] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.835s) [67.417365] Subtest overlay-plane-update-sf-dmg-area: SUCCESS (13.736s) [68.326140] [013/142] (930s left) gem_exec_reloc (basic-gtt-cpu) [68.393058] Subtest basic-gtt-cpu: SKIP (0.000s) [68.446983] [014/142] (930s left) kms_ccs (pipe-a-bad-rotation-90-y_tiled_gen12_mc_ccs) [68.808597] Starting subtest: pipe-A-bad-rotation-90-y_tiled_gen12_mc_ccs [68.813415] Subtest pipe-A-bad-rotation-90-y_tiled_gen12_mc_ccs: SKIP (0.000s) [69.723301] [015/142] (929s left) kms_big_fb (linear-16bpp-rotate-270) [69.815533] Starting subtest: linear-16bpp-rotate-270 [69.831476] Subtest linear-16bpp-rotate-270: SKIP (0.016s) [69.919910] [016/142] (929s left) gem_exec_schedule (preempt-queue-contexts) [69.983526] Subtest preempt-queue-contexts: SKIP (0.000s) [70.261624] [017/142] (928s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-onoff) [70.365980] Starting subtest: fbc-2p-scndscrn-spr-indfb-onoff [70.370191] Subtest fbc-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s) [70.440344] [018/142] (928s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-mmap-wc) [70.522556] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-mmap-wc [75.182094] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (4.662s) [75.312619] [019/142] (923s left) gem_partial_pwrite_pread (writes-after-reads) [75.388354] Subtest writes-after-reads: SKIP (0.000s) [75.444807] [020/142] (923s left) gem_exec_params (dr4-dirt) [75.506475] Starting subtest: DR4-dirt [75.509405] Subtest DR4-dirt: SUCCESS (0.000s) [75.581500] [021/142] (923s left) kms_chamelium_edid (dp-edid-resolution-list) [75.957235] Subtest dp-edid-resolution-list: SKIP (0.000s) [76.804163] [022/142] (922s left) kms_frontbuffer_tracking (fbc-2p-indfb-fliptrack-mmap-gtt) [76.873392] Starting subtest: fbc-2p-indfb-fliptrack-mmap-gtt [76.877322] Subtest fbc-2p-indfb-fliptrack-mmap-gtt: SKIP (0.000s) [76.954199] [023/142] (922s left) syncobj_timeline (invalid-multi-wait-unsubmitted-signaled) [77.009458] Starting subtest: invalid-multi-wait-unsubmitted-signaled [77.011836] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.001s) [77.068930] [024/142] (922s left) perf_pmu (multi-client) [77.122514] Starting subtest: multi-client [77.124812] Starting dynamic subtest: rcs0 [78.153586] Dynamic subtest rcs0: SUCCESS (1.029s) [78.165092] Starting dynamic subtest: bcs0 [79.199967] Dynamic subtest bcs0: SUCCESS (1.046s) [79.210787] Starting dynamic subtest: vcs0 [80.246600] Dynamic subtest vcs0: SUCCESS (1.046s) [80.257924] Starting dynamic subtest: vcs1 [81.401110] Dynamic subtest vcs1: SUCCESS (1.154s) [81.412405] Starting dynamic subtest: vecs0 [83.447825] Dynamic subtest vecs0: SUCCESS (2.045s) [83.459115] Starting dynamic subtest: ccs0 [85.433242] Dynamic subtest ccs0: SUCCESS (1.985s) [85.436255] Subtest multi-client: SUCCESS (8.310s) [85.537937] [025/142] (913s left) kms_ccs (pipe-c-crc-sprite-planes-basic-4_tiled_dg2_mc_ccs) [85.929435] Starting subtest: pipe-C-crc-sprite-planes-basic-4_tiled_dg2_mc_ccs [85.934526] Subtest pipe-C-crc-sprite-planes-basic-4_tiled_dg2_mc_ccs: SKIP (0.001s) [86.809578] [026/142] (912s left) syncobj_wait (invalid-reset-bad-pad) [86.880626] Starting subtest: invalid-reset-bad-pad [86.883201] Subtest invalid-reset-bad-pad: SUCCESS (0.000s) [86.942029] [027/142] (912s left) gem_mmap_gtt (close-race) [86.993992] Subtest close-race: SKIP (0.000s) [87.012716] [028/142] (912s left) gem_ctx_param (get-priority-new-ctx) [87.047876] Starting subtest: get-priority-new-ctx [87.050382] Subtest get-priority-new-ctx: SUCCESS (0.000s) [87.107272] [029/142] (912s left) gem_busy (semaphore) [87.299636] Subtest semaphore: SKIP (0.000s) [87.500910] [030/142] (912s left) gem_ctx_isolation (dirty-create) [87.552488] Starting subtest: dirty-create [87.554671] Starting dynamic subtest: rcs0 [87.652697] Dynamic subtest rcs0: SUCCESS (0.100s) [87.664077] Starting dynamic subtest: bcs0 [87.792949] Dynamic subtest bcs0: SUCCESS (0.140s) [87.797876] Starting dynamic subtest: vcs0 [87.956953] Dynamic subtest vcs0: SUCCESS (0.164s) [87.968161] Starting dynamic subtest: vcs1 [89.493645] Dynamic subtest vcs1: SUCCESS (1.536s) [89.505126] Starting dynamic subtest: vecs0 [91.549066] Dynamic subtest vecs0: SUCCESS (2.055s) [91.560515] Starting dynamic subtest: ccs0 [93.576055] Dynamic subtest ccs0: SUCCESS (2.027s) [93.578495] Subtest dirty-create: SUCCESS (6.023s) [93.799591] [031/142] (905s left) kms_ccs (pipe-a-random-ccs-data-y_tiled_ccs) [94.179496] Starting subtest: pipe-A-random-ccs-data-y_tiled_ccs [94.186768] Subtest pipe-A-random-ccs-data-y_tiled_ccs: SKIP (0.000s) [95.048358] [032/142] (904s left) gem_exec_whisper (basic-queues-forked) [95.103114] Starting subtest: basic-queues-forked [118.507971] Subtest basic-queues-forked: SUCCESS (23.402s) [118.682349] [033/142] (880s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-gtt) [118.772143] Starting subtest: fbc-rgb565-draw-mmap-gtt [118.776401] Subtest fbc-rgb565-draw-mmap-gtt: SKIP (0.000s) [118.850374] [034/142] (880s left) kms_writeback (writeback-check-output) [118.955159] Subtest writeback-check-output: SKIP (0.000s) [118.973192] [035/142] (880s left) kms_plane (invalid-pixel-format-settings) [119.046222] Starting subtest: invalid-pixel-format-settings [119.073523] Subtest invalid-pixel-format-settings: SUCCESS (0.027s) [119.134270] [036/142] (880s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-blt) [119.222695] Starting subtest: psr-1p-primscrn-pri-indfb-draw-blt [124.406347] Subtest psr-1p-primscrn-pri-indfb-draw-blt: SUCCESS (5.187s) [124.518237] [037/142] (875s left) kms_dsc (dsc-with-output-formats-with-bpc) [124.577766] Starting subtest: dsc-with-output-formats-with-bpc [124.582260] Subtest dsc-with-output-formats-with-bpc: SKIP (0.001s) [124.637702] [038/142] (875s left) gem_exec_balancer (indices) [124.716184] Starting subtest: indices [126.405281] Subtest indices: SUCCESS (1.687s) [126.647637] [039/142] (873s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-pwrite) [126.745329] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-pwrite [131.966518] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (5.226s) [132.096547] [040/142] (867s left) gen9_exec_parse (bb-chained) [132.141615] Subtest bb-chained: SKIP (0.000s) [132.172417] [041/142] (867s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-pgflip-blt) [132.243644] Starting subtest: fbc-2p-primscrn-shrfb-pgflip-blt [132.248075] Subtest fbc-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s) [132.322980] [042/142] (867s left) gem_exec_params (invalid-flag) [132.384684] Starting subtest: invalid-flag [132.387589] Subtest invalid-flag: SUCCESS (0.000s) [132.473273] [043/142] (867s left) gem_mmap_gtt (basic-small-copy-xy) [132.511893] Subtest basic-small-copy-XY: SKIP (0.000s) [132.532294] [044/142] (867s left) kms_vblank (pipe-b-wait-idle-hang) [132.612348] Starting subtest: pipe-B-wait-idle-hang [147.257612] Subtest pipe-B-wait-idle-hang: SUCCESS (14.646s) [148.205445] [045/142] (851s left) gem_ctx_engines (execute-oneforall) [148.263375] Starting subtest: execute-oneforall [148.429661] Subtest execute-oneforall: SUCCESS (0.168s) [149.516765] [046/142] (850s left) perf (global-sseu-config-invalid) [149.649839] Subtest global-sseu-config-invalid: SKIP (0.000s) [149.672926] [047/142] (850s left) api_intel_bb (misplaced-blitter) [149.740642] Starting subtest: misplaced-blitter [149.746634] Subtest misplaced-blitter: SUCCESS (0.007s) [149.835413] [048/142] (850s left) dmabuf_sync_file (export-multiwait) [149.886334] Starting subtest: export-multiwait [149.888565] Subtest export-multiwait: SUCCESS (0.001s) [149.925294] [049/142] (850s left) v3d/v3d_submit_cl (simple-flush-cache) [149.985985] Subtest simple-flush-cache: SKIP (0.000s) [150.029978] [050/142] (849s left) vc4/vc4_create_bo (create-bo-zeroed) [150.098024] Subtest create-bo-zeroed: SKIP (0.000s) [150.136451] [051/142] (849s left) syncobj_timeline (wait-all-for-submit-complex) [150.188914] Starting subtest: wait-all-for-submit-complex [150.402930] Subtest wait-all-for-submit-complex: SUCCESS (0.213s) [150.466172] [052/142] (849s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-blt) [150.559392] Starting subtest: psr-1p-primscrn-cur-indfb-draw-blt [155.408687] Subtest psr-1p-primscrn-cur-indfb-draw-blt: SUCCESS (4.853s) [155.531170] [053/142] (844s left) kms_properties (get_properties-sanity-non-atomic) [155.620917] Starting subtest: get_properties-sanity-non-atomic [155.623286] Subtest get_properties-sanity-non-atomic: SUCCESS (0.001s) [155.685619] [054/142] (844s left) sysfs_timeslice_duration (timeout) [155.741799] Starting subtest: timeout [155.744519] Starting dynamic subtest: vecs0 [165.402189] Dynamic subtest vecs0: SUCCESS (9.655s) [165.414444] Starting dynamic subtest: ccs0 [165.926134] Dynamic subtest ccs0: SUCCESS (0.526s) [165.935361] Starting dynamic subtest: vcs0 [175.454368] Dynamic subtest vcs0: SUCCESS (9.524s) [175.467272] Starting dynamic subtest: bcs0 [175.980954] Dynamic subtest bcs0: SUCCESS (0.529s) [175.988244] Starting dynamic subtest: rcs0 [176.465333] Dynamic subtest rcs0: SUCCESS (0.482s) [176.479032] Starting dynamic subtest: vcs1 [186.463883] Dynamic subtest vcs1: SUCCESS (9.994s) [186.466457] Subtest timeout: SUCCESS (30.718s) [186.526845] [055/142] (813s left) gem_softpin (noreloc-s3) [186.570662] Starting subtest: noreloc-S3 [206.950021] Subtest noreloc-S3: SUCCESS (5.383s) [207.048219] [056/142] (808s left) kms_cursor_crc (cursor-size-change) [207.122098] Starting subtest: cursor-size-change [207.124516] Starting dynamic subtest: pipe-A-eDP-1 [208.043309] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.921s) [208.054680] Starting dynamic subtest: pipe-D-eDP-1 [209.604062] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.559s) [209.606520] Subtest cursor-size-change: SUCCESS (2.484s) [210.477143] [057/142] (804s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-pwrite) [210.544787] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-pwrite [210.548792] Subtest psr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s) [210.631004] [058/142] (804s left) syncobj_timeline (etime-multi-wait-all-for-submit-submitted) [210.677954] Starting subtest: etime-multi-wait-all-for-submit-submitted [210.783806] Subtest etime-multi-wait-all-for-submit-submitted: SUCCESS (0.107s) [210.848082] [059/142] (804s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-cpu) [210.909500] Starting subtest: psr-rgb101010-draw-mmap-cpu [215.880457] Subtest psr-rgb101010-draw-mmap-cpu: SUCCESS (4.973s) [215.989421] [060/142] (799s left) kms_ccs (pipe-c-bad-aux-stride-4_tiled_mtl_mc_ccs) [216.378939] Starting subtest: pipe-C-bad-aux-stride-4_tiled_mtl_mc_ccs [216.455390] Subtest pipe-C-bad-aux-stride-4_tiled_mtl_mc_ccs: SUCCESS (0.077s) [217.211167] [061/142] (798s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180) [217.289894] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180 [217.294637] Subtest y-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s) [217.369210] [062/142] (797s left) gem_render_copy (y-tiled-to-vebox-linear) [217.426294] Starting subtest: y-tiled-to-vebox-linear [217.430818] Subtest y-tiled-to-vebox-linear: SKIP (0.000s) [217.599769] [063/142] (797s left) syncobj_timeline (etime-multi-wait-for-submit-submitted) [217.654912] Starting subtest: etime-multi-wait-for-submit-submitted [217.759519] Subtest etime-multi-wait-for-submit-submitted: SUCCESS (0.105s) [217.827264] [064/142] (797s left) kms_atomic_transition (modeset-transition-fencing) [217.896889] Starting subtest: modeset-transition-fencing [217.899386] Starting dynamic subtest: 1x-outputs [230.034757] Dynamic subtest 1x-outputs: SUCCESS (12.139s) [230.330243] Subtest modeset-transition-fencing: SUCCESS (12.434s) [231.220137] [065/142] (784s left) vc4/vc4_tiling (set-bad-flags) [231.280316] Subtest set-bad-flags: SKIP (0.000s) [231.325725] [066/142] (784s left) gem_fenced_exec_thrash (no-spare-fences-busy) [231.382571] Subtest no-spare-fences-busy: SKIP (0.000s) [231.409544] [067/142] (784s left) gem_exec_nop (basic-parallel) [231.478438] Starting subtest: basic-parallel [247.385056] Subtest basic-parallel: SUCCESS (15.916s) [247.581729] [068/142] (767s left) kms_force_connector_basic (force-load-detect) [247.655101] Starting subtest: force-load-detect [247.660085] Subtest force-load-detect: SKIP (0.000s) [247.739327] [069/142] (767s left) kms_cursor_legacy (cursora-vs-flipb-toggle) [247.830656] Starting subtest: cursorA-vs-flipB-toggle [247.835411] Subtest cursorA-vs-flipB-toggle: SKIP (0.002s) [247.973377] [070/142] (767s left) kms_flip (wf_vblank-ts-check) [248.043604] Starting subtest: wf_vblank-ts-check [248.046125] Starting dynamic subtest: A-eDP1 [257.054488] Dynamic subtest A-eDP1: SUCCESS (9.013s) [257.069008] Starting dynamic subtest: B-eDP1 [266.020600] Dynamic subtest B-eDP1: SUCCESS (8.959s) [266.033362] Starting dynamic subtest: C-eDP1 [275.027681] Dynamic subtest C-eDP1: SUCCESS (9.011s) [275.042520] Starting dynamic subtest: D-eDP1 [283.988400] Dynamic subtest D-eDP1: SUCCESS (8.959s) [283.996162] Subtest wf_vblank-ts-check: SUCCESS (35.957s) [285.249556] [071/142] (730s left) kms_ccs (pipe-b-crc-primary-basic-4_tiled_mtl_rc_ccs) [285.607505] Starting subtest: pipe-B-crc-primary-basic-4_tiled_mtl_rc_ccs [286.671595] Subtest pipe-B-crc-primary-basic-4_tiled_mtl_rc_ccs: SUCCESS (1.065s) [287.861632] [072/142] (727s left) kms_big_fb (4-tiled-64bpp-rotate-180) [287.931935] Starting subtest: 4-tiled-64bpp-rotate-180 [289.440269] Subtest 4-tiled-64bpp-rotate-180: SUCCESS (1.511s) [289.620900] [073/142] (725s left) kms_ccs (pipe-a-crc-primary-basic-4_tiled_dg2_rc_ccs) [289.973855] Starting subtest: pipe-A-crc-primary-basic-4_tiled_dg2_rc_ccs [289.979073] Subtest pipe-A-crc-primary-basic-4_tiled_dg2_rc_ccs: SKIP (0.001s) [290.865907] [074/142] (724s left) kms_ccs (pipe-c-ccs-on-another-bo-y_tiled_gen12_rc_ccs) [291.251997] Starting subtest: pipe-C-ccs-on-another-bo-y_tiled_gen12_rc_ccs [291.257375] Subtest pipe-C-ccs-on-another-bo-y_tiled_gen12_rc_ccs: SKIP (0.000s) [292.146650] [075/142] (723s left) gem_mmap_wc (copy) [292.197156] Subtest copy: SKIP (0.000s) [292.216652] [076/142] (723s left) gem_exec_reloc (basic-gtt-noreloc) [292.265939] Subtest basic-gtt-noreloc: SKIP (0.000s) [292.330638] [077/142] (723s left) api_intel_allocator (gem-pool) [292.389845] Starting subtest: gem-pool [292.394653] Subtest gem-pool: SUCCESS (0.009s) [292.486313] [078/142] (723s left) gem_exec_params (sol-reset-invalid) [292.537596] Starting subtest: sol-reset-invalid [292.539928] Subtest sol-reset-invalid: SUCCESS (0.002s) [294.506817] [079/142] (721s left) kms_ccs (pipe-d-bad-pixel-format-y_tiled_gen12_rc_ccs) [294.938560] Starting subtest: pipe-D-bad-pixel-format-y_tiled_gen12_rc_ccs [294.944598] Subtest pipe-D-bad-pixel-format-y_tiled_gen12_rc_ccs: SKIP (0.000s) [295.796018] [080/142] (719s left) kms_scaling_modes (scaling-mode-full) [295.878644] Starting subtest: scaling-mode-full [295.881064] Starting dynamic subtest: eDP-1-pipe-A [295.959769] Dynamic subtest eDP-1-pipe-A: SUCCESS (0.083s) [295.970626] Starting dynamic subtest: eDP-1-pipe-B [297.207352] Dynamic subtest eDP-1-pipe-B: SUCCESS (1.245s) [297.217787] Starting dynamic subtest: eDP-1-pipe-C [298.474501] Dynamic subtest eDP-1-pipe-C: SUCCESS (1.267s) [298.483640] Starting dynamic subtest: eDP-1-pipe-D [299.678646] Dynamic subtest eDP-1-pipe-D: SUCCESS (1.202s) [299.681107] Subtest scaling-mode-full: SUCCESS (3.803s) [300.929541] [081/142] (714s left) gem_ctx_shared (q-independent) [301.000525] Starting subtest: Q-independent [301.003262] Starting dynamic subtest: rcs0 [301.036668] Dynamic subtest rcs0: SUCCESS (0.036s) [301.052788] Starting dynamic subtest: vcs0 [301.055456] Dynamic subtest vcs0: SUCCESS (0.015s) [301.069477] Starting dynamic subtest: vcs1 [301.072541] Dynamic subtest vcs1: SUCCESS (0.014s) [301.083693] Starting dynamic subtest: vecs0 [301.086557] Dynamic subtest vecs0: SUCCESS (0.015s) [301.095105] Starting dynamic subtest: ccs0 [301.101780] Dynamic subtest ccs0: SUCCESS (0.019s) [301.104074] Subtest Q-independent: SUCCESS (0.102s) [302.534403] [082/142] (713s left) gem_exec_flush (basic-uc-ro-default) [302.582629] Starting subtest: basic-uc-ro-default [308.047979] Subtest basic-uc-ro-default: SUCCESS (5.468s) [308.229659] [083/142] (707s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-async-flip) [308.321716] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-async-flip [308.911529] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.592s) [309.046808] [084/142] (706s left) kms_lease (master-vs-lease) [309.141260] Starting subtest: master-vs-lease [309.143095] Subtest master-vs-lease: SUCCESS (0.001s) [309.204711] [085/142] (706s left) kms_cursor_crc (cursor-rapid-movement-128x128) [309.304293] Starting subtest: cursor-rapid-movement-128x128 [309.306628] Starting dynamic subtest: pipe-A-eDP-1 [309.851744] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.545s) [309.884813] Starting dynamic subtest: pipe-D-eDP-1 [311.182083] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.309s) [311.184549] Subtest cursor-rapid-movement-128x128: SUCCESS (1.880s) [312.073458] [086/142] (703s left) gem_exec_schedule (timeslicing) [312.146590] Starting subtest: timeslicing [312.149210] Starting dynamic subtest: rcs0 [312.151538] Dynamic subtest rcs0: SUCCESS (0.018s) [312.164685] Starting dynamic subtest: bcs0 [312.167127] Dynamic subtest bcs0: SUCCESS (0.018s) [312.179930] Starting dynamic subtest: vcs0 [312.185424] Dynamic subtest vcs0: SUCCESS (0.019s) [312.199091] Starting dynamic subtest: vcs1 [312.205807] Dynamic subtest vcs1: SUCCESS (0.019s) [312.216607] Starting dynamic subtest: vecs0 [312.225384] Dynamic subtest vecs0: SUCCESS (0.019s) [312.239224] Starting dynamic subtest: ccs0 [312.246037] Dynamic subtest ccs0: SUCCESS (0.019s) [312.248481] Subtest timeslicing: SUCCESS (0.118s) [313.498010] [087/142] (702s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-downscaling) [313.564835] Starting subtest: flip-64bpp-linear-to-32bpp-linear-downscaling [313.567162] Starting dynamic subtest: pipe-A-default-mode [314.762784] Dynamic subtest pipe-A-default-mode: SKIP (1.196s) [314.768289] Subtest flip-64bpp-linear-to-32bpp-linear-downscaling: SKIP (1.198s) [314.875168] [088/142] (701s left) kms_properties (connector-properties-legacy) [314.953968] Starting subtest: connector-properties-legacy [323.532511] Subtest connector-properties-legacy: SUCCESS (8.574s) [324.402809] [089/142] (691s left) gem_render_copy (mixed-tiled-to-yf-tiled-ccs) [324.455430] Starting subtest: mixed-tiled-to-yf-tiled-ccs [324.460275] Subtest mixed-tiled-to-yf-tiled-ccs: SKIP (0.000s) [324.631512] [090/142] (691s left) kms_addfb_basic (addfb25-yf-tiled-legacy) [324.697141] Starting subtest: addfb25-yf-tiled-legacy [324.699457] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s) [324.766058] [091/142] (691s left) kms_cursor_crc (cursor-offscreen-128x42) [324.900666] Starting subtest: cursor-offscreen-128x42 [324.903108] Starting dynamic subtest: pipe-A-eDP-1 [326.868238] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.965s) [326.896488] Starting dynamic subtest: pipe-D-eDP-1 [329.620681] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.729s) [329.623356] Subtest cursor-offscreen-128x42: SUCCESS (4.720s) [330.514848] [092/142] (685s left) vc4/vc4_perfmon (destroy-invalid-perfmon) [330.583493] Subtest destroy-invalid-perfmon: SKIP (0.000s) [330.633713] [093/142] (685s left) gem_media_vme [330.727425] [094/142] (685s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu) [330.814166] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu [330.817919] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s) [330.895384] [095/142] (685s left) kms_plane_scaling (plane-downscale-with-modifiers-factor-0-25) [330.973540] Starting subtest: plane-downscale-with-modifiers-factor-0-25 [330.976009] Starting dynamic subtest: pipe-A-eDP-1 [331.001902] Dynamic subtest pipe-A-eDP-1: SKIP (0.025s) [331.013972] Starting dynamic subtest: pipe-B-eDP-1 [331.045900] Dynamic subtest pipe-B-eDP-1: SKIP (0.044s) [331.054641] Starting dynamic subtest: pipe-C-eDP-1 [331.101548] Dynamic subtest pipe-C-eDP-1: SKIP (0.052s) [331.107560] Starting dynamic subtest: pipe-D-eDP-1 [331.133037] Dynamic subtest pipe-D-eDP-1: SKIP (0.033s) [331.136869] Subtest plane-downscale-with-modifiers-factor-0-25: SKIP (0.158s) [331.230186] [096/142] (684s left) gem_userptr_blits (sync-unmap-after-close) [331.284890] Starting subtest: sync-unmap-after-close [331.287326] Subtest sync-unmap-after-close: SUCCESS (0.006s) [331.394890] [097/142] (684s left) kms_color (legacy-gamma-reset) [331.458522] Starting subtest: legacy-gamma-reset [331.460548] Starting dynamic subtest: pipe-A [331.827900] Dynamic subtest pipe-A: SUCCESS (0.371s) [331.842096] Starting dynamic subtest: pipe-B [331.844560] Dynamic subtest pipe-B: SUCCESS (0.009s) [331.854194] Starting dynamic subtest: pipe-C [331.856590] Dynamic subtest pipe-C: SUCCESS (0.008s) [331.864535] Starting dynamic subtest: pipe-D [331.866902] Dynamic subtest pipe-D: SUCCESS (0.008s) [331.869349] Subtest legacy-gamma-reset: SUCCESS (0.398s) [332.722346] [098/142] (683s left) gem_exec_capture (capture) [332.769058] Starting subtest: capture [332.771125] Starting dynamic subtest: rcs0-smem [333.612531] Dynamic subtest rcs0-smem: SUCCESS (0.843s) [333.618062] Starting dynamic subtest: bcs0-smem [334.702543] Dynamic subtest bcs0-smem: SUCCESS (1.091s) [334.708443] Starting dynamic subtest: vcs0-smem [335.535765] Dynamic subtest vcs0-smem: SUCCESS (0.833s) [335.549373] Starting dynamic subtest: vcs1-smem [336.372747] Dynamic subtest vcs1-smem: SUCCESS (0.836s) [336.386572] Starting dynamic subtest: vecs0-smem [337.697985] Dynamic subtest vecs0-smem: SUCCESS (1.325s) [337.711416] Starting dynamic subtest: ccs0-smem [338.532370] Dynamic subtest ccs0-smem: SUCCESS (0.831s) [338.534471] Subtest capture: SUCCESS (5.762s) [338.621647] [099/142] (677s left) v3d/v3d_get_param (base-params) [338.713058] Subtest base-params: SKIP (0.000s) [338.757233] [100/142] (677s left) kms_ccs (pipe-d-crc-primary-basic-y_tiled_gen12_rc_ccs) [339.185092] Starting subtest: pipe-D-crc-primary-basic-y_tiled_gen12_rc_ccs [339.190855] Subtest pipe-D-crc-primary-basic-y_tiled_gen12_rc_ccs: SKIP (0.000s) [340.004815] [101/142] (676s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-wc) [340.058862] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-wc [340.063514] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s) [340.143151] [102/142] (676s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip) [340.216266] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip [340.220159] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s) [340.297774] [103/142] (676s left) kms_flip (2x-flip-vs-dpms) [340.360429] Starting subtest: 2x-flip-vs-dpms [340.380023] Subtest 2x-flip-vs-dpms: SKIP (0.019s) [340.453147] [104/142] (675s left) kms_vblank (pipe-a-ts-continuation-modeset-hang) [340.515804] Starting subtest: pipe-A-ts-continuation-modeset-hang [354.233568] Subtest pipe-A-ts-continuation-modeset-hang: SUCCESS (13.718s) [355.135764] [105/142] (661s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180) [355.223273] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180 [355.227982] Subtest y-tiled-max-hw-stride-32bpp-rotate-180: SKIP (0.000s) [355.299524] [106/142] (661s left) kms_cursor_crc (cursor-sliding-64x64) [355.424068] Starting subtest: cursor-sliding-64x64 [355.426415] Starting dynamic subtest: pipe-A-eDP-1 [358.659487] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.231s) [358.692191] Starting dynamic subtest: pipe-D-eDP-1 [362.609153] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.928s) [362.611767] Subtest cursor-sliding-64x64: SUCCESS (7.186s) [363.505634] [107/142] (652s left) kms_ccs (pipe-a-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs) [363.861330] Starting subtest: pipe-A-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs [363.866477] Subtest pipe-A-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs: SKIP (0.001s) [364.736028] [108/142] (651s left) gem_exec_schedule (out-order) [364.790826] Starting subtest: out-order [364.793272] Starting dynamic subtest: rcs0 [364.839562] Dynamic subtest rcs0: SUCCESS (0.054s) [364.853489] Starting dynamic subtest: vcs0 [364.892338] Dynamic subtest vcs0: SUCCESS (0.052s) [364.905860] Starting dynamic subtest: vcs1 [364.949022] Dynamic subtest vcs1: SUCCESS (0.055s) [364.964108] Starting dynamic subtest: vecs0 [365.003619] Dynamic subtest vecs0: SUCCESS (0.054s) [365.018330] Starting dynamic subtest: ccs0 [365.061159] Dynamic subtest ccs0: SUCCESS (0.056s) [365.063900] Subtest out-order: SUCCESS (0.278s) [366.533854] [109/142] (649s left) kms_rotation_crc (sprite-rotation-90-pos-100-0) [366.618301] Starting subtest: sprite-rotation-90-pos-100-0 [366.622951] Subtest sprite-rotation-90-pos-100-0: SKIP (0.001s) [366.683786] [110/142] (649s left) i915_hangman (detector) [366.748889] Starting subtest: detector [366.750838] Starting dynamic subtest: rcs0 [378.392967] Dynamic subtest rcs0: SUCCESS (11.643s) [378.408560] Starting dynamic subtest: bcs0 [390.425265] Dynamic subtest bcs0: SUCCESS (12.030s) [390.441201] Starting dynamic subtest: vcs0 [395.130633] Dynamic subtest vcs0: FAIL (4.661s) [395.145363] Starting dynamic subtest: vcs1 [399.152358] Dynamic subtest vcs1: FAIL (4.014s) [399.167437] Starting dynamic subtest: vecs0 [403.139634] Dynamic subtest vecs0: FAIL (3.979s) [403.155406] Starting dynamic subtest: ccs0 [414.425442] Dynamic subtest ccs0: SUCCESS (11.339s) [414.428307] Subtest detector: FAIL (47.677s) [414.505663] [111/142] (602s left) kms_chamelium_color (ctm-blue-to-red) [414.561848] Subtest ctm-blue-to-red: SKIP (0.000s) [414.586320] [112/142] (601s left) i915_pm_rpm (drm-resources-equal) [416.619244] Starting subtest: drm-resources-equal [421.951868] Subtest drm-resources-equal: SUCCESS (5.331s) [422.038446] [113/142] (594s left) kms_hdr (static-toggle) [422.121124] Starting subtest: static-toggle [422.125817] Subtest static-toggle: SKIP (0.000s) [422.189195] [114/142] (594s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt) [422.265313] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt [422.269617] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [422.355468] [115/142] (594s left) kms_ccs (pipe-d-bad-aux-stride-y_tiled_gen12_mc_ccs) [422.787656] Starting subtest: pipe-D-bad-aux-stride-y_tiled_gen12_mc_ccs [422.793355] Subtest pipe-D-bad-aux-stride-y_tiled_gen12_mc_ccs: SKIP (0.000s) [423.668762] [116/142] (593s left) gem_wait (busy) [423.726286] Starting subtest: busy [423.728777] Starting dynamic subtest: all-engines [425.367393] Dynamic subtest all-engines: SUCCESS (1.639s) [425.383509] Starting dynamic subtest: rcs0 [425.906041] Dynamic subtest rcs0: SUCCESS (0.539s) [425.921873] Starting dynamic subtest: bcs0 [426.445276] Dynamic subtest bcs0: SUCCESS (0.538s) [426.463471] Starting dynamic subtest: vcs0 [428.374961] Dynamic subtest vcs0: SUCCESS (1.928s) [428.390017] Starting dynamic subtest: vcs1 [430.426527] Dynamic subtest vcs1: SUCCESS (2.047s) [430.444838] Starting dynamic subtest: vecs0 [432.407290] Dynamic subtest vecs0: SUCCESS (1.982s) [432.422682] Starting dynamic subtest: ccs0 [432.947905] Dynamic subtest ccs0: SUCCESS (0.541s) [432.950571] Subtest busy: SUCCESS (9.222s) [433.155352] [117/142] (583s left) gem_eio (throttle) [433.351236] Starting subtest: throttle [434.426939] Subtest throttle: SUCCESS (1.074s) [436.444409] [118/142] (580s left) gem_exec_fence (syncobj-backward-timeline-chain-engines) [437.018412] Starting subtest: syncobj-backward-timeline-chain-engines [437.058677] Subtest syncobj-backward-timeline-chain-engines: SUCCESS (0.042s) [438.534691] [119/142] (578s left) syncobj_wait (single-wait-all-signaled) [438.592260] Starting subtest: single-wait-all-signaled [438.594720] Subtest single-wait-all-signaled: SUCCESS (0.000s) [438.657071] [120/142] (578s left) i915_pm_rc6_residency (rc6-idle) [438.737480] Starting subtest: rc6-idle [438.739900] Starting dynamic subtest: rcs0 [450.967014] Dynamic subtest rcs0: SUCCESS (12.230s) [450.982752] Starting dynamic subtest: bcs0 [463.235527] Dynamic subtest bcs0: SUCCESS (12.267s) [463.251212] Starting dynamic subtest: vcs0 [475.503760] Dynamic subtest vcs0: SUCCESS (12.267s) [475.519653] Starting dynamic subtest: vecs0 [488.669667] Dynamic subtest vecs0: SUCCESS (13.164s) [488.685552] Starting dynamic subtest: ccs0 [501.595500] Dynamic subtest ccs0: SUCCESS (12.924s) [501.598222] Subtest rc6-idle: SUCCESS (62.863s) [502.978286] [121/142] (513s left) kms_vblank (pipe-d-query-forked-busy-hang) [503.066660] Starting subtest: pipe-D-query-forked-busy-hang [518.292421] Subtest pipe-D-query-forked-busy-hang: SUCCESS (15.227s) [519.233022] [122/142] (497s left) i915_pm_rps (thresholds-park) [519.281468] Starting subtest: thresholds-park [519.284027] Starting dynamic subtest: gt0 [519.288724] Dynamic subtest gt0: SKIP (0.002s) [519.302050] Starting dynamic subtest: gt1 [519.306532] Dynamic subtest gt1: SKIP (0.000s) [519.311016] Subtest thresholds-park: SKIP (0.004s) [519.351646] [123/142] (497s left) gem_render_copy (yf-tiled-to-vebox-x-tiled) [519.420694] Starting subtest: yf-tiled-to-vebox-x-tiled [519.425993] Subtest yf-tiled-to-vebox-x-tiled: SKIP (0.000s) [519.599359] [124/142] (497s left) kms_vblank (pipe-b-wait-busy) [519.680111] Starting subtest: pipe-B-wait-busy [522.723921] Subtest pipe-B-wait-busy: SUCCESS (3.043s) [523.636567] [125/142] (493s left) kms_ccs (pipe-b-missing-ccs-buffer-y_tiled_gen12_rc_ccs_cc) [524.015525] Starting subtest: pipe-B-missing-ccs-buffer-y_tiled_gen12_rc_ccs_cc [524.021017] Subtest pipe-B-missing-ccs-buffer-y_tiled_gen12_rc_ccs_cc: SKIP (0.000s) [524.914969] [126/142] (492s left) kms_chamelium_hpd (vga-hpd-with-enabled-mode) [525.304034] Subtest vga-hpd-with-enabled-mode: SKIP (0.000s) [526.172693] [127/142] (490s left) kms_big_fb (x-tiled-64bpp-rotate-180) [526.242587] Starting subtest: x-tiled-64bpp-rotate-180 [527.831330] Subtest x-tiled-64bpp-rotate-180: SUCCESS (1.590s) [528.081797] [128/142] (488s left) gem_mmap_wc (fault-concurrent) [528.129171] Subtest fault-concurrent: SKIP (0.000s) [528.172889] [129/142] (488s left) drm_fdinfo (busy-idle) [528.222670] Starting subtest: busy-idle [528.224946] Starting dynamic subtest: rcs0 [528.229462] Dynamic subtest rcs0: SKIP (0.000s) [528.236452] Starting dynamic subtest: bcs0 [528.240699] Dynamic subtest bcs0: SKIP (0.000s) [528.247963] Starting dynamic subtest: vcs0 [528.252500] Dynamic subtest vcs0: SKIP (0.000s) [528.264704] Starting dynamic subtest: vcs1 [528.268877] Dynamic subtest vcs1: SKIP (0.000s) [528.277781] Starting dynamic subtest: vecs0 [528.281785] Dynamic subtest vecs0: SKIP (0.000s) [528.289453] Starting dynamic subtest: ccs0 [528.293440] Dynamic subtest ccs0: SKIP (0.000s) [528.297456] Subtest busy-idle: SKIP (0.003s) [528.314729] [130/142] (488s left) gem_readwrite (read-bad-handle) [528.362489] Subtest read-bad-handle: SKIP (0.000s) [528.404580] [131/142] (488s left) kms_frontbuffer_tracking (fbcpsr-1p-offscren-pri-indfb-draw-render) [528.493508] Starting subtest: fbcpsr-1p-offscren-pri-indfb-draw-render [533.241406] Subtest fbcpsr-1p-offscren-pri-indfb-draw-render: SUCCESS (4.751s) [533.386669] [132/142] (483s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-move) [533.456459] Starting subtest: psr-1p-primscrn-spr-indfb-move [539.081875] Subtest psr-1p-primscrn-spr-indfb-move: SUCCESS (5.628s) [539.208058] [133/142] (477s left) syncobj_timeline (invalid-wait-bad-flags) [539.267335] Starting subtest: invalid-wait-bad-flags [539.269293] Subtest invalid-wait-bad-flags: SUCCESS (0.000s) [539.330658] [134/142] (477s left) gem_ctx_param (root-set) [539.382892] Starting subtest: root-set [539.385100] Subtest root-set: SUCCESS (0.000s) [539.446090] [135/142] (477s left) gem_ctx_persistence (idempotent) [539.509778] Starting subtest: idempotent [539.512128] Subtest idempotent: SUCCESS (0.000s) [539.581426] [136/142] (477s left) gem_exec_fence (invalid-fence-array) [540.043661] Starting subtest: invalid-fence-array [540.046172] Subtest invalid-fence-array: SUCCESS (0.001s) [541.503340] [137/142] (475s left) kms_addfb_basic (invalid-get-prop) [541.552121] Starting subtest: invalid-get-prop [541.554507] Subtest invalid-get-prop: SUCCESS (0.000s) [541.674260] [138/142] (475s left) kms_psr (primary_blt) [541.739907] Starting subtest: primary_blt [543.514854] Subtest primary_blt: SUCCESS (1.774s) [544.434652] [139/142] (472s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-pwrite) [544.521450] Starting subtest: fbcpsr-rgb101010-draw-pwrite [549.313563] Subtest fbcpsr-rgb101010-draw-pwrite: SUCCESS (4.794s) [549.414124] [140/142] (467s left) kms_ccs (pipe-d-crc-sprite-planes-basic-yf_tiled_ccs) [549.812025] Starting subtest: pipe-D-crc-sprite-planes-basic-yf_tiled_ccs [549.818052] Subtest pipe-D-crc-sprite-planes-basic-yf_tiled_ccs: SKIP (0.001s) [550.637224] [141/142] (466s left) sw_sync (sync_multi_producer_single_consumer) [550.674087] Starting subtest: sync_multi_producer_single_consumer [551.749961] Subtest sync_multi_producer_single_consumer: SUCCESS (1.075s) [551.787182] [142/142] (465s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-pwrite) [551.851996] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-pwrite [551.856643] Subtest fbc-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s) [551.946217] Closing watchdogs Done.