[40.828118] Initializing watchdogs [40.828289] /dev/watchdog0 [40.843432] [001/142] (960s left) kms_color (ctm-max) [41.093361] Starting subtest: ctm-max [41.096754] Starting dynamic subtest: pipe-A [42.008115] Dynamic subtest pipe-A: SUCCESS (0.913s) [42.022475] Starting dynamic subtest: pipe-B [42.888382] Dynamic subtest pipe-B: SUCCESS (0.883s) [42.922671] Starting dynamic subtest: pipe-C [43.944592] Dynamic subtest pipe-C: SUCCESS (1.056s) [43.950638] Subtest ctm-max: SUCCESS (2.853s) [44.267924] [002/142] (957s left) kms_plane_scaling (planes-downscale-factor-0-25-upscale-factor-0-25) [44.536178] Starting subtest: planes-downscale-factor-0-25-upscale-factor-0-25 [44.539192] Starting dynamic subtest: pipe-A-HDMI-A-1 [44.584249] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.040s) [44.600725] Starting dynamic subtest: pipe-B-HDMI-A-1 [44.627087] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.041s) [44.643867] Starting dynamic subtest: pipe-C-HDMI-A-1 [44.707547] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.075s) [44.713289] Subtest planes-downscale-factor-0-25-upscale-factor-0-25: SKIP (0.165s) [44.791443] [003/142] (956s left) kms_flip (2x-flip-vs-rmfb) [45.014648] Starting subtest: 2x-flip-vs-rmfb [45.018096] Starting dynamic subtest: AB-HDMI-A1-HDMI-A2 [55.998931] Dynamic subtest AB-HDMI-A1-HDMI-A2: SUCCESS (10.983s) [56.019016] Starting dynamic subtest: AC-HDMI-A1-HDMI-A2 [66.682591] Dynamic subtest AC-HDMI-A1-HDMI-A2: SUCCESS (10.674s) [66.703958] Starting dynamic subtest: BC-HDMI-A1-HDMI-A2 [77.353781] Dynamic subtest BC-HDMI-A1-HDMI-A2: SUCCESS (10.659s) [77.357272] Subtest 2x-flip-vs-rmfb: SUCCESS (32.345s) [77.955786] [004/142] (923s left) gem_exec_fair (basic-deadline) [78.150673] Starting subtest: basic-deadline [90.662087] Subtest basic-deadline: FAIL (11.670s) [90.687098] [005/142] (910s left) gem_exec_reloc (basic-write-wc) [91.139219] Starting subtest: basic-write-wc [91.204726] Subtest basic-write-wc: SUCCESS (0.017s) [91.501722] [006/142] (910s left) gem_exec_whisper (basic-contexts-forked-all) [92.278508] Starting subtest: basic-contexts-forked-all [114.504401] Subtest basic-contexts-forked-all: SUCCESS (22.543s) [114.694384] [007/142] (887s left) kms_big_fb (y-tiled-addfb-size-offset-overflow) [114.951558] Starting subtest: y-tiled-addfb-size-offset-overflow [114.955021] Subtest y-tiled-addfb-size-offset-overflow: SUCCESS (0.001s) [115.043535] [008/142] (886s left) gem_create (create-size-update) [115.193611] Starting subtest: create-size-update [115.197467] Subtest create-size-update: SUCCESS (0.000s) [115.410730] [009/142] (886s left) gem_ctx_shared (disjoint-timelines) [115.586583] Starting subtest: disjoint-timelines [115.687317] Subtest disjoint-timelines: SUCCESS (0.100s) [115.906402] [010/142] (885s left) kms_prop_blob (blob-prop-validate) [116.063253] Starting subtest: blob-prop-validate [116.066560] Subtest blob-prop-validate: SUCCESS (0.001s) [116.143860] [011/142] (885s left) gem_linear_blits (basic) [117.327813] Starting subtest: basic [117.344174] Subtest basic: SUCCESS (0.014s) [117.506759] [012/142] (884s left) gem_ringfill (legacy-basic) [117.977610] Starting subtest: legacy-basic [117.980853] Starting dynamic subtest: default [117.999090] Dynamic subtest default: SUCCESS (0.018s) [118.020309] Starting dynamic subtest: render [118.023843] Dynamic subtest render: SUCCESS (0.024s) [118.042916] Starting dynamic subtest: bsd [118.046899] Dynamic subtest bsd: SUCCESS (0.011s) [118.074116] Starting dynamic subtest: bsd1 [118.077976] Dynamic subtest bsd1: SUCCESS (0.012s) [118.098215] Starting dynamic subtest: blt [118.101273] Dynamic subtest blt: SUCCESS (0.015s) [118.115434] Starting dynamic subtest: vebox [118.118638] Dynamic subtest vebox: SUCCESS (0.018s) [118.122203] Subtest legacy-basic: SUCCESS (0.111s) [118.177807] [013/142] (883s left) gem_vm_create (create-ext) [118.342622] Starting subtest: create-ext [118.349969] Subtest create-ext: SUCCESS (0.007s) [118.444654] [014/142] (883s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-move) [118.715215] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-move [118.721757] Subtest fbcpsr-1p-primscrn-spr-indfb-move: SKIP (0.000s) [118.796080] [015/142] (883s left) kms_ccs (pipe-a-random-ccs-data-yf_tiled_ccs) [119.482675] Starting subtest: pipe-A-random-ccs-data-yf_tiled_ccs [119.721492] Subtest pipe-A-random-ccs-data-yf_tiled_ccs: SUCCESS (0.238s) [120.526432] [016/142] (881s left) kms_cursor_legacy (nonblocking-modeset-vs-cursor-atomic) [120.771854] Starting subtest: nonblocking-modeset-vs-cursor-atomic [121.835229] Subtest nonblocking-modeset-vs-cursor-atomic: SUCCESS (1.063s) [122.131124] [017/142] (879s left) kms_rotation_crc (primary-4-tiled-reflect-x-180) [122.372424] Starting subtest: primary-4-tiled-reflect-x-180 [122.379085] Subtest primary-4-tiled-reflect-x-180: SKIP (0.003s) [122.463513] [018/142] (879s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0) [122.727048] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0 [122.734095] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0: SKIP (0.000s) [122.813358] [019/142] (879s left) gem_ppgtt (blt-vs-render-ctx0) [122.974991] Starting subtest: blt-vs-render-ctx0 [155.556660] Subtest blt-vs-render-ctx0: SUCCESS (32.581s) [155.666585] [020/142] (846s left) vc4/vc4_perfmon (create-perfmon-0) [155.977861] Subtest create-perfmon-0: SKIP (0.000s) [156.047270] [021/142] (846s left) kms_plane_alpha_blend (alpha-7efc) [156.292525] Starting subtest: alpha-7efc [156.516853] Starting dynamic subtest: pipe-A-HDMI-A-1 [157.595347] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.077s) [157.695718] Starting dynamic subtest: pipe-C-HDMI-A-1 [158.739855] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (1.065s) [158.750056] Subtest alpha-7efc: SUCCESS (2.450s) [159.048909] [022/142] (843s left) v3d/v3d_submit_cl (bad-in-sync) [159.261477] Subtest bad-in-sync: SKIP (0.000s) [159.331378] [023/142] (842s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-blt) [159.603869] Starting subtest: psr-1p-primscrn-spr-indfb-draw-blt [159.610248] Subtest psr-1p-primscrn-spr-indfb-draw-blt: SKIP (0.000s) [159.681541] [024/142] (842s left) gem_exec_balancer (bonded-sync) [159.860276] Starting subtest: bonded-sync [162.727353] Subtest bonded-sync: SUCCESS (2.864s) [165.781737] [025/142] (836s left) gem_ctx_persistence (file) [165.942336] Starting subtest: file [166.014349] Subtest file: SUCCESS (0.072s) [166.099434] [026/142] (836s left) kms_vblank (pipe-a-ts-continuation-suspend) [166.326582] Starting subtest: pipe-A-ts-continuation-suspend [200.973138] Subtest pipe-A-ts-continuation-suspend: SUCCESS (3.528s) [207.129353] [027/142] (832s left) gem_exec_basic (basic) [207.302875] Starting subtest: basic [207.306414] Starting dynamic subtest: rcs0-smem [207.309750] Dynamic subtest rcs0-smem: SUCCESS (0.002s) [207.328000] Starting dynamic subtest: bcs0-smem [207.331645] Dynamic subtest bcs0-smem: SUCCESS (0.002s) [207.348576] Starting dynamic subtest: vcs0-smem [207.352637] Dynamic subtest vcs0-smem: SUCCESS (0.004s) [207.371095] Starting dynamic subtest: vecs0-smem [207.374947] Dynamic subtest vecs0-smem: SUCCESS (0.003s) [207.378525] Subtest basic: SUCCESS (0.023s) [207.538912] [028/142] (831s left) kms_frontbuffer_tracking (fbcpsr-1p-offscren-pri-indfb-draw-pwrite) [207.786499] Starting subtest: fbcpsr-1p-offscren-pri-indfb-draw-pwrite [207.792903] Subtest fbcpsr-1p-offscren-pri-indfb-draw-pwrite: SKIP (0.000s) [207.871012] [029/142] (831s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted) [208.030027] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted [208.033684] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.001s) [208.121315] [030/142] (831s left) kms_cursor_crc (cursor-sliding-32x10) [208.374667] Starting subtest: cursor-sliding-32x10 [208.630144] Subtest cursor-sliding-32x10: SKIP (0.250s) [208.738719] [031/142] (830s left) kms_hdr (bpc-switch) [208.980799] Starting subtest: bpc-switch [237.696995] Subtest bpc-switch: SKIP (28.712s) [238.145238] [032/142] (801s left) vgem_basic (unload) [238.313521] Starting subtest: unload [267.313178] Subtest unload: SUCCESS (29.001s) [267.468331] [033/142] (772s left) dumb_buffer (map-invalid-size) [267.625781] Starting subtest: map-invalid-size [267.628952] Subtest map-invalid-size: SUCCESS (0.000s) [267.719018] [034/142] (772s left) gem_cs_tlb (engines) [267.875700] Starting subtest: engines [267.878806] Starting dynamic subtest: rcs0 [270.041331] Dynamic subtest rcs0: SUCCESS (2.160s) [270.062310] Starting dynamic subtest: bcs0 [272.203308] Dynamic subtest bcs0: SUCCESS (2.161s) [272.226888] Starting dynamic subtest: vcs0 [274.362580] Dynamic subtest vcs0: SUCCESS (2.160s) [274.379847] Starting dynamic subtest: vecs0 [276.527812] Dynamic subtest vecs0: SUCCESS (2.161s) [276.531889] Subtest engines: SUCCESS (8.651s) [276.620301] [035/142] (763s left) kms_cursor_legacy (2x-flip-vs-cursor-atomic) [276.866251] Starting subtest: 2x-flip-vs-cursor-atomic [277.898490] Subtest 2x-flip-vs-cursor-atomic: SUCCESS (1.031s) [278.148269] [036/142] (761s left) kms_ccs (pipe-c-random-ccs-data-yf_tiled_ccs) [278.923903] Starting subtest: pipe-C-random-ccs-data-yf_tiled_ccs [278.932655] Subtest pipe-C-random-ccs-data-yf_tiled_ccs: SKIP (0.001s) [279.260179] [037/142] (760s left) kms_pipe_crc_basic (read-crc-frame-sequence) [279.509215] Starting subtest: read-crc-frame-sequence [279.517328] Starting dynamic subtest: pipe-A-HDMI-A-1 [280.461175] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.945s) [280.494770] Starting dynamic subtest: pipe-B-HDMI-A-2 [281.452010] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.984s) [281.485565] Starting dynamic subtest: pipe-C-HDMI-A-1 [282.756157] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (1.297s) [282.759894] Subtest read-crc-frame-sequence: SUCCESS (3.249s) [283.053693] [038/142] (756s left) kms_cursor_crc (cursor-offscreen-512x512) [283.327337] Starting subtest: cursor-offscreen-512x512 [283.334993] Subtest cursor-offscreen-512x512: SKIP (0.003s) [283.437648] [039/142] (756s left) syncobj_wait (reset-during-wait-for-submit) [283.601808] Starting subtest: reset-during-wait-for-submit [283.703108] Subtest reset-during-wait-for-submit: SUCCESS (0.103s) [283.791362] [040/142] (756s left) kms_frontbuffer_tracking (fbcpsr-1p-pri-indfb-multidraw) [284.061081] Starting subtest: fbcpsr-1p-pri-indfb-multidraw [284.067662] Subtest fbcpsr-1p-pri-indfb-multidraw: SKIP (0.000s) [284.152611] [041/142] (755s left) gem_exec_params (rel-constants-invalid) [284.314511] Starting subtest: rel-constants-invalid [284.317978] Subtest rel-constants-invalid: SUCCESS (0.001s) [284.407013] [042/142] (755s left) drm_read (fault-buffer) [284.923004] Starting subtest: fault-buffer [284.926352] Subtest fault-buffer: SUCCESS (0.001s) [285.159161] [043/142] (754s left) kms_ccs (pipe-c-bad-pixel-format-4_tiled_dg2_rc_ccs_cc) [285.944024] Starting subtest: pipe-C-bad-pixel-format-4_tiled_dg2_rc_ccs_cc [285.950568] Subtest pipe-C-bad-pixel-format-4_tiled_dg2_rc_ccs_cc: SKIP (0.000s) [286.248134] [044/142] (753s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted-signa [286.401531] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted-signaled [286.506039] Subtest etime-multi-wait-all-for-submit-available-unsubmitted-signaled: SUCCESS (0.108s) [286.596587] [045/142] (753s left) kms_cursor_legacy (single-bo) [286.845946] Starting subtest: single-bo [286.849242] Starting dynamic subtest: pipe-A [292.250233] Dynamic subtest pipe-A: SUCCESS (5.402s) [292.275590] Starting dynamic subtest: pipe-B [297.666078] Dynamic subtest pipe-B: SUCCESS (5.412s) [297.685569] Starting dynamic subtest: pipe-C [303.063816] Dynamic subtest pipe-C: SUCCESS (5.396s) [303.085865] Starting dynamic subtest: all-pipes [308.462221] Dynamic subtest all-pipes: SUCCESS (5.398s) [308.466242] Subtest single-bo: SUCCESS (21.618s) [308.565937] [046/142] (731s left) gem_mmap_wc (fault-concurrent) [308.722769] Starting subtest: fault-concurrent [309.040731] Subtest fault-concurrent: SUCCESS (0.325s) [309.131039] [047/142] (731s left) vgem_basic (busy-fence) [309.297308] Starting subtest: busy-fence [309.301570] Subtest busy-fence: SUCCESS (0.001s) [309.362783] [048/142] (730s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-render) [309.625691] Starting subtest: psr-1p-primscrn-spr-indfb-draw-render [309.632040] Subtest psr-1p-primscrn-spr-indfb-draw-render: SKIP (0.000s) [309.714348] [049/142] (730s left) kms_big_fb (x-tiled-16bpp-rotate-270) [309.984361] Starting subtest: x-tiled-16bpp-rotate-270 [310.318940] Subtest x-tiled-16bpp-rotate-270: SKIP (0.326s) [310.498431] [050/142] (729s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-render) [311.135366] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-render [313.288967] Subtest fbc-1p-primscrn-pri-shrfb-draw-render: SUCCESS (2.420s) [313.549091] [051/142] (726s left) perf_pmu (busy-idle-no-semaphores) [313.715758] Starting subtest: busy-idle-no-semaphores [313.719238] Starting dynamic subtest: rcs0 [314.345304] Dynamic subtest rcs0: SUCCESS (0.627s) [314.364170] Starting dynamic subtest: bcs0 [314.975266] Dynamic subtest bcs0: SUCCESS (0.624s) [314.994493] Starting dynamic subtest: vcs0 [315.602307] Dynamic subtest vcs0: SUCCESS (0.623s) [315.622718] Starting dynamic subtest: vecs0 [316.227464] Dynamic subtest vecs0: SUCCESS (0.621s) [316.231189] Subtest busy-idle-no-semaphores: SUCCESS (2.510s) [316.313786] [052/142] (724s left) i915_pm_freq_api (freq-reset) [316.474656] Subtest freq-reset: SKIP (0.000s) [316.534895] [053/142] (723s left) gem_mmap_wc (bad-size) [316.690529] Starting subtest: bad-size [316.693615] Subtest bad-size: SUCCESS (0.002s) [316.781080] [054/142] (723s left) api_intel_bb (blit-reloc-purge-cache) [316.936324] Starting subtest: blit-reloc-purge-cache [316.945729] Subtest blit-reloc-purge-cache: SUCCESS (0.016s) [317.047734] [055/142] (723s left) perf_pmu (pmu-read) [317.203222] Starting subtest: pmu-read [317.212700] Subtest pmu-read: SUCCESS (0.006s) [317.298725] [056/142] (723s left) kms_vblank (pipe-c-ts-continuation-dpms-rpm) [317.539755] Starting subtest: pipe-C-ts-continuation-dpms-rpm [323.007125] Subtest pipe-C-ts-continuation-dpms-rpm: SUCCESS (5.464s) [323.480423] [057/142] (717s left) gem_mmap_gtt (big-copy-xy) [323.639500] Starting subtest: big-copy-XY [334.465606] Subtest big-copy-XY: SUCCESS (10.825s) [334.565919] [058/142] (706s left) kms_vblank (pipe-d-wait-idle) [334.923550] Subtest pipe-D-wait-idle: SKIP (0.000s) [335.009160] [059/142] (705s left) kms_psr (cursor_mmap_cpu) [335.166238] Subtest cursor_mmap_cpu: SKIP (0.000s) [335.228783] [060/142] (705s left) gem_render_copy (y-tiled-ccs-to-linear) [335.389704] Starting subtest: y-tiled-ccs-to-linear [335.393288] Starting dynamic subtest: smem [335.595699] Dynamic subtest smem: SUCCESS (0.200s) [335.598939] Subtest y-tiled-ccs-to-linear: SUCCESS (0.203s) [335.799885] [061/142] (704s left) drm_fdinfo (busy-check-all) [335.960702] Starting subtest: busy-check-all [335.963929] Starting dynamic subtest: rcs0 [336.478852] Dynamic subtest rcs0: SUCCESS (0.520s) [336.500414] Starting dynamic subtest: bcs0 [337.009500] Dynamic subtest bcs0: SUCCESS (0.522s) [337.027701] Starting dynamic subtest: vcs0 [337.528804] Dynamic subtest vcs0: SUCCESS (0.520s) [337.546903] Starting dynamic subtest: vecs0 [338.050185] Dynamic subtest vecs0: SUCCESS (0.523s) [338.053973] Subtest busy-check-all: SUCCESS (2.093s) [338.142993] [062/142] (702s left) sysfs_heartbeat_interval (precise) [338.302176] Starting subtest: precise [338.305668] Starting dynamic subtest: vecs0 [339.758798] Dynamic subtest vecs0: SUCCESS (1.456s) [339.785158] Starting dynamic subtest: vcs0 [341.202154] Dynamic subtest vcs0: SUCCESS (1.441s) [341.259449] Starting dynamic subtest: bcs0 [342.660117] Dynamic subtest bcs0: SUCCESS (1.451s) [342.706238] Starting dynamic subtest: rcs0 [344.108133] Dynamic subtest rcs0: SUCCESS (1.441s) [344.112294] Subtest precise: SUCCESS (5.803s) [344.208682] [063/142] (696s left) kms_draw_crc (draw-method-mmap-wc) [344.502906] Starting subtest: draw-method-mmap-wc [344.507682] Starting dynamic subtest: xrgb8888-untiled [345.039910] Dynamic subtest xrgb8888-untiled: SUCCESS (0.540s) [345.105268] Starting dynamic subtest: rgb565-untiled [345.308016] Dynamic subtest rgb565-untiled: SUCCESS (0.264s) [345.353034] Starting dynamic subtest: xrgb2101010-untiled [345.609915] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.293s) [345.685471] Starting dynamic subtest: xrgb8888-xtiled [345.823827] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.213s) [345.893245] Starting dynamic subtest: rgb565-xtiled [346.056968] Dynamic subtest rgb565-xtiled: SUCCESS (0.232s) [346.075974] Starting dynamic subtest: xrgb2101010-xtiled [346.240946] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.180s) [346.276556] Starting dynamic subtest: xrgb8888-ytiled [346.458786] Dynamic subtest xrgb8888-ytiled: SUCCESS (0.215s) [346.512254] Starting dynamic subtest: rgb565-ytiled [346.664434] Dynamic subtest rgb565-ytiled: SUCCESS (0.199s) [346.682757] Starting dynamic subtest: xrgb2101010-ytiled [346.844867] Dynamic subtest xrgb2101010-ytiled: SUCCESS (0.180s) [346.849772] Subtest draw-method-mmap-wc: SUCCESS (2.343s) [347.033364] [064/142] (693s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-render) [347.355148] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-render [347.361734] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s) [347.444900] [065/142] (693s left) kms_plane_scaling (plane-scaler-with-pixel-format-unity-scaling) [347.894606] Starting subtest: plane-scaler-with-pixel-format-unity-scaling [347.960400] Starting dynamic subtest: pipe-A-HDMI-A-1 [351.303054] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (3.518s) [351.337296] Starting dynamic subtest: pipe-B-HDMI-A-1 [354.670903] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (3.362s) [354.705718] Starting dynamic subtest: pipe-C-HDMI-A-1 [355.123070] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.445s) [355.127709] Subtest plane-scaler-with-pixel-format-unity-scaling: SUCCESS (7.344s) [355.604323] [066/142] (685s left) kms_chamelium_hpd (dp-hpd-for-each-pipe) [356.293365] Subtest dp-hpd-for-each-pipe: SKIP (0.000s) [356.490141] [067/142] (684s left) v3d/v3d_submit_cl (multi-and-single-sync) [356.710029] Subtest multi-and-single-sync: SKIP (0.000s) [356.779469] [068/142] (684s left) kms_cursor_legacy (short-flip-before-cursor-atomic-transitions-varying-size) [357.027709] Starting subtest: short-flip-before-cursor-atomic-transitions-varying-size [358.597713] Subtest short-flip-before-cursor-atomic-transitions-varying-size: SUCCESS (1.567s) [358.900627] [069/142] (682s left) gem_userptr_blits (unsync-overlap) [359.076761] Subtest unsync-overlap: SKIP (0.000s) [359.210304] [070/142] (681s left) kms_atomic (plane-immutable-zpos) [359.561331] Starting subtest: plane-immutable-zpos [360.057745] Subtest plane-immutable-zpos: SUCCESS (0.491s) [360.663125] [071/142] (680s left) gem_exec_params (invalid-bsd1-flag-on-vebox) [360.862943] Starting subtest: invalid-bsd1-flag-on-vebox [360.866311] Subtest invalid-bsd1-flag-on-vebox: SUCCESS (0.001s) [360.963672] [072/142] (680s left) gem_huc_copy (huc-copy) [361.128262] Starting subtest: huc-copy [361.135070] Subtest huc-copy: SKIP (0.001s) [361.220468] [073/142] (680s left) gem_pxp (create-regular-buffer) [363.892259] Subtest create-regular-buffer: SKIP (0.000s) [363.980920] [074/142] (677s left) kms_ccs (pipe-a-crc-primary-basic-y_tiled_ccs) [364.637559] Starting subtest: pipe-A-crc-primary-basic-y_tiled_ccs [365.087944] Subtest pipe-A-crc-primary-basic-y_tiled_ccs: SUCCESS (0.448s) [366.016812] [075/142] (675s left) kms_cursor_legacy (cursorb-vs-flipb-legacy) [366.264585] Starting subtest: cursorB-vs-flipB-legacy [377.619619] Subtest cursorB-vs-flipB-legacy: SUCCESS (11.356s) [377.847522] [076/142] (663s left) gem_render_copy (y-tiled-ccs-to-x-tiled) [378.015856] Starting subtest: y-tiled-ccs-to-x-tiled [378.019125] Starting dynamic subtest: smem [378.247150] Dynamic subtest smem: SUCCESS (0.226s) [378.250597] Subtest y-tiled-ccs-to-x-tiled: SUCCESS (0.233s) [378.463834] [077/142] (662s left) gem_exec_schedule (preemptive-hang) [378.759772] Starting subtest: preemptive-hang [378.763054] Starting dynamic subtest: rcs0 [384.719967] Dynamic subtest rcs0: SUCCESS (5.950s) [384.748564] Starting dynamic subtest: bcs0 [390.736820] Dynamic subtest bcs0: SUCCESS (6.013s) [390.761820] Starting dynamic subtest: vcs0 [396.753752] Dynamic subtest vcs0: SUCCESS (6.012s) [396.773351] Starting dynamic subtest: vecs0 [402.715198] Dynamic subtest vecs0: SUCCESS (5.956s) [402.718678] Subtest preemptive-hang: SUCCESS (23.946s) [402.947431] [078/142] (638s left) gem_shrink (reclaim) [403.132728] Starting subtest: reclaim [405.398825] Subtest reclaim: SUCCESS (2.290s) [405.497856] [079/142] (636s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-pwrite) [405.753141] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-pwrite [405.759946] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [405.847067] [080/142] (635s left) kms_addfb_basic (invalid-set-prop-any) [406.007766] Starting subtest: invalid-set-prop-any [406.011048] Subtest invalid-set-prop-any: SUCCESS (0.000s) [406.196311] [081/142] (635s left) gem_userptr_blits (sync-unmap-after-close) [406.384335] Starting subtest: sync-unmap-after-close [406.424196] Subtest sync-unmap-after-close: SUCCESS (0.041s) [406.547413] [082/142] (635s left) gem_exec_params (invalid-fence-in-submit) [406.707797] Starting subtest: invalid-fence-in-submit [406.715513] Subtest invalid-fence-in-submit: SUCCESS (0.004s) [406.811810] [083/142] (634s left) gem_render_copy (yf-tiled-to-vebox-linear) [406.971304] Starting subtest: yf-tiled-to-vebox-linear [406.978904] Subtest yf-tiled-to-vebox-linear: SKIP (0.000s) [407.179999] [084/142] (634s left) kms_cursor_legacy (cursora-vs-flipb-toggle) [407.417237] Starting subtest: cursorA-vs-flipB-toggle [418.793483] Subtest cursorA-vs-flipB-toggle: SUCCESS (11.275s) [419.175947] [085/142] (622s left) kms_ccs (pipe-c-crc-primary-basic-4_tiled_mtl_rc_ccs_cc) [420.140888] Starting subtest: pipe-C-crc-primary-basic-4_tiled_mtl_rc_ccs_cc [420.147447] Subtest pipe-C-crc-primary-basic-4_tiled_mtl_rc_ccs_cc: SKIP (0.001s) [420.442266] [086/142] (621s left) perf_pmu (cpu-hotplug) [420.606812] Starting subtest: cpu-hotplug [420.618091] Subtest cpu-hotplug: SKIP (0.006s) [420.709025] [087/142] (621s left) gem_vm_create (isolation) [420.870213] Starting subtest: isolation [420.882949] Subtest isolation: SUCCESS (0.012s) [420.983498] [088/142] (621s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-plflip-blt) [421.245747] Starting subtest: fbcpsr-2p-scndscrn-indfb-plflip-blt [421.252115] Subtest fbcpsr-2p-scndscrn-indfb-plflip-blt: SKIP (0.000s) [421.333579] [089/142] (620s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip) [421.595033] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip [421.601852] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.000s) [421.692599] [090/142] (620s left) kms_vblank (pipe-c-wait-forked-busy-hang) [421.951938] Starting subtest: pipe-C-wait-forked-busy-hang [437.488214] Subtest pipe-C-wait-forked-busy-hang: SUCCESS (15.546s) [437.802398] [091/142] (604s left) gem_exec_fence (syncobj-channel) [438.409574] Starting subtest: syncobj-channel [439.484739] Subtest syncobj-channel: SUCCESS (1.073s) [439.806639] [092/142] (602s left) kms_invalid_mode (zero-vdisplay) [440.041481] Starting subtest: zero-vdisplay [440.045567] Starting dynamic subtest: HDMI-A-1-pipe-A [440.502109] Dynamic subtest HDMI-A-1-pipe-A: SUCCESS (0.459s) [440.537663] Starting dynamic subtest: HDMI-A-2-pipe-A [440.552085] Dynamic subtest HDMI-A-2-pipe-A: SUCCESS (0.041s) [440.581277] Starting dynamic subtest: HDMI-A-1-pipe-B [440.591755] Dynamic subtest HDMI-A-1-pipe-B: SUCCESS (0.036s) [440.628482] Starting dynamic subtest: HDMI-A-2-pipe-B [440.631775] Dynamic subtest HDMI-A-2-pipe-B: SUCCESS (0.034s) [440.669285] Starting dynamic subtest: HDMI-A-1-pipe-C [440.672844] Dynamic subtest HDMI-A-1-pipe-C: SUCCESS (0.031s) [440.703936] Starting dynamic subtest: HDMI-A-2-pipe-C [440.707630] Dynamic subtest HDMI-A-2-pipe-C: SUCCESS (0.018s) [440.711457] Subtest zero-vdisplay: SUCCESS (0.654s) [440.942647] [093/142] (601s left) gem_mmap_gtt (basic-small-bo-tiledx) [441.093349] Starting subtest: basic-small-bo-tiledX [442.525914] Subtest basic-small-bo-tiledX: SUCCESS (1.433s) [442.654129] [094/142] (599s left) gem_mmap_gtt (close-race) [442.895867] Starting subtest: close-race [462.978605] Subtest close-race: SUCCESS (20.083s) [463.084961] [095/142] (579s left) kms_cursor_legacy (flip-vs-cursor-crc-atomic) [463.337838] Starting subtest: flip-vs-cursor-crc-atomic [464.461949] Subtest flip-vs-cursor-crc-atomic: SUCCESS (1.126s) [464.738595] [096/142] (577s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-render) [465.003617] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-render [467.608481] Subtest fbc-2p-primscrn-pri-shrfb-draw-render: SUCCESS (2.613s) [467.753826] [097/142] (574s left) kms_frontbuffer_tracking (psr-1p-offscren-pri-indfb-draw-blt) [468.023617] Starting subtest: psr-1p-offscren-pri-indfb-draw-blt [468.029913] Subtest psr-1p-offscren-pri-indfb-draw-blt: SKIP (0.000s) [468.104430] [098/142] (574s left) kms_vblank (pipe-a-wait-forked-busy) [468.349648] Starting subtest: pipe-A-wait-forked-busy [473.806852] Subtest pipe-A-wait-forked-busy: SUCCESS (5.454s) [474.066587] [099/142] (568s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-pgflip-blt) [474.330603] Starting subtest: fbc-2p-scndscrn-indfb-pgflip-blt [476.441792] Subtest fbc-2p-scndscrn-indfb-pgflip-blt: SUCCESS (2.117s) [476.597186] [100/142] (565s left) syncobj_basic (bad-flags-fd-to-handle) [476.756935] Starting subtest: bad-flags-fd-to-handle [476.760525] Subtest bad-flags-fd-to-handle: SUCCESS (0.000s) [476.846706] [101/142] (565s left) kms_ccs (pipe-b-ccs-on-another-bo-y_tiled_gen12_rc_ccs) [477.592892] Starting subtest: pipe-B-ccs-on-another-bo-y_tiled_gen12_rc_ccs [477.599173] Subtest pipe-B-ccs-on-another-bo-y_tiled_gen12_rc_ccs: SKIP (0.000s) [477.941338] [102/142] (564s left) kms_ccs (pipe-d-random-ccs-data-y_tiled_ccs) [478.776283] Subtest pipe-D-random-ccs-data-y_tiled_ccs: SKIP (0.000s) [479.010902] [103/142] (563s left) vc4/vc4_label_bo (set-bad-handle) [479.239098] Subtest set-bad-handle: SKIP (0.000s) [479.309393] [104/142] (563s left) kms_ccs (pipe-a-bad-rotation-90-4_tiled_dg2_rc_ccs) [479.970570] Starting subtest: pipe-A-bad-rotation-90-4_tiled_dg2_rc_ccs [479.976556] Subtest pipe-A-bad-rotation-90-4_tiled_dg2_rc_ccs: SKIP (0.000s) [480.374484] [105/142] (562s left) kms_cdclk (plane-scaling) [480.533925] Subtest plane-scaling: SKIP (0.000s) [480.592582] [106/142] (562s left) syncobj_timeline (single-wait-available-submitted) [480.751873] Starting subtest: single-wait-available-submitted [480.755244] Subtest single-wait-available-submitted: SUCCESS (0.001s) [480.840203] [107/142] (562s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-move) [481.107261] Starting subtest: psr-2p-primscrn-spr-indfb-move [481.113712] Subtest psr-2p-primscrn-spr-indfb-move: SKIP (0.000s) [481.190606] [108/142] (561s left) syncobj_timeline (multi-wait-for-submit-available-signaled) [481.348070] Starting subtest: multi-wait-for-submit-available-signaled [481.351968] Subtest multi-wait-for-submit-available-signaled: SUCCESS (0.002s) [481.441394] [109/142] (561s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-render) [481.699099] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-render [484.163565] Subtest fbc-2p-primscrn-cur-indfb-draw-render: SUCCESS (2.475s) [484.322626] [110/142] (558s left) gem_exec_flush (basic-wb-set-default) [484.503487] Starting subtest: basic-wb-set-default [489.930312] Subtest basic-wb-set-default: SUCCESS (5.426s) [490.139597] [111/142] (552s left) kms_ccs (pipe-c-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs) [490.912440] Starting subtest: pipe-C-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs [490.923229] Subtest pipe-C-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs: SKIP (0.005s) [491.171267] [112/142] (551s left) gen9_exec_parse (batch-zero-length) [491.345887] Starting subtest: batch-zero-length [491.349266] Subtest batch-zero-length: SUCCESS (0.002s) [491.561083] [113/142] (551s left) kms_async_flips (invalid-async-flip) [491.798397] Starting subtest: invalid-async-flip [492.920881] Starting dynamic subtest: pipe-A-HDMI-A-1 [493.393966] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.474s) [494.626510] Starting dynamic subtest: pipe-A-HDMI-A-2 [495.097765] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.518s) [496.221185] Starting dynamic subtest: pipe-B-HDMI-A-1 [496.699065] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.526s) [497.505589] Starting dynamic subtest: pipe-B-HDMI-A-2 [497.942000] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.467s) [498.718560] Starting dynamic subtest: pipe-C-HDMI-A-1 [499.124802] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.452s) [499.649298] Starting dynamic subtest: pipe-C-HDMI-A-2 [500.063890] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.455s) [500.069113] Subtest invalid-async-flip: SUCCESS (8.264s) [500.802386] [114/142] (542s left) kms_ccs (pipe-a-bad-aux-stride-y_tiled_gen12_rc_ccs) [501.498292] Starting subtest: pipe-A-bad-aux-stride-y_tiled_gen12_rc_ccs [501.504662] Subtest pipe-A-bad-aux-stride-y_tiled_gen12_rc_ccs: SKIP (0.001s) [501.851624] [115/142] (541s left) kms_ccs (pipe-d-bad-pixel-format-y_tiled_gen12_rc_ccs) [502.602618] Subtest pipe-D-bad-pixel-format-y_tiled_gen12_rc_ccs: SKIP (0.000s) [502.855617] [116/142] (540s left) gem_exec_params (cliprects-invalid) [503.017931] Starting subtest: cliprects-invalid [503.021645] Subtest cliprects-invalid: SUCCESS (0.001s) [503.120098] [117/142] (540s left) kms_ccs (pipe-d-crc-primary-basic-y_tiled_gen12_rc_ccs) [503.925972] Subtest pipe-D-crc-primary-basic-y_tiled_gen12_rc_ccs: SKIP (0.000s) [504.191853] [118/142] (539s left) kms_vblank (pipe-d-accuracy-idle) [504.439721] Subtest pipe-D-accuracy-idle: SKIP (0.000s) [504.524040] [119/142] (538s left) gem_exec_flush (basic-batch-kernel-default-uc) [504.696963] Starting subtest: basic-batch-kernel-default-uc [510.454909] Subtest basic-batch-kernel-default-uc: SUCCESS (5.754s) [510.658962] [120/142] (532s left) kms_ccs (pipe-b-random-ccs-data-y_tiled_gen12_rc_ccs) [511.366180] Starting subtest: pipe-B-random-ccs-data-y_tiled_gen12_rc_ccs [511.376877] Subtest pipe-B-random-ccs-data-y_tiled_gen12_rc_ccs: SKIP (0.001s) [511.705800] [121/142] (531s left) kms_psr2_su (frontbuffer-xrgb8888) [512.243080] Subtest frontbuffer-XRGB8888: SKIP (0.000s) [512.588730] [122/142] (531s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180) [513.370798] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180 [514.729017] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180: SUCCESS (1.590s) [514.971886] [123/142] (528s left) kms_ccs (pipe-b-crc-sprite-planes-basic-y_tiled_ccs) [515.740965] Starting subtest: pipe-B-crc-sprite-planes-basic-y_tiled_ccs [516.724450] Subtest pipe-B-crc-sprite-planes-basic-y_tiled_ccs: SUCCESS (0.983s) [517.435414] [124/142] (526s left) api_intel_bb (render) [517.592811] Starting subtest: render [517.596077] Starting dynamic subtest: render-none-512 [517.695783] Dynamic subtest render-none-512: SUCCESS (0.102s) [517.726204] Starting dynamic subtest: render-none-reloc-512 [517.813828] Dynamic subtest render-none-reloc-512: SUCCESS (0.113s) [517.846279] Starting dynamic subtest: render-none-1024 [518.144822] Dynamic subtest render-none-1024: SUCCESS (0.328s) [518.177081] Starting dynamic subtest: render-none-reloc-1024 [518.473761] Dynamic subtest render-none-reloc-1024: SUCCESS (0.324s) [518.506172] Starting dynamic subtest: render-x-512 [518.573971] Dynamic subtest render-x-512: SUCCESS (0.097s) [518.611169] Starting dynamic subtest: render-x-reloc-512 [518.678859] Dynamic subtest render-x-reloc-512: SUCCESS (0.096s) [518.710102] Starting dynamic subtest: render-x-1024 [518.958774] Dynamic subtest render-x-1024: SUCCESS (0.275s) [518.993098] Starting dynamic subtest: render-x-reloc-1024 [519.240028] Dynamic subtest render-x-reloc-1024: SUCCESS (0.276s) [519.272192] Starting dynamic subtest: render-y-512 [519.338954] Dynamic subtest render-y-512: SUCCESS (0.096s) [519.375235] Starting dynamic subtest: render-y-reloc-512 [519.441925] Dynamic subtest render-y-reloc-512: SUCCESS (0.097s) [519.480204] Starting dynamic subtest: render-y-1024 [519.724611] Dynamic subtest render-y-1024: SUCCESS (0.276s) [519.759329] Starting dynamic subtest: render-y-reloc-1024 [519.997812] Dynamic subtest render-y-reloc-1024: SUCCESS (0.268s) [520.001088] Subtest render: SUCCESS (2.409s) [520.092329] [125/142] (523s left) i915_pm_rps (fence-order) [520.254721] Starting subtest: fence-order [522.620741] Subtest fence-order: SUCCESS (2.363s) [522.749246] [126/142] (521s left) kms_ccs (pipe-a-crc-sprite-planes-basic-yf_tiled_ccs) [523.468181] Starting subtest: pipe-A-crc-sprite-planes-basic-yf_tiled_ccs [524.564284] Subtest pipe-A-crc-sprite-planes-basic-yf_tiled_ccs: SUCCESS (1.096s) [525.417623] [127/142] (518s left) i915_pm_rpm (gem-execbuf) [527.578621] Starting subtest: gem-execbuf [527.582057] Starting dynamic subtest: smem0 [529.138546] Dynamic subtest smem0: SUCCESS (1.556s) [529.141722] Subtest gem-execbuf: SUCCESS (1.558s) [529.639291] [128/142] (514s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling) [529.881847] Starting subtest: flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling [529.885138] Starting dynamic subtest: pipe-A-valid-mode [530.355970] Dynamic subtest pipe-A-valid-mode: SKIP (0.469s) [530.363880] Subtest flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.474s) [530.664812] [129/142] (513s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-pgflip-blt) [530.937540] Starting subtest: psr-2p-scndscrn-shrfb-pgflip-blt [530.943952] Subtest psr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s) [531.030829] [130/142] (512s left) i915_pm_backlight (fade) [531.281428] Subtest fade: SKIP (0.000s) [531.343737] [131/142] (512s left) kms_flip (2x-plain-flip-ts-check) [531.575213] Starting subtest: 2x-plain-flip-ts-check [531.578723] Starting dynamic subtest: AB-HDMI-A1-HDMI-A2 [542.766197] Dynamic subtest AB-HDMI-A1-HDMI-A2: SUCCESS (11.183s) [542.797468] Starting dynamic subtest: AC-HDMI-A1-HDMI-A2 [553.817155] Dynamic subtest AC-HDMI-A1-HDMI-A2: SUCCESS (11.044s) [553.850338] Starting dynamic subtest: BC-HDMI-A1-HDMI-A2 [564.857892] Dynamic subtest BC-HDMI-A1-HDMI-A2: SUCCESS (11.030s) [564.861476] Subtest 2x-plain-flip-ts-check: SUCCESS (33.278s) [565.449108] [132/142] (478s left) api_intel_allocator (fork-simple-once) [565.604495] Starting subtest: fork-simple-once [565.643431] Subtest fork-simple-once: SUCCESS (0.039s) [565.736585] [133/142] (478s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-wc) [566.000517] Starting subtest: psr-rgb101010-draw-mmap-wc [566.006925] Subtest psr-rgb101010-draw-mmap-wc: SKIP (0.000s) [566.085794] [134/142] (478s left) gem_exec_gttfill (basic) [566.260471] Starting subtest: basic [576.019773] Subtest basic: SUCCESS (9.761s) [576.239792] [135/142] (467s left) kms_flip_scaled_crc (flip-32bpp-ytileccs-to-64bpp-ytile-downscaling) [576.587176] Starting subtest: flip-32bpp-ytileccs-to-64bpp-ytile-downscaling [576.591578] Starting dynamic subtest: pipe-A-valid-mode [577.426173] Dynamic subtest pipe-A-valid-mode: SKIP (0.837s) [577.434908] Subtest flip-32bpp-ytileccs-to-64bpp-ytile-downscaling: SKIP (0.842s) [577.905911] [136/142] (466s left) gem_exec_schedule (wide) [578.228867] Starting subtest: wide [578.232179] Starting dynamic subtest: rcs0 [595.324473] Dynamic subtest rcs0: SUCCESS (17.092s) [595.407553] Starting dynamic subtest: bcs0 [613.250238] Dynamic subtest bcs0: SUCCESS (17.922s) [613.327817] Starting dynamic subtest: vcs0 [630.503513] Dynamic subtest vcs0: SUCCESS (17.241s) [630.590633] Starting dynamic subtest: vecs0 [648.177004] Dynamic subtest vecs0: SUCCESS (17.660s) [648.187332] Subtest wide: SUCCESS (69.954s) [649.024088] [137/142] (395s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-hflip) [649.288411] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-hflip [649.540034] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.247s) [649.762472] [138/142] (394s left) kms_cursor_crc (cursor-dpms) [650.019964] Starting subtest: cursor-dpms [650.027404] Starting dynamic subtest: pipe-A-HDMI-A-1 [652.003194] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.978s) [652.044034] Starting dynamic subtest: pipe-C-HDMI-A-1 [653.954007] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (1.930s) [653.958173] Subtest cursor-dpms: SUCCESS (3.939s) [654.269195] [139/142] (390s left) gem_partial_pwrite_pread (writes-after-reads) [654.437338] Starting subtest: writes-after-reads [674.723230] Subtest writes-after-reads: SUCCESS (20.286s) [674.833219] [140/142] (369s left) gem_flink_basic (double-flink) [674.992163] Starting subtest: double-flink [674.995572] Subtest double-flink: SUCCESS (0.000s) [675.083261] [141/142] (369s left) perf (sysctl-defaults) [675.340105] Starting subtest: sysctl-defaults [675.343670] Subtest sysctl-defaults: SUCCESS (0.000s) [675.427813] [142/142] (369s left) syncobj_timeline (invalid-transfer-non-existent-point) [675.591859] Starting subtest: invalid-transfer-non-existent-point [675.595184] Subtest invalid-transfer-non-existent-point: SUCCESS (0.000s) [675.678230] Closing watchdogs Done.