[58.054215] Initializing watchdogs [58.054375] /dev/watchdog0 [58.062586] [001/131] (960s left) sysfs_timeslice_duration (timeout) [58.129698] Starting subtest: timeout [58.132123] Starting dynamic subtest: vecs0 [67.966191] Dynamic subtest vecs0: SUCCESS (9.789s) [67.971989] Starting dynamic subtest: ccs0 [69.128250] Dynamic subtest ccs0: SUCCESS (1.161s) [69.136835] Starting dynamic subtest: vcs0 [78.950085] Dynamic subtest vcs0: SUCCESS (9.810s) [78.958686] Starting dynamic subtest: bcs0 [79.422165] Dynamic subtest bcs0: SUCCESS (0.473s) [79.430268] Starting dynamic subtest: rcs0 [80.568755] Dynamic subtest rcs0: SUCCESS (1.146s) [80.575214] Starting dynamic subtest: vcs1 [89.970271] Dynamic subtest vcs1: SUCCESS (9.396s) [89.972751] Subtest timeout: SUCCESS (31.777s) [90.023777] [002/131] (928s left) kms_big_fb (linear-16bpp-rotate-180) [90.129196] Starting subtest: linear-16bpp-rotate-180 [91.535265] Subtest linear-16bpp-rotate-180: FAIL (0.814s) [91.551131] [003/131] (927s left) kms_psr (fbc-psr-basic) [91.647656] Starting subtest: fbc-psr-basic [91.649636] Starting dynamic subtest: eDP-1 [91.653116] Dynamic subtest eDP-1: SKIP (0.000s) [91.656660] Subtest fbc-psr-basic: SKIP (0.000s) [91.698911] [004/131] (926s left) kms_vblank (wait-idle-hang) [91.789549] Starting subtest: wait-idle-hang [91.791623] Starting dynamic subtest: pipe-A-eDP-1 [98.267172] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.473s) [98.279722] Starting dynamic subtest: pipe-D-eDP-1 [105.252954] Dynamic subtest pipe-D-eDP-1: SUCCESS (6.984s) [105.255067] Subtest wait-idle-hang: SUCCESS (13.460s) [106.032760] [005/131] (912s left) prime_mmap_kms (buffer-sharing) [106.127949] Starting subtest: buffer-sharing [106.562092] Subtest buffer-sharing: SUCCESS (0.432s) [107.354554] [006/131] (911s left) gem_exec_whisper (basic-fds-priority) [107.416181] Starting subtest: basic-fds-priority [131.407119] Subtest basic-fds-priority: SUCCESS (23.983s) [131.562587] [007/131] (887s left) dumb_buffer (create-valid-dumb) [131.621015] Starting subtest: create-valid-dumb [131.623339] Subtest create-valid-dumb: SUCCESS (0.000s) [131.714874] [008/131] (887s left) kms_pm_backlight (fade) [131.829892] Starting subtest: fade [131.879707] Starting dynamic subtest: eDP-1 [134.546646] Dynamic subtest eDP-1: SUCCESS (2.664s) [134.549149] Subtest fade: SUCCESS (2.714s) [135.377214] [009/131] (883s left) gem_userptr_blits (process-exit) [135.448124] Starting subtest: process-exit [135.457316] Subtest process-exit: SUCCESS (0.010s) [135.567541] [010/131] (883s left) gen7_exec_parse (basic-offset) [135.637362] Subtest basic-offset: SKIP (0.000s) [135.702308] [011/131] (883s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-pwrite) [135.808147] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-pwrite [139.068695] Subtest fbc-1p-primscrn-cur-indfb-draw-pwrite: SUCCESS (3.265s) [139.163710] [012/131] (879s left) gem_exec_fence (syncobj-signal) [139.639918] Starting subtest: syncobj-signal [139.644984] Subtest syncobj-signal: SUCCESS (0.005s) [140.985204] [013/131] (877s left) kms_frontbuffer_tracking (fbcpsr-1p-offscren-pri-shrfb-draw-mmap-cpu) [141.092592] Starting subtest: fbcpsr-1p-offscren-pri-shrfb-draw-mmap-cpu [145.552729] Subtest fbcpsr-1p-offscren-pri-shrfb-draw-mmap-cpu: SUCCESS (4.463s) [145.689919] [014/131] (873s left) gem_exec_balancer (smoke) [145.755509] Starting subtest: smoke [168.237497] Subtest smoke: SUCCESS (22.479s) [169.927837] [015/131] (848s left) gem_exec_schedule (implicit-read-write) [170.005131] Starting subtest: implicit-read-write [170.007145] Starting dynamic subtest: rcs0 [170.186719] Dynamic subtest rcs0: SUCCESS (0.186s) [170.197422] Starting dynamic subtest: vcs0 [170.274034] Dynamic subtest vcs0: SUCCESS (0.089s) [170.284457] Starting dynamic subtest: vcs1 [170.366814] Dynamic subtest vcs1: SUCCESS (0.093s) [170.377441] Starting dynamic subtest: vecs0 [170.466664] Dynamic subtest vecs0: SUCCESS (0.100s) [170.476717] Starting dynamic subtest: ccs0 [170.583729] Dynamic subtest ccs0: SUCCESS (0.117s) [170.586243] Subtest implicit-read-write: SUCCESS (0.585s) [172.018456] [016/131] (846s left) i915_power (sanity) [172.072768] Starting subtest: sanity [176.117151] Subtest sanity: SUCCESS (4.038s) [177.961194] [017/131] (840s left) gem_mmap_wc (copy) [178.026437] Subtest copy: SKIP (0.000s) [178.076439] [018/131] (840s left) kms_psr (fbc-psr2-basic) [178.179108] Starting subtest: fbc-psr2-basic [178.181367] Starting dynamic subtest: eDP-1 [178.185439] Dynamic subtest eDP-1: SKIP (0.000s) [178.189552] Subtest fbc-psr2-basic: SKIP (0.000s) [178.237453] [019/131] (840s left) kms_color (ctm-0-50) [178.338835] Starting subtest: ctm-0-50 [178.341140] Starting dynamic subtest: pipe-A-eDP-1 [181.662511] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.313s) [181.671614] Starting dynamic subtest: pipe-B-eDP-1 [185.609687] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.957s) [185.619299] Starting dynamic subtest: pipe-C-eDP-1 [189.434409] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.823s) [189.442186] Starting dynamic subtest: pipe-D-eDP-1 [193.199281] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.765s) [193.201701] Subtest ctm-0-50: SUCCESS (14.859s) [193.966217] [020/131] (825s left) syncobj_wait (reset-signaled) [194.028496] Starting subtest: reset-signaled [194.030820] Subtest reset-signaled: SUCCESS (0.000s) [194.121604] [021/131] (824s left) syncobj_timeline (32bits-limit) [194.177907] Starting subtest: 32bits-limit [194.180180] Subtest 32bits-limit: SUCCESS (0.001s) [194.273564] [022/131] (824s left) gem_exec_balancer (bonded-semaphore) [194.346786] Starting subtest: bonded-semaphore [194.351266] Subtest bonded-semaphore: SKIP (0.000s) [194.636659] [023/131] (824s left) kms_cursor_crc (cursor-rapid-movement-128x128) [194.822535] Starting subtest: cursor-rapid-movement-128x128 [194.824852] Starting dynamic subtest: pipe-A-eDP-1 [195.366393] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.541s) [195.389424] Starting dynamic subtest: pipe-D-eDP-1 [196.590542] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.208s) [196.592981] Subtest cursor-rapid-movement-128x128: SUCCESS (1.768s) [197.419695] [024/131] (821s left) gem_workarounds (basic-read-context) [197.490233] Starting subtest: basic-read-context [197.499703] Subtest basic-read-context: SUCCESS (0.009s) [197.597189] [025/131] (821s left) kms_chamelium_color (ctm-0-50) [197.702279] Subtest ctm-0-50: SKIP (0.000s) [197.726884] [026/131] (821s left) syncobj_timeline (invalid-multi-wait-unsubmitted-signaled) [197.787868] Starting subtest: invalid-multi-wait-unsubmitted-signaled [197.790014] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s) [197.873070] [027/131] (821s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc) [197.958885] Starting subtest: missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc [197.961219] Starting dynamic subtest: pipe-A-eDP-1 [197.981415] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s) [197.989081] Starting dynamic subtest: pipe-B-eDP-1 [198.008025] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [198.014983] Starting dynamic subtest: pipe-C-eDP-1 [198.034034] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [198.041122] Starting dynamic subtest: pipe-D-eDP-1 [198.060700] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [198.062939] Subtest missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.004s) [200.064277] [028/131] (819s left) prime_busy (hang) [200.119294] Starting subtest: hang [200.121637] Starting dynamic subtest: rcs0 [226.435395] Dynamic subtest rcs0: SUCCESS (26.310s) [226.444213] Starting dynamic subtest: bcs0 [233.583497] Dynamic subtest bcs0: SUCCESS (7.148s) [233.592924] Starting dynamic subtest: vcs0 [240.564216] Dynamic subtest vcs0: SUCCESS (6.982s) [240.574108] Starting dynamic subtest: vcs1 [247.606087] Dynamic subtest vcs1: SUCCESS (7.039s) [247.615079] Starting dynamic subtest: vecs0 [254.577742] Dynamic subtest vecs0: SUCCESS (6.973s) [254.587749] Starting dynamic subtest: ccs0 [268.416081] Dynamic subtest ccs0: SUCCESS (13.835s) [268.418259] Subtest hang: SUCCESS (68.290s) [268.528342] [029/131] (750s left) kms_ccs (crc-primary-suspend-4-tiled-bmg-ccs) [268.633052] Starting subtest: crc-primary-suspend-4-tiled-bmg-ccs [268.637697] Subtest crc-primary-suspend-4-tiled-bmg-ccs: SKIP (0.000s) [269.681927] [030/131] (749s left) gem_render_copy (y-tiled-to-vebox-yf-tiled) [269.743536] Starting subtest: y-tiled-to-vebox-yf-tiled [269.748350] Subtest y-tiled-to-vebox-yf-tiled: SKIP (0.000s) [269.907741] [031/131] (749s left) kms_big_fb (x-tiled-8bpp-rotate-90) [270.016859] Starting subtest: x-tiled-8bpp-rotate-90 [270.038326] Subtest x-tiled-8bpp-rotate-90: SKIP (0.021s) [270.146513] [032/131] (749s left) kms_panel_fitting (atomic-fastset) [270.249995] Starting subtest: atomic-fastset [270.252332] Starting dynamic subtest: pipe-A-eDP-1 [270.390452] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.140s) [270.400410] Starting dynamic subtest: pipe-B-eDP-1 [271.559082] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.168s) [271.569494] Starting dynamic subtest: pipe-C-eDP-1 [272.740534] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.179s) [272.750161] Starting dynamic subtest: pipe-D-eDP-1 [273.861079] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.120s) [273.863429] Subtest atomic-fastset: SUCCESS (3.609s) [275.081917] [033/131] (744s left) kms_big_fb (y-tiled-16bpp-rotate-270) [275.194265] Starting subtest: y-tiled-16bpp-rotate-270 [275.198719] Subtest y-tiled-16bpp-rotate-270: SKIP (0.000s) [275.264399] [034/131] (744s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs-cc) [275.356998] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs-cc [275.359353] Starting dynamic subtest: pipe-A-eDP-1 [275.515069] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.149s) [275.523797] Starting dynamic subtest: pipe-B-eDP-1 [275.544494] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.010s) [275.552196] Starting dynamic subtest: pipe-C-eDP-1 [275.571084] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.009s) [275.578073] Starting dynamic subtest: pipe-D-eDP-1 [275.596409] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.009s) [275.598282] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.179s) [277.736285] [035/131] (741s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs) [277.832116] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs [277.834440] Starting dynamic subtest: pipe-A-eDP-1 [277.843604] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [277.852303] Starting dynamic subtest: pipe-B-eDP-1 [277.861248] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [277.867993] Starting dynamic subtest: pipe-C-eDP-1 [277.876464] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [277.883318] Starting dynamic subtest: pipe-D-eDP-1 [277.891744] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [277.895847] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.004s) [279.987021] [036/131] (739s left) gem_exec_params (batch-first) [280.042545] Starting subtest: batch-first [280.051235] Subtest batch-first: SUCCESS (0.009s) [280.159948] [037/131] (739s left) kms_lease (atomic-implicit-crtc) [280.249597] Starting subtest: atomic-implicit-crtc [280.251825] Starting dynamic subtest: pipe-A-eDP-1 [280.262567] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s) [280.270800] Starting dynamic subtest: pipe-B-eDP-1 [280.282102] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.007s) [280.290448] Starting dynamic subtest: pipe-C-eDP-1 [280.301492] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.008s) [280.308584] Starting dynamic subtest: pipe-D-eDP-1 [280.319475] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.008s) [280.321586] Subtest atomic-implicit-crtc: SUCCESS (0.028s) [280.369467] [038/131] (738s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-render) [280.475735] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-render [280.480236] Subtest fbc-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s) [280.561681] [039/131] (738s left) kms_lease (lease-uevent) [280.659077] Starting subtest: lease-uevent [281.673761] Subtest lease-uevent: SUCCESS (1.010s) [281.725637] [040/131] (737s left) kms_frontbuffer_tracking (psr-rgb565-draw-blt) [281.822141] Starting subtest: psr-rgb565-draw-blt [286.677867] Subtest psr-rgb565-draw-blt: SUCCESS (4.858s) [286.802958] [041/131] (732s left) kms_big_fb (x-tiled-16bpp-rotate-0) [286.915378] Starting subtest: x-tiled-16bpp-rotate-0 [287.993120] Subtest x-tiled-16bpp-rotate-0: SUCCESS (1.077s) [288.116467] [042/131] (731s left) gem_exec_balancer (full) [288.179253] Starting subtest: full [292.655813] Subtest full: SUCCESS (4.476s) [292.971683] [043/131] (726s left) gem_pxp (create-regular-buffer) [293.102648] Starting subtest: create-regular-buffer [293.105029] Subtest create-regular-buffer: SUCCESS (0.000s) [294.204538] [044/131] (725s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180) [294.316194] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180 [294.320102] Subtest y-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s) [294.411223] [045/131] (725s left) kms_cursor_legacy (flip-vs-cursor-atomic-transitions-varying-size) [294.533692] Starting subtest: flip-vs-cursor-atomic-transitions-varying-size [302.682706] Subtest flip-vs-cursor-atomic-transitions-varying-size: SUCCESS (8.149s) [303.465270] [046/131] (716s left) kms_big_fb (yf-tiled-64bpp-rotate-270) [303.583556] Starting subtest: yf-tiled-64bpp-rotate-270 [303.587748] Subtest yf-tiled-64bpp-rotate-270: SKIP (0.000s) [303.672354] [047/131] (715s left) gem_eio (throttle) [303.906798] Starting subtest: throttle [304.200026] Subtest throttle: SUCCESS (0.293s) [304.296270] [048/131] (715s left) kms_vrr (seamless-rr-switch-drrs) [304.387939] Starting subtest: seamless-rr-switch-drrs [304.394583] Subtest seamless-rr-switch-drrs: SKIP (0.000s) [304.439552] [049/131] (715s left) perf_pmu (init-busy) [304.476479] Starting subtest: init-busy [304.478506] Starting dynamic subtest: rcs0 [304.480418] Dynamic subtest rcs0: SUCCESS (0.001s) [304.489982] Starting dynamic subtest: bcs0 [304.491887] Dynamic subtest bcs0: SUCCESS (0.001s) [304.498863] Starting dynamic subtest: vcs0 [304.500743] Dynamic subtest vcs0: SUCCESS (0.000s) [304.507838] Starting dynamic subtest: vcs1 [304.509562] Dynamic subtest vcs1: SUCCESS (0.000s) [304.516335] Starting dynamic subtest: vecs0 [304.517993] Dynamic subtest vecs0: SUCCESS (0.000s) [304.524685] Starting dynamic subtest: ccs0 [304.526291] Dynamic subtest ccs0: SUCCESS (0.001s) [304.527880] Subtest init-busy: SUCCESS (0.005s) [304.565998] [050/131] (715s left) i915_pm_rpm (gem-mmap-type) [306.079129] Starting subtest: gem-mmap-type [306.081671] Starting dynamic subtest: wb-smem0 [310.195639] Dynamic subtest wb-smem0: SUCCESS (4.114s) [310.203378] Starting dynamic subtest: wc-smem0 [313.324502] Dynamic subtest wc-smem0: SUCCESS (3.129s) [313.332545] Starting dynamic subtest: uc-smem0 [316.464555] Dynamic subtest uc-smem0: SUCCESS (3.137s) [316.466878] Subtest gem-mmap-type: SUCCESS (10.383s) [316.529997] [051/131] (703s left) kms_cursor_legacy (cursora-vs-flipa-varying-size) [316.645096] Starting subtest: cursorA-vs-flipA-varying-size [327.783480] Subtest cursorA-vs-flipA-varying-size: SUCCESS (11.136s) [328.625158] [052/131] (690s left) kms_psr2_sf (psr2-overlay-primary-update-sf-dmg-area) [333.581425] Starting subtest: psr2-overlay-primary-update-sf-dmg-area [333.583689] Starting dynamic subtest: pipe-A-eDP-1 [340.170297] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.586s) [340.178245] Starting dynamic subtest: pipe-B-eDP-1 [346.702999] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.530s) [346.705302] Subtest psr2-overlay-primary-update-sf-dmg-area: SUCCESS (13.121s) [347.555391] [053/131] (672s left) kms_getfb (getfb-repeated-different-handles) [347.615359] Starting subtest: getfb-repeated-different-handles [347.617677] Subtest getfb-repeated-different-handles: SUCCESS (0.000s) [347.700201] [054/131] (671s left) kms_content_protection (dp-mst-lic-type-1) [347.842717] Starting subtest: dp-mst-lic-type-1 [347.847840] Subtest dp-mst-lic-type-1: SKIP (0.000s) [347.944547] [055/131] (671s left) gem_exec_reloc (basic-wc-read-active) [348.010985] Subtest basic-wc-read-active: SKIP (0.000s) [348.078071] [056/131] (671s left) gem_ppgtt (blt-vs-render-ctxn) [348.138534] Starting subtest: blt-vs-render-ctxN [381.328692] Subtest blt-vs-render-ctxN: SUCCESS (33.186s) [381.460092] [057/131] (638s left) gem_ctx_freq (sysfs) [381.556987] Starting subtest: sysfs [381.559303] Starting dynamic subtest: gt0 [387.129776] Dynamic subtest gt0: SUCCESS (5.572s) [387.141707] Starting dynamic subtest: gt1 [428.905398] Dynamic subtest gt1: SUCCESS (41.770s) [428.907965] Subtest sysfs: SUCCESS (47.345s) [428.961186] [058/131] (590s left) kms_plane_scaling (plane-downscale-factor-0-75-with-rotation) [429.071876] Starting subtest: plane-downscale-factor-0-75-with-rotation [429.074192] Starting dynamic subtest: pipe-A [429.303955] Dynamic subtest pipe-A: SUCCESS (0.232s) [429.313116] Starting dynamic subtest: pipe-B [430.545325] Dynamic subtest pipe-B: SUCCESS (1.239s) [430.553807] Starting dynamic subtest: pipe-C [431.873408] Dynamic subtest pipe-C: SUCCESS (1.328s) [431.881478] Starting dynamic subtest: pipe-D [433.213822] Dynamic subtest pipe-D: SUCCESS (1.340s) [433.216038] Subtest plane-downscale-factor-0-75-with-rotation: SUCCESS (4.142s) [434.363625] [059/131] (585s left) kms_plane_scaling (planes-downscale-factor-0-25-upscale-20x20) [434.458142] Starting subtest: planes-downscale-factor-0-25-upscale-20x20 [434.460482] Starting dynamic subtest: pipe-A [434.475758] Dynamic subtest pipe-A: SKIP (0.011s) [434.486324] Starting dynamic subtest: pipe-B [434.499247] Dynamic subtest pipe-B: SKIP (0.021s) [434.507594] Starting dynamic subtest: pipe-C [434.520498] Dynamic subtest pipe-C: SKIP (0.021s) [434.528398] Starting dynamic subtest: pipe-D [434.540702] Dynamic subtest pipe-D: SKIP (0.021s) [434.545050] Subtest planes-downscale-factor-0-25-upscale-20x20: SKIP (0.076s) [434.622402] [060/131] (585s left) syncobj_timeline (etime-multi-wait-all-for-submit-submitted) [434.689297] Starting subtest: etime-multi-wait-all-for-submit-submitted [434.797993] Subtest etime-multi-wait-all-for-submit-submitted: SUCCESS (0.106s) [434.853063] [061/131] (584s left) api_intel_bb (object-noreloc-keep-cache-simple) [434.902175] Starting subtest: object-noreloc-keep-cache-simple [434.906127] Subtest object-noreloc-keep-cache-simple: SUCCESS (0.006s) [435.019123] [062/131] (584s left) gem_pxp (verify-pxp-stale-buf-optout-execution) [436.131211] Starting subtest: verify-pxp-stale-buf-optout-execution [436.188305] Subtest verify-pxp-stale-buf-optout-execution: SUCCESS (0.056s) [436.329918] [063/131] (583s left) fbdev (unaligned-write) [436.377476] Starting subtest: unaligned-write [436.564050] Subtest unaligned-write: SUCCESS (0.184s) [436.608769] [064/131] (583s left) kms_flip (bo-too-big-interruptible) [436.719178] Starting subtest: bo-too-big-interruptible [436.721515] Starting dynamic subtest: A-eDP1 [438.028946] Dynamic subtest A-eDP1: SUCCESS (1.308s) [438.038274] Starting dynamic subtest: B-eDP1 [439.255985] Dynamic subtest B-eDP1: SUCCESS (1.226s) [439.266353] Starting dynamic subtest: C-eDP1 [440.508123] Dynamic subtest C-eDP1: SUCCESS (1.252s) [440.519201] Starting dynamic subtest: D-eDP1 [441.822548] Dynamic subtest D-eDP1: SUCCESS (1.313s) [441.825051] Subtest bo-too-big-interruptible: SUCCESS (5.106s) [442.993998] [065/131] (576s left) gem_partial_pwrite_pread (write-display) [443.044744] Subtest write-display: SKIP (0.000s) [443.100250] [066/131] (576s left) sysfs_heartbeat_interval (idempotent) [443.158569] Starting subtest: idempotent [443.160955] Starting dynamic subtest: vecs0 [443.163282] Dynamic subtest vecs0: SUCCESS (0.001s) [443.174069] Starting dynamic subtest: ccs0 [443.176188] Dynamic subtest ccs0: SUCCESS (0.001s) [443.184061] Starting dynamic subtest: vcs0 [443.185922] Dynamic subtest vcs0: SUCCESS (0.000s) [443.193330] Starting dynamic subtest: bcs0 [443.195253] Dynamic subtest bcs0: SUCCESS (0.001s) [443.203076] Starting dynamic subtest: rcs0 [443.204963] Dynamic subtest rcs0: SUCCESS (0.000s) [443.212371] Starting dynamic subtest: vcs1 [443.214267] Dynamic subtest vcs1: SUCCESS (0.000s) [443.216147] Subtest idempotent: SUCCESS (0.007s) [443.260938] [067/131] (576s left) prime_mmap (test_userptr) [443.310067] Starting subtest: test_userptr [443.311942] Starting dynamic subtest: test_userptr-smem [443.313825] Dynamic subtest test_userptr-smem: SUCCESS (0.000s) [443.315696] Subtest test_userptr: SUCCESS (0.001s) [443.393183] [068/131] (576s left) gen3_render_tiledy_blits [443.486120] [069/131] (576s left) kms_psr (psr2-sprite-plane-move) [443.596268] Starting subtest: psr2-sprite-plane-move [443.598645] Starting dynamic subtest: eDP-1 [445.321856] Dynamic subtest eDP-1: SUCCESS (1.724s) [445.324266] Subtest psr2-sprite-plane-move: SUCCESS (1.724s) [446.139628] [070/131] (573s left) kms_sequence (queue-busy) [446.241141] Starting subtest: queue-busy [446.243487] Starting dynamic subtest: pipe-A-eDP-1 [448.153187] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.910s) [448.162652] Starting dynamic subtest: pipe-B-eDP-1 [450.743348] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.589s) [450.753053] Starting dynamic subtest: pipe-C-eDP-1 [453.355068] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.610s) [453.364285] Starting dynamic subtest: pipe-D-eDP-1 [455.886083] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.530s) [455.888370] Subtest queue-busy: SUCCESS (9.644s) [456.652399] [071/131] (563s left) prime_mmap_coherency (ioctl-errors) [456.723982] Starting subtest: ioctl-errors [473.649200] Subtest ioctl-errors: SUCCESS (16.925s) [473.842205] [072/131] (546s left) perf (invalid-oa-exponent) [474.023360] Starting subtest: invalid-oa-exponent [474.034305] Subtest invalid-oa-exponent: SUCCESS (0.012s) [474.067331] [073/131] (545s left) kms_psr (pr-primary-render) [474.167180] Starting subtest: pr-primary-render [474.171590] Subtest pr-primary-render: SKIP (0.000s) [474.223931] [074/131] (545s left) gem_exec_params (sol-reset-invalid) [474.288572] Starting subtest: sol-reset-invalid [474.293947] Subtest sol-reset-invalid: SUCCESS (0.003s) [476.020156] [075/131] (544s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-exceed-fully-sf) [481.020470] Starting subtest: fbc-pr-cursor-plane-move-continuous-exceed-fully-sf [481.025394] Subtest fbc-pr-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.003s) [481.867166] [076/131] (538s left) i915_module_load (resize-bar) [481.912452] Starting subtest: resize-bar [481.919313] Subtest resize-bar: SKIP (0.005s) [481.941180] [077/131] (538s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt) [482.055562] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt [482.060048] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [482.147293] [078/131] (537s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu) [482.248643] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu [482.253092] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s) [482.341397] [079/131] (537s left) kms_async_flips (test-cursor) [482.447260] Starting subtest: test-cursor [482.451603] Subtest test-cursor: SKIP (0.000s) [483.597535] [080/131] (536s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-wc) [483.709777] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-wc [483.714240] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s) [483.800193] [081/131] (536s left) kms_ccs (bad-pixel-format-4-tiled-mtl-rc-ccs) [483.910228] Starting subtest: bad-pixel-format-4-tiled-mtl-rc-ccs [483.912445] Starting dynamic subtest: pipe-A-eDP-1 [483.932848] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s) [483.942743] Starting dynamic subtest: pipe-B-eDP-1 [483.962241] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [483.970440] Starting dynamic subtest: pipe-C-eDP-1 [483.989302] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [483.997314] Starting dynamic subtest: pipe-D-eDP-1 [484.016801] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [484.018991] Subtest bad-pixel-format-4-tiled-mtl-rc-ccs: SUCCESS (0.005s) [486.046082] [082/131] (534s left) gem_ctx_persistence (heartbeat-hostile) [486.106411] Starting subtest: heartbeat-hostile [486.111091] Subtest heartbeat-hostile: SKIP (0.000s) [486.201424] [083/131] (534s left) kms_draw_crc (draw-method-blt) [486.304994] Starting subtest: draw-method-blt [486.307220] Starting dynamic subtest: xrgb8888-untiled [486.503857] Dynamic subtest xrgb8888-untiled: SUCCESS (0.201s) [486.516880] Starting dynamic subtest: rgb565-untiled [486.692673] Dynamic subtest rgb565-untiled: SUCCESS (0.188s) [486.701551] Starting dynamic subtest: xrgb2101010-untiled [486.870462] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.177s) [486.879091] Starting dynamic subtest: xrgb8888-xtiled [486.970312] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.099s) [486.978765] Starting dynamic subtest: rgb565-xtiled [487.070041] Dynamic subtest rgb565-xtiled: SUCCESS (0.100s) [487.078256] Starting dynamic subtest: xrgb2101010-xtiled [487.159023] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.089s) [487.167068] Starting dynamic subtest: xrgb8888-4tiled [487.258890] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.099s) [487.267343] Starting dynamic subtest: rgb565-4tiled [487.359032] Dynamic subtest rgb565-4tiled: SUCCESS (0.099s) [487.367243] Starting dynamic subtest: xrgb2101010-4tiled [487.459086] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.099s) [487.461089] Subtest draw-method-blt: SUCCESS (1.157s) [487.588753] [084/131] (532s left) kms_flip (2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible) [487.698907] Starting subtest: 2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible [487.711837] Subtest 2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible: SKIP (0.011s) [487.768654] [085/131] (532s left) device_reset (unbind-reset-rebind) [487.819618] Starting subtest: unbind-reset-rebind [492.474860] Subtest unbind-reset-rebind: SUCCESS (4.631s) [492.497431] [086/131] (527s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render) [492.615314] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render [497.682270] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (5.069s) [497.788153] [087/131] (522s left) debugfs_test (read_all_entries_display_off) [497.887097] Starting subtest: read_all_entries_display_off [498.916072] Subtest read_all_entries_display_off: SUCCESS (1.029s) [499.208815] [088/131] (521s left) gem_exec_schedule (preempt) [499.295262] Starting subtest: preempt [499.297490] Starting dynamic subtest: rcs0 [499.308290] Dynamic subtest rcs0: SUCCESS (0.020s) [499.317791] Starting dynamic subtest: bcs0 [499.330555] Dynamic subtest bcs0: SUCCESS (0.022s) [499.339342] Starting dynamic subtest: vcs0 [499.349440] Dynamic subtest vcs0: SUCCESS (0.018s) [499.358317] Starting dynamic subtest: vcs1 [499.367846] Dynamic subtest vcs1: SUCCESS (0.017s) [499.376695] Starting dynamic subtest: vecs0 [499.384082] Dynamic subtest vecs0: SUCCESS (0.016s) [499.398560] Starting dynamic subtest: ccs0 [499.403445] Dynamic subtest ccs0: SUCCESS (0.017s) [499.405560] Subtest preempt: SUCCESS (0.113s) [500.994894] [089/131] (519s left) kms_addfb_basic (invalid-set-prop) [501.059731] Starting subtest: invalid-set-prop [501.062078] Subtest invalid-set-prop: SUCCESS (0.000s) [501.197663] [090/131] (519s left) gem_mmap_gtt (cpuset-basic-small-copy-xy) [501.261930] Subtest cpuset-basic-small-copy-XY: SKIP (0.000s) [501.305112] [091/131] (519s left) gem_mmap_gtt (fault-concurrent) [501.367037] Subtest fault-concurrent: SKIP (0.000s) [501.412462] [092/131] (519s left) kms_addfb_basic (unused-pitches) [501.464112] Starting subtest: unused-pitches [501.466083] Subtest unused-pitches: SUCCESS (0.000s) [501.588984] [093/131] (518s left) kms_atomic_transition (modeset-transition-fencing) [501.690089] Starting subtest: modeset-transition-fencing [501.691929] Starting dynamic subtest: 1x-outputs [512.136324] Dynamic subtest 1x-outputs: SUCCESS (10.447s) [512.403468] Subtest modeset-transition-fencing: SUCCESS (10.712s) [513.243264] [094/131] (507s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc) [513.349595] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc [513.354073] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s) [513.431082] [095/131] (507s left) kms_frontbuffer_tracking (fbcpsr-tiling-linear) [513.528711] Starting subtest: fbcpsr-tiling-linear [517.776870] Subtest fbcpsr-tiling-linear: SUCCESS (4.251s) [517.904468] [096/131] (502s left) api_intel_bb (blit-reloc-keep-cache) [517.967550] Starting subtest: blit-reloc-keep-cache [517.971864] Subtest blit-reloc-keep-cache: SKIP (0.000s) [518.086175] [097/131] (502s left) kms_frontbuffer_tracking (fbc-rgb565-draw-render) [518.196411] Starting subtest: fbc-rgb565-draw-render [521.414062] Subtest fbc-rgb565-draw-render: SUCCESS (3.221s) [521.553470] [098/131] (498s left) prime_vgem (coherency-gtt) [521.632267] Starting subtest: coherency-gtt [521.636200] Subtest coherency-gtt: SKIP (0.000s) [521.732582] [099/131] (498s left) kms_cursor_edge_walk (256x256-right-edge) [521.830707] Starting subtest: 256x256-right-edge [521.832569] Starting dynamic subtest: pipe-A-eDP-1 [525.292458] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.460s) [525.302294] Starting dynamic subtest: pipe-D-eDP-1 [528.423037] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.128s) [528.425443] Subtest 256x256-right-edge: SUCCESS (6.591s) [529.201923] [100/131] (491s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-plflip-blt) [529.317810] Starting subtest: fbc-2p-primscrn-shrfb-plflip-blt [529.322215] Subtest fbc-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s) [529.386998] [101/131] (491s left) syncobj_timeline (multi-wait-for-submit-signaled) [529.449827] Starting subtest: multi-wait-for-submit-signaled [529.452275] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s) [529.541583] [102/131] (491s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-mmap-wc) [529.642401] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-mmap-wc [533.827413] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (4.187s) [533.931878] [103/131] (486s left) kms_psr2_sf (pr-primary-plane-update-sf-dmg-area) [538.799575] Starting subtest: pr-primary-plane-update-sf-dmg-area [538.804232] Subtest pr-primary-plane-update-sf-dmg-area: SKIP (0.002s) [539.642144] [104/131] (481s left) kms_plane_alpha_blend (alpha-7efc) [539.747262] Starting subtest: alpha-7efc [540.012176] Starting dynamic subtest: pipe-A-eDP-1 [540.589610] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.573s) [540.610735] Starting dynamic subtest: pipe-D-eDP-1 [541.864512] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.261s) [541.866923] Subtest alpha-7efc: SUCCESS (2.115s) [542.701550] [105/131] (477s left) kms_chamelium_frames (dp-crc-multiple) [543.086076] Subtest dp-crc-multiple: SKIP (0.000s) [543.903554] [106/131] (476s left) gem_spin_batch (legacy) [543.970810] Starting subtest: legacy [543.973250] Starting dynamic subtest: default [547.210935] Dynamic subtest default: SUCCESS (3.235s) [547.222224] Starting dynamic subtest: render [550.444430] Dynamic subtest render: SUCCESS (3.230s) [550.453659] Starting dynamic subtest: bsd [553.680905] Dynamic subtest bsd: SUCCESS (3.233s) [553.690297] Starting dynamic subtest: bsd1 [556.910447] Dynamic subtest bsd1: SUCCESS (3.227s) [556.922204] Starting dynamic subtest: bsd2 [560.143936] Dynamic subtest bsd2: SUCCESS (3.232s) [560.154563] Starting dynamic subtest: blt [563.379728] Dynamic subtest blt: SUCCESS (3.233s) [563.387985] Starting dynamic subtest: vebox [566.611523] Dynamic subtest vebox: SUCCESS (3.229s) [566.613946] Subtest legacy: SUCCESS (22.637s) [567.053037] [107/131] (453s left) gem_eio (in-flight-suspend) [567.257425] Starting subtest: in-flight-suspend [609.682494] Subtest in-flight-suspend: SUCCESS (13.589s) [609.806853] [108/131] (439s left) gem_mmap_gtt (big-bo-tiledy) [609.869103] Subtest big-bo-tiledY: SKIP (0.000s) [609.913869] [109/131] (439s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt) [610.015149] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt [610.019415] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [610.099851] [110/131] (439s left) gem_exec_schedule (timeslicing) [610.176603] Starting subtest: timeslicing [610.178498] Starting dynamic subtest: rcs0 [610.187854] Dynamic subtest rcs0: SUCCESS (0.021s) [610.197552] Starting dynamic subtest: bcs0 [610.210356] Dynamic subtest bcs0: SUCCESS (0.021s) [610.219768] Starting dynamic subtest: vcs0 [610.232124] Dynamic subtest vcs0: SUCCESS (0.020s) [610.241528] Starting dynamic subtest: vcs1 [610.253305] Dynamic subtest vcs1: SUCCESS (0.020s) [610.262732] Starting dynamic subtest: vecs0 [610.274058] Dynamic subtest vecs0: SUCCESS (0.020s) [610.289217] Starting dynamic subtest: ccs0 [610.297736] Dynamic subtest ccs0: SUCCESS (0.022s) [610.300151] Subtest timeslicing: SUCCESS (0.129s) [611.810617] [111/131] (437s left) kms_atomic_interruptible (atomic-setmode) [611.913649] Starting subtest: atomic-setmode [611.915831] Starting dynamic subtest: pipe-A-eDP-1 [618.800851] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.800s) [618.803227] Subtest atomic-setmode: SUCCESS (6.801s) [619.654766] [112/131] (430s left) gem_pwrite_snooped [619.766698] [113/131] (430s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling) [619.863717] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling [619.865965] Starting dynamic subtest: pipe-A-default-mode [620.154054] Dynamic subtest pipe-A-default-mode: SKIP (0.285s) [620.158937] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling: SKIP (0.286s) [620.986302] [114/131] (428s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-64bpp-4tile-downscaling) [621.093805] Starting subtest: flip-32bpp-4tile-to-64bpp-4tile-downscaling [621.096197] Starting dynamic subtest: pipe-A-default-mode [622.262399] Dynamic subtest pipe-A-default-mode: SKIP (1.157s) [622.267147] Subtest flip-32bpp-4tile-to-64bpp-4tile-downscaling: SKIP (1.158s) [622.409692] [115/131] (427s left) gem_partial_pwrite_pread (reads-display) [622.475072] Subtest reads-display: SKIP (0.000s) [622.538029] [116/131] (427s left) gem_ctx_persistence (hostile) [622.591889] Starting subtest: hostile [624.174785] Subtest hostile: FAIL (1.530s) [624.248910] [117/131] (425s left) perf_pmu (all-busy-idle-check-all) [624.289022] Starting subtest: all-busy-idle-check-all [625.741357] Subtest all-busy-idle-check-all: SUCCESS (1.445s) [625.818224] [118/131] (424s left) gem_mmap_wc (bad-offset) [625.877982] Subtest bad-offset: SKIP (0.000s) [625.924726] [119/131] (424s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-move) [626.029580] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-move [626.033618] Subtest fbcpsr-2p-primscrn-cur-indfb-move: SKIP (0.000s) [626.112933] [120/131] (423s left) syncobj_timeline (single-wait-all-for-submit-available-submitted) [626.166500] Starting subtest: single-wait-all-for-submit-available-submitted [626.168597] Subtest single-wait-all-for-submit-available-submitted: SUCCESS (0.000s) [626.261110] [121/131] (423s left) kms_pm_rpm (dpms-mode-unset-lpsp) [627.988187] Starting subtest: dpms-mode-unset-lpsp [632.028340] Subtest dpms-mode-unset-lpsp: SUCCESS (4.033s) [632.375384] [122/131] (417s left) perf_pmu (interrupts-sync) [632.417223] Starting subtest: interrupts-sync [633.485793] Subtest interrupts-sync: SUCCESS (1.066s) [633.598728] [123/131] (416s left) gem_fenced_exec_thrash (no-spare-fences) [633.660000] Subtest no-spare-fences: SKIP (0.000s) [633.707224] [124/131] (416s left) kms_rotation_crc (primary-4-tiled-reflect-x-0) [633.807411] Starting subtest: primary-4-tiled-reflect-x-0 [640.826980] Subtest primary-4-tiled-reflect-x-0: SUCCESS (7.010s) [642.019114] [125/131] (408s left) gen9_exec_parse (bb-start-far) [642.089509] Subtest bb-start-far: SKIP (0.000s) [642.151275] [126/131] (407s left) kms_cursor_crc (cursor-random-128x128) [642.345940] Starting subtest: cursor-random-128x128 [642.350976] Starting dynamic subtest: pipe-A-eDP-1 [645.668515] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.318s) [645.695184] Starting dynamic subtest: pipe-D-eDP-1 [649.611020] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.923s) [649.613436] Subtest cursor-random-128x128: SUCCESS (7.262s) [650.470176] [127/131] (399s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-render) [650.580470] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-render [650.584597] Subtest psr-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s) [650.661517] [128/131] (399s left) kms_frontbuffer_tracking (psr-2p-pri-indfb-multidraw) [650.769900] Starting subtest: psr-2p-pri-indfb-multidraw [650.774341] Subtest psr-2p-pri-indfb-multidraw: SKIP (0.000s) [650.869092] [129/131] (399s left) kms_flip (2x-blocking-absolute-wf_vblank) [650.969674] Starting subtest: 2x-blocking-absolute-wf_vblank [650.980973] Subtest 2x-blocking-absolute-wf_vblank: SKIP (0.011s) [651.086039] [130/131] (399s left) gem_lmem_swapping (massive-random) [651.136571] Subtest massive-random: SKIP (0.000s) [651.159220] [131/131] (399s left) kms_hdr (bpc-switch-dpms) [651.258454] Starting subtest: bpc-switch-dpms [652.360480] Starting dynamic subtest: pipe-A-eDP-1 [656.759795] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.398s) [656.762035] Subtest bpc-switch-dpms: SUCCESS (5.499s) [656.861102] Closing watchdogs Done.