[39.074360] Initializing watchdogs [39.074427] /dev/watchdog0 [39.080143] [001/144] (960s left) kms_chamelium_color (ctm-0-25) [41.037348] Subtest ctm-0-25: SKIP (0.000s) [41.065976] [002/144] (958s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-blt) [43.025338] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-blt [43.027345] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s) [43.092026] [003/144] (956s left) kms_plane (plane-position-hole-dpms) [45.106568] Starting subtest: plane-position-hole-dpms [45.107718] Starting dynamic subtest: pipe-A [48.233479] Dynamic subtest pipe-A: SUCCESS (3.126s) [48.239366] Starting dynamic subtest: pipe-B [50.968401] Dynamic subtest pipe-B: SUCCESS (2.732s) [50.969550] Subtest plane-position-hole-dpms: SUCCESS (5.862s) [51.095054] [004/144] (948s left) kms_psr2_sf (overlay-plane-update-continuous-sf) [51.158901] Subtest overlay-plane-update-continuous-sf: SKIP (0.000s) [51.187672] [005/144] (948s left) gem_exec_flush (basic-uc-set-default) [51.251653] Subtest basic-uc-set-default: SKIP (0.000s) [51.287597] [006/144] (948s left) kms_psr (fbc-psr-cursor-plane-onoff) [53.247609] Subtest fbc-psr-cursor-plane-onoff: SKIP (0.000s) [53.270586] [007/144] (946s left) gem_partial_pwrite_pread (write-snoop) [53.320946] Subtest write-snoop: SKIP (0.000s) [53.371353] [008/144] (946s left) gem_exec_reloc (basic-gtt-read) [53.457111] Subtest basic-gtt-read: SKIP (0.000s) [53.486683] [009/144] (946s left) gem_exec_balancer (bonded-semaphore) [53.542609] Starting subtest: bonded-semaphore [53.545192] Subtest bonded-semaphore: SKIP (0.000s) [53.895327] [010/144] (945s left) syncobj_timeline (multi-wait-for-submit-available-signaled) [53.944566] Starting subtest: multi-wait-for-submit-available-signaled [53.945518] Subtest multi-wait-for-submit-available-signaled: SUCCESS (0.001s) [54.014393] [011/144] (945s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-downscaling) [55.978557] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-downscaling [55.979558] Starting dynamic subtest: pipe-A-valid-mode [56.020056] Dynamic subtest pipe-A-valid-mode: SKIP (0.039s) [56.022037] Subtest flip-32bpp-yftile-to-64bpp-yftile-downscaling: SKIP (0.040s) [56.101948] [012/144] (943s left) gen9_exec_parse (allowed-single) [56.158410] Subtest allowed-single: SKIP (0.000s) [56.178476] [013/144] (943s left) gem_sync (basic-many-each) [56.239707] Starting subtest: basic-many-each [58.532762] Subtest basic-many-each: SUCCESS (2.294s) [58.748143] [014/144] (941s left) gem_exec_fence (submit3) [58.997937] Starting subtest: submit3 [59.001076] Subtest submit3: SKIP (0.000s) [59.581543] [015/144] (940s left) kms_plane_scaling (planes-downscale-factor-0-75-unity-scaling) [61.528404] Starting subtest: planes-downscale-factor-0-75-unity-scaling [61.533541] Starting dynamic subtest: pipe-A-HDMI-A-4 [61.637146] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.104s) [61.646517] Starting dynamic subtest: pipe-B-HDMI-A-4 [61.759415] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.118s) [61.768470] Starting dynamic subtest: pipe-C-HDMI-A-4 [61.881434] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.117s) [61.890262] Starting dynamic subtest: pipe-D-HDMI-A-4 [62.003369] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.117s) [62.004541] Subtest planes-downscale-factor-0-75-unity-scaling: SUCCESS (0.475s) [62.143375] [016/144] (937s left) kms_ccs (pipe-b-ccs-on-another-bo-y-tiled-gen12-mc-ccs) [64.203320] Starting subtest: pipe-B-ccs-on-another-bo-y-tiled-gen12-mc-ccs [64.205305] Subtest pipe-B-ccs-on-another-bo-y-tiled-gen12-mc-ccs: SKIP (0.000s) [64.371298] [017/144] (935s left) kms_cursor_crc (cursor-sliding-64x21) [66.483969] Starting subtest: cursor-sliding-64x21 [66.491129] Starting dynamic subtest: pipe-A-HDMI-A-4 [70.993311] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (4.503s) [71.016955] Starting dynamic subtest: pipe-D-HDMI-A-4 [75.185416] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (4.172s) [75.186401] Subtest cursor-sliding-64x21: SUCCESS (8.701s) [75.530048] [018/144] (924s left) perf_pmu (frequency) [75.581827] Starting subtest: frequency [75.582785] Starting dynamic subtest: gt0 [77.799449] Dynamic subtest gt0: FAIL (2.151s) [77.813025] Starting dynamic subtest: idle-gt0 [78.244433] Dynamic subtest idle-gt0: SUCCESS (0.504s) [78.246743] Subtest frequency: FAIL (2.657s) [78.318035] [019/144] (921s left) kms_plane_scaling (plane-upscale-factor-0-25-with-modifiers) [80.266505] Starting subtest: plane-upscale-factor-0-25-with-modifiers [80.271241] Starting dynamic subtest: pipe-A-HDMI-A-4 [81.279883] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (1.009s) [81.296832] Starting dynamic subtest: pipe-B-HDMI-A-4 [82.235909] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.948s) [82.253083] Starting dynamic subtest: pipe-C-HDMI-A-4 [83.275431] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (1.031s) [83.295135] Starting dynamic subtest: pipe-D-HDMI-A-4 [84.097267] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.813s) [84.098214] Subtest plane-upscale-factor-0-25-with-modifiers: SUCCESS (3.832s) [84.317839] [020/144] (915s left) kms_cursor_legacy (flip-vs-cursor-atomic) [86.301924] Starting subtest: flip-vs-cursor-atomic [94.790912] Subtest flip-vs-cursor-atomic: SUCCESS (8.489s) [94.923020] [021/144] (905s left) kms_psr (fbc-pr-sprite-mmap-gtt) [96.873756] Subtest fbc-pr-sprite-mmap-gtt: SKIP (0.000s) [96.891224] [022/144] (903s left) kms_chamelium_hpd (hdmi-hpd-fast) [98.891038] Subtest hdmi-hpd-fast: SKIP (0.000s) [98.942712] [023/144] (901s left) vc4/vc4_wait_bo (used-bo-1ns) [99.016474] Subtest used-bo-1ns: SKIP (0.000s) [99.065906] [024/144] (900s left) syncobj_timeline (invalid-multi-wait-unsubmitted-signaled) [99.120173] Starting subtest: invalid-multi-wait-unsubmitted-signaled [99.121105] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s) [99.197089] [025/144] (900s left) kms_flip (2x-dpms-vs-vblank-race) [101.185831] Starting subtest: 2x-dpms-vs-vblank-race [101.210979] Subtest 2x-dpms-vs-vblank-race: SKIP (0.025s) [101.283417] [026/144] (898s left) kms_frontbuffer_tracking (psr-rgb565-draw-render) [103.290213] Starting subtest: psr-rgb565-draw-render [103.292109] Subtest psr-rgb565-draw-render: SKIP (0.000s) [103.368285] [027/144] (896s left) syncobj_wait (wait-all-for-submit-snapshot) [103.494440] Starting subtest: wait-all-for-submit-snapshot [103.577317] Subtest wait-all-for-submit-snapshot: SUCCESS (0.082s) [103.682033] [028/144] (896s left) gem_reg_read (bad-register) [103.766015] Starting subtest: bad-register [103.766967] Subtest bad-register: SUCCESS (0.000s) [103.831708] [029/144] (896s left) syncobj_timeline (etime-multi-wait-available-unsubmitted) [103.890930] Starting subtest: etime-multi-wait-available-unsubmitted [104.000568] Subtest etime-multi-wait-available-unsubmitted: SUCCESS (0.105s) [104.075351] [030/144] (896s left) kms_pipe_crc_basic (disable-crc-after-crtc) [106.023515] Starting subtest: disable-crc-after-crtc [106.026081] Starting dynamic subtest: pipe-A-HDMI-A-4 [106.611483] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.585s) [106.619710] Starting dynamic subtest: pipe-B-HDMI-A-4 [106.998473] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.385s) [107.007873] Starting dynamic subtest: pipe-C-HDMI-A-4 [107.400339] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.399s) [107.413733] Starting dynamic subtest: pipe-D-HDMI-A-4 [107.812168] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.408s) [107.813188] Subtest disable-crc-after-crtc: SUCCESS (1.789s) [107.922099] [031/144] (892s left) kms_frontbuffer_tracking (fbc-2p-rte) [109.881551] Starting subtest: fbc-2p-rte [109.883522] Subtest fbc-2p-rte: SKIP (0.000s) [109.961778] [032/144] (890s left) prime_vgem (fence-read-hang) [110.098029] Subtest fence-read-hang: SKIP (0.000s) [110.182218] [033/144] (890s left) kms_frontbuffer_tracking (psr-2p-pri-indfb-multidraw) [112.168418] Starting subtest: psr-2p-pri-indfb-multidraw [112.170437] Subtest psr-2p-pri-indfb-multidraw: SKIP (0.000s) [112.242380] [034/144] (887s left) kms_color (ctm-0-50) [114.280639] Starting subtest: ctm-0-50 [114.283203] Starting dynamic subtest: pipe-A [115.776928] Dynamic subtest pipe-A: SUCCESS (1.495s) [115.782799] Starting dynamic subtest: pipe-B [117.099828] Dynamic subtest pipe-B: SUCCESS (1.323s) [117.107155] Starting dynamic subtest: pipe-C [118.455225] Dynamic subtest pipe-C: SUCCESS (1.354s) [118.462535] Starting dynamic subtest: pipe-D [119.795124] Dynamic subtest pipe-D: SUCCESS (1.340s) [119.796090] Subtest ctm-0-50: SUCCESS (5.517s) [119.921392] [035/144] (880s left) kms_color (legacy-gamma-reset) [121.879204] Starting subtest: legacy-gamma-reset [121.880284] Starting dynamic subtest: pipe-A [122.072904] Dynamic subtest pipe-A: SUCCESS (0.192s) [122.086255] Starting dynamic subtest: pipe-B [122.129615] Dynamic subtest pipe-B: SUCCESS (0.055s) [122.135614] Starting dynamic subtest: pipe-C [122.157522] Dynamic subtest pipe-C: SUCCESS (0.028s) [122.163466] Starting dynamic subtest: pipe-D [122.184542] Dynamic subtest pipe-D: SUCCESS (0.026s) [122.185495] Subtest legacy-gamma-reset: SUCCESS (0.306s) [122.273608] [036/144] (877s left) syncobj_wait (wait-all-delayed-signal) [122.325276] Starting subtest: wait-all-delayed-signal [122.430635] Subtest wait-all-delayed-signal: SUCCESS (0.102s) [122.520810] [037/144] (877s left) kms_flip (2x-nonexisting-fb) [124.508121] Starting subtest: 2x-nonexisting-fb [124.533168] Subtest 2x-nonexisting-fb: SKIP (0.025s) [124.608953] [038/144] (875s left) api_intel_bb (intel-bb-blit-x) [124.708514] Starting subtest: intel-bb-blit-x [125.431358] Subtest intel-bb-blit-x: SUCCESS (0.724s) [125.533397] [039/144] (874s left) kms_atomic (plane-primary-overlay-mutable-zpos) [127.482832] Starting subtest: plane-primary-overlay-mutable-zpos [128.479482] Subtest plane-primary-overlay-mutable-zpos: SKIP (0.996s) [128.634983] [040/144] (871s left) perf_pmu (multi-client) [128.688439] Starting subtest: multi-client [128.689360] Starting dynamic subtest: rcs0 [129.746169] Dynamic subtest rcs0: SUCCESS (1.053s) [129.752224] Starting dynamic subtest: bcs0 [130.800610] Dynamic subtest bcs0: SUCCESS (1.050s) [130.806495] Starting dynamic subtest: vcs0 [131.853735] Dynamic subtest vcs0: SUCCESS (1.049s) [131.859563] Starting dynamic subtest: vcs1 [132.905761] Dynamic subtest vcs1: SUCCESS (1.048s) [132.911613] Starting dynamic subtest: vecs0 [133.958743] Dynamic subtest vecs0: SUCCESS (1.048s) [133.959631] Subtest multi-client: SUCCESS (5.268s) [134.087476] [041/144] (866s left) syncobj_wait (multi-wait-for-submit-signaled) [134.134981] Starting subtest: multi-wait-for-submit-signaled [134.135974] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s) [134.199871] [042/144] (866s left) kms_ccs (pipe-a-bad-pixel-format-4-tiled-dg2-rc-ccs-cc) [136.152179] Starting subtest: pipe-A-bad-pixel-format-4-tiled-dg2-rc-ccs-cc [136.154179] Subtest pipe-A-bad-pixel-format-4-tiled-dg2-rc-ccs-cc: SKIP (0.000s) [136.433242] [043/144] (863s left) kms_psr (fbc-psr-cursor-mmap-cpu) [138.390985] Subtest fbc-psr-cursor-mmap-cpu: SKIP (0.000s) [138.408586] [044/144] (861s left) i915_pm_rps (engine-order) [138.459371] Starting subtest: engine-order [146.236793] Subtest engine-order: SUCCESS (7.773s) [146.380929] [045/144] (854s left) gem_tiled_partial_pwrite_pread (reads) [146.432545] Subtest reads: SKIP (0.000s) [146.457553] [046/144] (853s left) gem_exec_balancer (busy) [146.542336] Starting subtest: busy [147.202214] Subtest busy: SUCCESS (0.660s) [147.522170] [047/144] (852s left) kms_flip (flip-vs-panning-vs-hang) [149.470840] Starting subtest: flip-vs-panning-vs-hang [149.476520] Starting dynamic subtest: A-HDMI-A4 [187.864449] Dynamic subtest A-HDMI-A4: SUCCESS (38.388s) [187.871998] Starting dynamic subtest: D-HDMI-A4 [238.855069] Dynamic subtest D-HDMI-A4: SUCCESS (50.989s) [238.855976] Subtest flip-vs-panning-vs-hang: SUCCESS (89.385s) [238.976259] [048/144] (761s left) gem_pxp (verify-pxp-key-change-after-suspend-resume) [241.545086] Subtest verify-pxp-key-change-after-suspend-resume: SKIP (0.000s) [241.633929] [049/144] (758s left) kms_ccs (pipe-c-random-ccs-data-4-tiled-mtl-mc-ccs) [243.717193] Starting subtest: pipe-C-random-ccs-data-4-tiled-mtl-mc-ccs [243.720422] Subtest pipe-C-random-ccs-data-4-tiled-mtl-mc-ccs: SKIP (0.000s) [243.858371] [050/144] (756s left) gem_exec_schedule (preempt) [243.922955] Starting subtest: preempt [243.923910] Starting dynamic subtest: rcs0 [243.973625] Dynamic subtest rcs0: SUCCESS (0.050s) [243.979807] Starting dynamic subtest: bcs0 [244.009317] Dynamic subtest bcs0: SUCCESS (0.035s) [244.015239] Starting dynamic subtest: vcs0 [244.047714] Dynamic subtest vcs0: SUCCESS (0.037s) [244.053770] Starting dynamic subtest: vcs1 [244.084017] Dynamic subtest vcs1: SUCCESS (0.035s) [244.090010] Starting dynamic subtest: vecs0 [244.121158] Dynamic subtest vecs0: SUCCESS (0.036s) [244.121998] Subtest preempt: SUCCESS (0.199s) [244.481665] [051/144] (756s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu) [246.439481] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu [246.441501] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s) [246.512760] [052/144] (754s left) i915_suspend (sysfs-reader) [246.621516] Starting subtest: sysfs-reader [268.742723] Subtest sysfs-reader: SUCCESS (10.876s) [271.809321] [053/144] (743s left) kms_cursor_legacy (cursorb-vs-flipb-varying-size) [273.764399] Starting subtest: cursorB-vs-flipB-varying-size [273.768420] Subtest cursorB-vs-flipB-varying-size: SKIP (0.002s) [273.836603] [054/144] (741s left) gem_render_linear_blits (basic) [273.940829] Starting subtest: basic [274.030913] Subtest basic: SUCCESS (0.090s) [274.094480] [055/144] (740s left) kms_getfb (getfb-handle-protection) [274.156562] Starting subtest: getfb-handle-protection [274.178204] Subtest getfb-handle-protection: SUCCESS (0.022s) [274.302608] [056/144] (740s left) gem_exec_whisper (basic-queues-priority-all) [274.374958] Starting subtest: basic-queues-priority-all [297.260001] Subtest basic-queues-priority-all: SUCCESS (22.879s) [297.431350] [057/144] (717s left) kms_selftest (drm_dp_mst_helper) [297.481052] Starting subtest: drm_dp_mst_helper [297.705674] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_mode [297.712706] Dynamic subtest drm_test_dp_mst_calc_pbn_mode: SUCCESS (0.011s) [297.721357] Starting dynamic subtest: drm_test_dp_mst_sideband_msg_req_decode [297.722334] Dynamic subtest drm_test_dp_mst_sideband_msg_req_decode: SUCCESS (0.005s) [297.723302] Subtest drm_dp_mst_helper: SUCCESS (0.238s) [297.959189] [058/144] (717s left) kms_psr (psr-primary-mmap-gtt) [299.917692] Subtest psr-primary-mmap-gtt: SKIP (0.000s) [299.939098] [059/144] (715s left) kms_ccs (pipe-a-crc-primary-basic-4-tiled-mtl-rc-ccs-cc) [301.939513] Starting subtest: pipe-A-crc-primary-basic-4-tiled-mtl-rc-ccs-cc [301.941517] Subtest pipe-A-crc-primary-basic-4-tiled-mtl-rc-ccs-cc: SKIP (0.000s) [302.164139] [060/144] (712s left) kms_addfb_basic (framebuffer-vs-set-tiling) [302.215279] Starting subtest: framebuffer-vs-set-tiling [302.217213] Subtest framebuffer-vs-set-tiling: SKIP (0.000s) [304.204362] [061/144] (710s left) gem_mmap_wc (write-read) [304.337805] Subtest write-read: SKIP (0.000s) [304.356163] [062/144] (710s left) kms_ccs (pipe-b-missing-ccs-buffer-y-tiled-gen12-rc-ccs) [306.405652] Starting subtest: pipe-B-missing-ccs-buffer-y-tiled-gen12-rc-ccs [306.406633] Subtest pipe-B-missing-ccs-buffer-y-tiled-gen12-rc-ccs: SUCCESS (0.000s) [306.580472] [063/144] (708s left) perf (global-sseu-config-invalid) [306.692562] Starting subtest: global-sseu-config-invalid [306.693516] Starting dynamic subtest: 0-rcs0 [306.706578] Dynamic subtest 0-rcs0: SUCCESS (0.015s) [306.707596] Subtest global-sseu-config-invalid: SUCCESS (0.016s) [306.730131] [064/144] (708s left) kms_big_fb (y-tiled-8bpp-rotate-180) [308.697546] Starting subtest: y-tiled-8bpp-rotate-180 [310.267301] Subtest y-tiled-8bpp-rotate-180: SUCCESS (1.566s) [310.410402] [065/144] (704s left) kms_rotation_crc (primary-rotation-90) [312.355553] Starting subtest: primary-rotation-90 [322.941176] Subtest primary-rotation-90: SUCCESS (10.585s) [323.124145] [066/144] (691s left) gem_softpin (zero) [323.177085] Starting subtest: zero [323.182281] Subtest zero: SUCCESS (0.005s) [323.314373] [067/144] (691s left) v3d/v3d_perfmon (get-values-valid-perfmon) [323.407510] Subtest get-values-valid-perfmon: SKIP (0.000s) [323.457755] [068/144] (691s left) kms_vrr (flipline) [325.413817] Starting subtest: flipline [325.416121] Subtest flipline: SKIP (0.000s) [325.476412] [069/144] (689s left) syncobj_timeline (multi-wait-for-submit-unsubmitted-signaled) [325.562698] Starting subtest: multi-wait-for-submit-unsubmitted-signaled [325.564122] Subtest multi-wait-for-submit-unsubmitted-signaled: SUCCESS (0.001s) [325.640666] [070/144] (689s left) kms_flip (2x-flip-vs-fences-interruptible) [327.627983] Starting subtest: 2x-flip-vs-fences-interruptible [327.629667] Subtest 2x-flip-vs-fences-interruptible: SKIP (0.000s) [327.693655] [071/144] (687s left) gem_exec_capture (capture-recoverable) [327.808687] Starting subtest: capture-recoverable [327.814414] Subtest capture-recoverable: SUCCESS (0.006s) [327.957373] [072/144] (687s left) kms_cursor_edge_walk (128x128-top-edge) [329.941654] Starting subtest: 128x128-top-edge [329.942612] Starting dynamic subtest: pipe-A-HDMI-A-4 [333.219054] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (3.277s) [333.228302] Starting dynamic subtest: pipe-D-HDMI-A-4 [336.413869] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (3.192s) [336.414755] Subtest 128x128-top-edge: SUCCESS (6.475s) [336.540505] [073/144] (678s left) syncobj_wait (invalid-signal-one-illegal-handle) [336.590777] Starting subtest: invalid-signal-one-illegal-handle [336.591659] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s) [336.670020] [074/144] (678s left) kms_ccs (pipe-c-ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc) [338.770480] Starting subtest: pipe-C-ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc [338.772713] Subtest pipe-C-ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc: SKIP (0.000s) [338.905377] [075/144] (676s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-blt) [340.872180] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-blt [340.874375] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s) [340.942553] [076/144] (674s left) syncobj_eventfd (timeline-wait-signaled) [341.051857] Starting subtest: timeline-wait-signaled [341.052952] Subtest timeline-wait-signaled: SUCCESS (0.001s) [341.131324] [077/144] (674s left) kms_big_fb (yf-tiled-addfb-size-overflow) [343.117530] Starting subtest: yf-tiled-addfb-size-overflow [343.119675] Subtest yf-tiled-addfb-size-overflow: SKIP (0.000s) [343.215781] [078/144] (672s left) gem_ctx_param (root-set) [343.350991] Starting subtest: root-set [343.351895] Subtest root-set: SUCCESS (0.000s) [343.403783] [079/144] (672s left) gem_ctx_isolation (preservation) [343.458869] Starting subtest: preservation [343.459696] Starting dynamic subtest: rcs0 [343.890269] Dynamic subtest rcs0: SUCCESS (0.428s) [343.898499] Starting dynamic subtest: bcs0 [344.421781] Dynamic subtest bcs0: SUCCESS (0.530s) [344.429354] Starting dynamic subtest: vcs0 [344.935164] Dynamic subtest vcs0: SUCCESS (0.512s) [344.943263] Starting dynamic subtest: vcs1 [345.430802] Dynamic subtest vcs1: SUCCESS (0.494s) [345.438856] Starting dynamic subtest: vecs0 [345.971926] Dynamic subtest vecs0: SUCCESS (0.540s) [345.972800] Subtest preservation: SUCCESS (2.511s) [346.206174] [080/144] (669s left) kms_ccs (pipe-d-bad-rotation-90-4-tiled-mtl-rc-ccs-cc) [348.317929] Starting subtest: pipe-D-bad-rotation-90-4-tiled-mtl-rc-ccs-cc [348.320220] Subtest pipe-D-bad-rotation-90-4-tiled-mtl-rc-ccs-cc: SKIP (0.000s) [348.438471] [081/144] (667s left) gem_exec_params (rsvd2-dirt) [348.490440] Starting subtest: rsvd2-dirt [348.492225] Subtest rsvd2-dirt: SKIP (0.000s) [348.587059] [082/144] (666s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-downscaling) [350.568568] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-downscaling [350.569596] Starting dynamic subtest: pipe-A-valid-mode [351.612779] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.041s) [351.613708] Subtest flip-64bpp-xtile-to-16bpp-xtile-downscaling: SUCCESS (1.043s) [351.732194] [083/144] (663s left) syncobj_basic (bad-fd-to-handle) [351.780713] Starting subtest: bad-fd-to-handle [351.781595] Subtest bad-fd-to-handle: SUCCESS (0.000s) [351.858140] [084/144] (663s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-cpu) [353.841568] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-cpu [353.843543] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s) [353.922125] [085/144] (661s left) gem_exec_schedule (reorder-wide) [354.232080] Subtest reorder-wide: SKIP (0.000s) [354.420289] [086/144] (661s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt) [356.382581] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt [356.384362] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [356.472463] [087/144] (659s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-blt) [358.528230] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-blt [358.530273] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-blt: SKIP (0.000s) [358.625689] [088/144] (657s left) vc4/vc4_perfmon (create-single-perfmon) [358.780888] Subtest create-single-perfmon: SKIP (0.000s) [358.830152] [089/144] (656s left) drm_fdinfo (busy) [358.881355] Starting subtest: busy [358.882362] Starting dynamic subtest: rcs0 [358.884344] Dynamic subtest rcs0: SKIP (0.000s) [358.892451] Starting dynamic subtest: bcs0 [358.894679] Dynamic subtest bcs0: SKIP (0.000s) [358.902247] Starting dynamic subtest: vcs0 [358.904136] Dynamic subtest vcs0: SKIP (0.000s) [358.911576] Starting dynamic subtest: vcs1 [358.913401] Dynamic subtest vcs1: SKIP (0.000s) [358.920722] Starting dynamic subtest: vecs0 [358.922979] Dynamic subtest vecs0: SKIP (0.000s) [358.925278] Subtest busy: SKIP (0.006s) [358.948164] [090/144] (656s left) kms_big_fb (x-tiled-8bpp-rotate-0) [360.910797] Starting subtest: x-tiled-8bpp-rotate-0 [362.467515] Subtest x-tiled-8bpp-rotate-0: SUCCESS (1.552s) [362.609444] [091/144] (653s left) kms_cursor_crc (cursor-onscreen-max-size) [364.785971] Starting subtest: cursor-onscreen-max-size [364.789646] Subtest cursor-onscreen-max-size: SKIP (0.000s) [364.926900] [092/144] (650s left) kms_ccs (pipe-a-crc-primary-basic-4-tiled-dg2-mc-ccs) [366.956216] Starting subtest: pipe-A-crc-primary-basic-4-tiled-dg2-mc-ccs [366.958140] Subtest pipe-A-crc-primary-basic-4-tiled-dg2-mc-ccs: SKIP (0.000s) [367.179535] [093/144] (648s left) kms_pm_rpm (modeset-lpsp-stress) [371.706461] Starting subtest: modeset-lpsp-stress [372.941892] Subtest modeset-lpsp-stress: SKIP (1.234s) [374.134609] [094/144] (641s left) gem_exec_store (cachelines) [374.217462] Starting subtest: cachelines [374.218529] Starting dynamic subtest: rcs0 [374.286451] Dynamic subtest rcs0: SUCCESS (0.068s) [374.298585] Starting dynamic subtest: bcs0 [374.337326] Dynamic subtest bcs0: SUCCESS (0.049s) [374.375137] Starting dynamic subtest: vcs0 [374.415610] Dynamic subtest vcs0: SUCCESS (0.074s) [374.453857] Starting dynamic subtest: vcs1 [374.490039] Dynamic subtest vcs1: SUCCESS (0.070s) [374.510545] Starting dynamic subtest: vecs0 [374.552678] Dynamic subtest vecs0: SUCCESS (0.060s) [374.554991] Subtest cachelines: SUCCESS (0.336s) [374.804738] [095/144] (641s left) gem_ctx_persistence (legacy-engines-hang) [374.866148] Starting subtest: legacy-engines-hang [374.867060] Starting dynamic subtest: render [374.918612] Dynamic subtest render: SUCCESS (0.052s) [374.929364] Starting dynamic subtest: bsd1 [375.004008] Dynamic subtest bsd1: SUCCESS (0.083s) [375.045897] Starting dynamic subtest: bsd2 [375.054865] Dynamic subtest bsd2: SUCCESS (0.045s) [375.071863] Starting dynamic subtest: blt [375.082622] Dynamic subtest blt: SUCCESS (0.025s) [375.094697] Starting dynamic subtest: vebox [375.166084] Dynamic subtest vebox: SUCCESS (0.080s) [375.168970] Subtest legacy-engines-hang: SUCCESS (0.302s) [375.330526] [096/144] (640s left) gem_flink_race (flink_close) [375.395733] Starting subtest: flink_close [380.419525] Subtest flink_close: SUCCESS (5.024s) [380.483887] [097/144] (635s left) gem_workarounds (basic-read-fd) [380.619739] Starting subtest: basic-read-fd [380.658358] Subtest basic-read-fd: SUCCESS (0.035s) [380.770741] [098/144] (635s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-fullscreen) [382.761070] Starting subtest: psr-2p-primscrn-spr-indfb-fullscreen [382.763071] Subtest psr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s) [382.853429] [099/144] (633s left) fbdev (read) [382.994945] Starting subtest: read [384.440647] Subtest read: SUCCESS (1.442s) [384.478217] [100/144] (631s left) gem_partial_pwrite_pread (writes-after-reads-display) [384.528430] Subtest writes-after-reads-display: SKIP (0.000s) [384.570937] [101/144] (631s left) kms_ccs (pipe-d-bad-aux-stride-y-tiled-ccs) [386.702096] Starting subtest: pipe-D-bad-aux-stride-y-tiled-ccs [386.703682] Subtest pipe-D-bad-aux-stride-y-tiled-ccs: SKIP (0.000s) [386.794437] [102/144] (629s left) gem_mmap_offset (bad-extensions) [386.846739] Starting subtest: bad-extensions [386.847642] Subtest bad-extensions: SUCCESS (0.000s) [386.954746] [103/144] (629s left) gem_readwrite (write-bad-handle) [387.012127] Subtest write-bad-handle: SKIP (0.000s) [387.055269] [104/144] (629s left) syncobj_wait (single-wait-for-submit-submitted) [387.108238] Starting subtest: single-wait-for-submit-submitted [387.218959] Subtest single-wait-for-submit-submitted: SUCCESS (0.106s) [387.298097] [105/144] (628s left) gem_close (many-handles-one-vma) [387.356927] Starting subtest: many-handles-one-vma [387.386631] Subtest many-handles-one-vma: SUCCESS (0.030s) [387.498828] [106/144] (628s left) kms_ccs (pipe-b-crc-primary-rotation-180-y-tiled-gen12-mc-ccs) [389.544473] Starting subtest: pipe-B-crc-primary-rotation-180-y-tiled-gen12-mc-ccs [389.546751] Subtest pipe-B-crc-primary-rotation-180-y-tiled-gen12-mc-ccs: SKIP (0.001s) [389.730573] [107/144] (626s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-0) [391.694605] Starting subtest: linear-max-hw-stride-32bpp-rotate-0 [392.929099] Subtest linear-max-hw-stride-32bpp-rotate-0: SUCCESS (1.233s) [393.015440] [108/144] (623s left) gem_lmem_swapping (parallel-random-verify-ccs) [397.682833] Starting subtest: parallel-random-verify-ccs [397.683662] Starting dynamic subtest: lmem0 [397.685288] Dynamic subtest lmem0: SKIP (0.000s) [397.687530] Subtest parallel-random-verify-ccs: SKIP (0.001s) [398.787017] [109/144] (617s left) syncobj_basic (create-signaled) [402.960910] Starting subtest: create-signaled [402.962832] Subtest create-signaled: SUCCESS (0.000s) [403.007941] [110/144] (613s left) kms_ccs (pipe-b-bad-aux-stride-y-tiled-gen12-rc-ccs) [405.066507] Starting subtest: pipe-B-bad-aux-stride-y-tiled-gen12-rc-ccs [405.067518] Subtest pipe-B-bad-aux-stride-y-tiled-gen12-rc-ccs: SUCCESS (0.001s) [405.234534] [111/144] (611s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-plflip-blt) [407.188932] Starting subtest: fbcpsr-2p-primscrn-indfb-plflip-blt [407.190836] Subtest fbcpsr-2p-primscrn-indfb-plflip-blt: SKIP (0.000s) [407.274563] [112/144] (609s left) sysfs_preempt_timeout (invalid) [407.396518] Starting subtest: invalid [407.397660] Starting dynamic subtest: vecs0 [407.398764] Dynamic subtest vecs0: SUCCESS (0.000s) [407.406209] Starting dynamic subtest: vcs0 [407.407296] Dynamic subtest vcs0: SUCCESS (0.000s) [407.414360] Starting dynamic subtest: bcs0 [407.415683] Dynamic subtest bcs0: SUCCESS (0.000s) [407.422621] Starting dynamic subtest: rcs0 [407.423685] Dynamic subtest rcs0: SUCCESS (0.000s) [407.430641] Starting dynamic subtest: vcs1 [407.431696] Dynamic subtest vcs1: SUCCESS (0.000s) [407.432857] Subtest invalid: SUCCESS (0.008s) [407.492029] [113/144] (608s left) kms_frontbuffer_tracking (fbcpsr-1p-indfb-fliptrack-mmap-gtt) [409.471148] Starting subtest: fbcpsr-1p-indfb-fliptrack-mmap-gtt [409.472804] Subtest fbcpsr-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s) [409.559897] [114/144] (606s left) i915_pciid [409.780024] [115/144] (606s left) gem_userptr_blits (vma-merge) [409.879656] Starting subtest: vma-merge [429.970559] Subtest vma-merge: FAIL (20.075s) [430.078237] [116/144] (586s left) gem_render_copy (y-tiled-mc-ccs-to-yf-tiled-ccs) [430.132265] Starting subtest: y-tiled-mc-ccs-to-yf-tiled-ccs [430.133175] Starting dynamic subtest: smem [430.229310] Dynamic subtest smem: SUCCESS (0.096s) [430.237957] Starting dynamic subtest: lmem0 [431.330539] Dynamic subtest lmem0: SUCCESS (1.097s) [431.331429] Subtest y-tiled-mc-ccs-to-yf-tiled-ccs: SUCCESS (1.196s) [431.535091] [117/144] (584s left) kms_ccs (pipe-d-crc-primary-rotation-180-y-tiled-ccs) [433.654332] Starting subtest: pipe-D-crc-primary-rotation-180-y-tiled-ccs [433.656603] Subtest pipe-D-crc-primary-rotation-180-y-tiled-ccs: SKIP (0.000s) [433.766623] [118/144] (582s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip) [435.735989] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip [435.738052] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SKIP (0.000s) [435.826774] [119/144] (580s left) kms_frontbuffer_tracking (fbc-1p-offscren-pri-indfb-draw-mmap-wc) [437.878352] Starting subtest: fbc-1p-offscren-pri-indfb-draw-mmap-wc [437.880651] Subtest fbc-1p-offscren-pri-indfb-draw-mmap-wc: SKIP (0.000s) [437.976919] [120/144] (578s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-wc) [440.040149] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-wc [440.041991] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s) [440.143796] [121/144] (576s left) api_intel_bb (blit-noreloc-keep-cache) [440.286415] Starting subtest: blit-noreloc-keep-cache [440.303794] Subtest blit-noreloc-keep-cache: SUCCESS (0.019s) [440.388910] [122/144] (576s left) drm_fdinfo (virtual-busy-idle) [440.455002] Starting subtest: virtual-busy-idle [440.456860] Subtest virtual-busy-idle: SKIP (0.000s) [440.517126] [123/144] (576s left) kms_psr (psr2-cursor-plane-onoff) [442.471624] Subtest psr2-cursor-plane-onoff: SKIP (0.000s) [442.491510] [124/144] (574s left) vgem_basic (bad-handle) [442.548773] Starting subtest: bad-handle [442.549936] Subtest bad-handle: SUCCESS (0.000s) [442.606101] [125/144] (574s left) kms_sequence (get-forked-busy) [444.613345] Starting subtest: get-forked-busy [444.616437] Starting dynamic subtest: pipe-A-HDMI-A-4 [447.206903] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (2.589s) [447.230648] Starting dynamic subtest: pipe-B-HDMI-A-4 [449.700171] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (2.485s) [449.723767] Starting dynamic subtest: pipe-C-HDMI-A-4 [452.199745] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (2.492s) [452.221006] Starting dynamic subtest: pipe-D-HDMI-A-4 [454.704197] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (2.496s) [454.705654] Subtest get-forked-busy: SUCCESS (10.090s) [454.829303] [126/144] (561s left) i915_suspend (basic-s3-without-i915) [454.873084] Starting subtest: basic-s3-without-i915 [480.012782] Subtest basic-s3-without-i915: SUCCESS (13.082s) [480.075921] [127/144] (548s left) gem_wait (invalid-flags) [480.134066] Starting subtest: invalid-flags [480.134957] Subtest invalid-flags: SUCCESS (0.000s) [480.425159] [128/144] (548s left) v3d/v3d_submit_csd (bad-multisync-extension) [480.558427] Subtest bad-multisync-extension: SKIP (0.000s) [480.612499] [129/144] (548s left) kms_pipe_crc_basic (bad-source) [482.558288] Starting subtest: bad-source [482.559121] Subtest bad-source: SUCCESS (0.000s) [482.626988] [130/144] (546s left) kms_dsc (dsc-with-bpc) [484.643762] Subtest dsc-with-bpc: SKIP (0.000s) [484.666685] [131/144] (544s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-hflip) [486.630743] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-hflip [486.635424] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s) [486.715252] [132/144] (542s left) gem_mmap_offset (ptrace) [486.856233] Starting subtest: ptrace [486.863013] Starting dynamic subtest: lmem0-fixed [486.978288] Dynamic subtest lmem0-fixed: SUCCESS (0.112s) [486.986934] Starting dynamic subtest: smem0-fixed [487.006762] Dynamic subtest smem0-fixed: SUCCESS (0.026s) [487.007675] Subtest ptrace: SUCCESS (0.152s) [487.079381] [133/144] (541s left) kms_ccs (pipe-d-random-ccs-data-4-tiled-mtl-rc-ccs) [489.199894] Starting subtest: pipe-D-random-ccs-data-4-tiled-mtl-rc-ccs [489.203148] Subtest pipe-D-random-ccs-data-4-tiled-mtl-rc-ccs: SKIP (0.000s) [489.306933] [134/144] (539s left) kms_ccs (pipe-a-missing-ccs-buffer-y-tiled-ccs) [491.328617] Starting subtest: pipe-A-missing-ccs-buffer-y-tiled-ccs [491.330666] Subtest pipe-A-missing-ccs-buffer-y-tiled-ccs: SKIP (0.000s) [491.541301] [135/144] (537s left) gem_create (hog-create) [491.596081] Starting subtest: hog-create [491.597030] Starting dynamic subtest: lmem0 [523.869748] Dynamic subtest lmem0: SUCCESS (32.273s) [523.879473] Starting dynamic subtest: smem0 [556.124717] Dynamic subtest smem0: SUCCESS (32.254s) [556.125685] Subtest hog-create: SUCCESS (64.529s) [556.374660] [136/144] (472s left) kms_prop_blob (blob-multiple) [556.420389] Starting subtest: blob-multiple [556.422798] Subtest blob-multiple: SUCCESS (0.002s) [556.483808] [137/144] (472s left) gem_exec_parallel (userptr) [556.545944] Starting subtest: userptr [556.546872] Starting dynamic subtest: rcs0 [558.082837] Dynamic subtest rcs0: SUCCESS (1.535s) [558.114250] Starting dynamic subtest: bcs0 [559.558791] Dynamic subtest bcs0: SUCCESS (1.473s) [559.568469] Starting dynamic subtest: vcs0 [561.013684] Dynamic subtest vcs0: SUCCESS (1.454s) [561.025413] Starting dynamic subtest: vcs1 [562.473612] Dynamic subtest vcs1: SUCCESS (1.459s) [562.484520] Starting dynamic subtest: vecs0 [563.923720] Dynamic subtest vecs0: SUCCESS (1.448s) [563.931770] Subtest userptr: SUCCESS (7.380s) [564.220642] [138/144] (464s left) kms_ccs (pipe-c-ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc) [566.329213] Starting subtest: pipe-C-ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc [566.330067] Subtest pipe-C-ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc: SUCCESS (0.000s) [566.465728] [139/144] (462s left) gem_exec_reloc (basic-gtt-cpu-active) [566.522536] Subtest basic-gtt-cpu-active: SKIP (0.000s) [566.558739] [140/144] (462s left) kms_frontbuffer_tracking (fbcpsr-stridechange) [568.518661] Starting subtest: fbcpsr-stridechange [568.520773] Subtest fbcpsr-stridechange: SKIP (0.000s) [568.611628] [141/144] (460s left) kms_lease (master-vs-lease) [570.648684] Starting subtest: master-vs-lease [570.649635] Subtest master-vs-lease: SUCCESS (0.001s) [570.718872] [142/144] (458s left) prime_vgem (basic-fence-flip) [570.834357] Starting subtest: basic-fence-flip [572.766189] Subtest basic-fence-flip: SKIP (1.931s) [572.857602] [143/144] (456s left) sysfs_heartbeat_interval (idempotent) [572.997225] Starting subtest: idempotent [572.998140] Starting dynamic subtest: vecs0 [573.000622] Dynamic subtest vecs0: SUCCESS (0.001s) [573.008544] Starting dynamic subtest: vcs0 [573.009400] Dynamic subtest vcs0: SUCCESS (0.001s) [573.016947] Starting dynamic subtest: bcs0 [573.018022] Dynamic subtest bcs0: SUCCESS (0.001s) [573.025412] Starting dynamic subtest: rcs0 [573.026450] Dynamic subtest rcs0: SUCCESS (0.001s) [573.034063] Starting dynamic subtest: vcs1 [573.035276] Dynamic subtest vcs1: SUCCESS (0.001s) [573.036476] Subtest idempotent: SUCCESS (0.011s) [573.086203] [144/144] (456s left) kms_flip (plain-flip-fb-recreate-interruptible) [575.061365] Starting subtest: plain-flip-fb-recreate-interruptible [575.073086] Starting dynamic subtest: A-HDMI-A4 [583.070152] Dynamic subtest A-HDMI-A4: SUCCESS (7.996s) [583.106877] Starting dynamic subtest: B-HDMI-A4 [591.043118] Dynamic subtest B-HDMI-A4: SUCCESS (7.965s) [591.076943] Starting dynamic subtest: C-HDMI-A4 [599.014482] Dynamic subtest C-HDMI-A4: SUCCESS (7.964s) [599.051204] Starting dynamic subtest: D-HDMI-A4 [606.985833] Dynamic subtest D-HDMI-A4: SUCCESS (7.964s) [606.993958] Subtest plain-flip-fb-recreate-interruptible: SUCCESS (31.926s) [607.138509] Closing watchdogs Done.