[57.932904] Initializing watchdogs [57.932951] /dev/watchdog0 [57.947181] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics] [57.951606] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [57.953637] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [57.955578] [001/132] (960s left) kms_psr (fbc-psr2-dpms) [58.062075] Starting subtest: fbc-psr2-dpms [58.062912] Starting dynamic subtest: eDP-1 [58.064956] Dynamic subtest eDP-1: SKIP (0.000s) [58.066852] Subtest fbc-psr2-dpms: SKIP (0.000s) [58.150086] [002/132] (960s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-pgflip-blt) [58.236894] Starting subtest: fbc-2p-primscrn-shrfb-pgflip-blt [58.238675] Subtest fbc-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s) [58.374398] [003/132] (960s left) perf_pmu (idle-no-semaphores) [58.410370] Starting subtest: idle-no-semaphores [58.411432] Starting dynamic subtest: rcs0 [58.985006] Dynamic subtest rcs0: SUCCESS (0.567s) [58.994031] Starting dynamic subtest: bcs0 [59.509893] Dynamic subtest bcs0: SUCCESS (0.522s) [59.519057] Starting dynamic subtest: vcs0 [60.029897] Dynamic subtest vcs0: SUCCESS (0.515s) [60.039043] Starting dynamic subtest: vcs1 [60.559974] Dynamic subtest vcs1: SUCCESS (0.525s) [60.569528] Starting dynamic subtest: vecs0 [61.078781] Dynamic subtest vecs0: SUCCESS (0.515s) [61.087904] Starting dynamic subtest: ccs0 [61.597518] Dynamic subtest ccs0: SUCCESS (0.515s) [61.598915] Subtest idle-no-semaphores: SUCCESS (3.165s) [61.711531] [004/132] (956s left) gem_spin_batch (legacy) [61.779376] Starting subtest: legacy [61.780462] Starting dynamic subtest: default [65.126794] Dynamic subtest default: SUCCESS (3.331s) [65.135345] Starting dynamic subtest: render [68.459775] Dynamic subtest render: SUCCESS (3.321s) [68.468184] Starting dynamic subtest: bsd [71.695857] Dynamic subtest bsd: SUCCESS (3.229s) [71.703791] Starting dynamic subtest: bsd1 [74.926997] Dynamic subtest bsd1: SUCCESS (3.228s) [74.935763] Starting dynamic subtest: bsd2 [78.165535] Dynamic subtest bsd2: SUCCESS (3.233s) [78.173883] Starting dynamic subtest: blt [81.401728] Dynamic subtest blt: SUCCESS (3.233s) [81.410925] Starting dynamic subtest: vebox [84.639268] Dynamic subtest vebox: SUCCESS (3.234s) [84.640497] Subtest legacy: SUCCESS (22.819s) [84.999637] [005/132] (933s left) kms_addfb_basic (unused-handle) [85.060322] Starting subtest: unused-handle [85.061438] Subtest unused-handle: SUCCESS (0.000s) [85.206436] [006/132] (933s left) kms_properties (plane-properties-legacy) [85.299084] Starting subtest: plane-properties-legacy [85.300475] Starting dynamic subtest: pipe-A-eDP-1 [85.879471] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.579s) [85.886337] Starting dynamic subtest: pipe-B-eDP-1 [87.114922] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.233s) [87.126671] Starting dynamic subtest: pipe-C-eDP-1 [88.346352] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.231s) [88.352544] Starting dynamic subtest: pipe-D-eDP-1 [89.581375] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.233s) [89.582349] Subtest plane-properties-legacy: SUCCESS (4.280s) [90.397328] [007/132] (928s left) i915_pm_freq_api (freq-reset-multiple) [90.457389] Starting subtest: freq-reset-multiple [90.458531] Starting dynamic subtest: gt0 [99.239092] Dynamic subtest gt0: SUCCESS (8.778s) [99.247079] Starting dynamic subtest: gt1 [106.772617] Dynamic subtest gt1: SUCCESS (7.529s) [106.774230] Subtest freq-reset-multiple: SUCCESS (16.308s) [106.869750] [008/132] (911s left) kms_cursor_crc (cursor-rapid-movement-64x64) [107.075070] Starting subtest: cursor-rapid-movement-64x64 [107.077078] Starting dynamic subtest: pipe-A-eDP-1 [107.646034] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.569s) [107.671592] Starting dynamic subtest: pipe-D-eDP-1 [108.887226] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.221s) [108.888150] Subtest cursor-rapid-movement-64x64: SUCCESS (1.813s) [109.767673] [009/132] (908s left) kms_atomic (plane-immutable-zpos) [109.844967] Starting subtest: plane-immutable-zpos [109.845956] Starting dynamic subtest: pipe-A-eDP-1 [110.470182] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.623s) [110.471212] Subtest plane-immutable-zpos: SUCCESS (0.624s) [111.306605] [010/132] (907s left) syncobj_timeline (single-wait-for-submit-signaled) [111.364048] Starting subtest: single-wait-for-submit-signaled [111.365009] Subtest single-wait-for-submit-signaled: SUCCESS (0.000s) [111.484313] [011/132] (907s left) kms_cursor_edge_walk (64x64-top-edge) [111.563387] Starting subtest: 64x64-top-edge [111.564406] Starting dynamic subtest: pipe-A-eDP-1 [115.062725] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.499s) [115.069059] Starting dynamic subtest: pipe-D-eDP-1 [118.195060] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.131s) [118.196043] Subtest 64x64-top-edge: SUCCESS (6.632s) [119.009520] [012/132] (899s left) kms_big_fb (y-tiled-64bpp-rotate-270) [119.113975] Starting subtest: y-tiled-64bpp-rotate-270 [119.115801] Subtest y-tiled-64bpp-rotate-270: SKIP (0.000s) [119.243365] [013/132] (899s left) gem_ctx_isolation (preservation-s3) [119.303074] Starting subtest: preservation-S3 [119.304184] Starting dynamic subtest: rcs0 [135.584699] Dynamic subtest rcs0: SUCCESS (5.399s) [135.599851] Starting dynamic subtest: bcs0 [152.572647] Dynamic subtest bcs0: SUCCESS (1.750s) [152.581205] Starting dynamic subtest: vcs0 [169.578159] Dynamic subtest vcs0: SUCCESS (2.915s) [169.585685] Starting dynamic subtest: vcs1 [187.579079] Dynamic subtest vcs1: SUCCESS (5.027s) [187.588180] Starting dynamic subtest: vecs0 [205.560639] Dynamic subtest vecs0: SUCCESS (5.047s) [205.567981] Starting dynamic subtest: ccs0 [223.566929] Dynamic subtest ccs0: SUCCESS (3.141s) [223.568459] Subtest preservation-S3: SUCCESS (23.282s) [229.848502] [014/132] (795s left) kms_flip (plain-flip-ts-check-interruptible) [229.940750] Starting subtest: plain-flip-ts-check-interruptible [229.942999] Starting dynamic subtest: A-eDP1 [250.654796] Dynamic subtest A-eDP1: SUCCESS (20.438s) [250.664879] Starting dynamic subtest: B-eDP1 [259.533405] Dynamic subtest B-eDP1: SUCCESS (8.860s) [259.542853] Starting dynamic subtest: C-eDP1 [268.368522] Dynamic subtest C-eDP1: SUCCESS (8.830s) [268.376960] Starting dynamic subtest: D-eDP1 [277.190703] Dynamic subtest D-eDP1: SUCCESS (8.819s) [277.193677] Subtest plain-flip-ts-check-interruptible: SUCCESS (46.955s) [278.391299] [015/132] (746s left) gem_partial_pwrite_pread (reads-display) [278.452746] Subtest reads-display: SKIP (0.000s) [278.525796] [016/132] (746s left) gen9_exec_parse (bb-oversize) [278.585912] Subtest bb-oversize: SKIP (0.000s) [278.652944] [017/132] (746s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-16bpp-yftile-downscaling) [278.738268] Starting subtest: flip-64bpp-yftile-to-16bpp-yftile-downscaling [278.739123] Starting dynamic subtest: pipe-A-default-mode [279.025142] Dynamic subtest pipe-A-default-mode: SKIP (0.285s) [279.026733] Subtest flip-64bpp-yftile-to-16bpp-yftile-downscaling: SKIP (0.287s) [279.918414] [018/132] (745s left) gem_fenced_exec_thrash (no-spare-fences) [279.971354] Subtest no-spare-fences: SKIP (0.000s) [280.030356] [019/132] (745s left) vgem_basic (bad-fence) [280.114853] Starting subtest: bad-fence [280.116020] Subtest bad-fence: SUCCESS (0.000s) [280.191956] [FACT vgem_basic (bad-fence)] new: kernel.kmod_is_loaded.vgem: true [280.194888] [020/132] (744s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-180) [280.290921] Starting subtest: linear-max-hw-stride-64bpp-rotate-180 [281.302767] Subtest linear-max-hw-stride-64bpp-rotate-180: SUCCESS (1.012s) [281.445981] [021/132] (743s left) gem_ctx_persistence (idempotent) [281.502996] Starting subtest: idempotent [281.504467] Subtest idempotent: SUCCESS (0.000s) [281.635369] [022/132] (743s left) syncobj_basic (bad-create-flags) [281.695948] Starting subtest: bad-create-flags [281.697258] Subtest bad-create-flags: SUCCESS (0.000s) [281.826714] [023/132] (743s left) kms_frontbuffer_tracking (fbcpsr-1p-pri-indfb-multidraw) [281.907195] Starting subtest: fbcpsr-1p-pri-indfb-multidraw [304.102241] Subtest fbcpsr-1p-pri-indfb-multidraw: SUCCESS (22.189s) [304.266088] [024/132] (720s left) kms_rotation_crc (primary-yf-tiled-reflect-x-0) [304.373491] Starting subtest: primary-yf-tiled-reflect-x-0 [304.433846] Subtest primary-yf-tiled-reflect-x-0: SKIP (0.059s) [304.550800] [025/132] (720s left) fbdev (pan) [304.589371] Starting subtest: pan [304.621484] Subtest pan: SUCCESS (0.034s) [304.708969] [026/132] (720s left) kms_addfb_basic (addfb25-y-tiled-small-legacy) [304.795242] Starting subtest: addfb25-y-tiled-small-legacy [304.796865] Subtest addfb25-y-tiled-small-legacy: SKIP (0.000s) [304.912519] [027/132] (720s left) kms_ccs (crc-primary-suspend-y-tiled-ccs) [304.993454] Starting subtest: crc-primary-suspend-y-tiled-ccs [304.994492] Starting dynamic subtest: pipe-A-eDP-1 [304.998192] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [305.007906] Starting dynamic subtest: pipe-B-eDP-1 [305.014530] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [305.027663] Starting dynamic subtest: pipe-C-eDP-1 [305.033624] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [305.041094] Starting dynamic subtest: pipe-D-eDP-1 [305.045699] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [305.047816] Subtest crc-primary-suspend-y-tiled-ccs: SKIP (0.005s) [307.223286] [028/132] (718s left) gem_mmap_gtt (basic-short) [307.278726] Subtest basic-short: SKIP (0.000s) [307.339868] [029/132] (718s left) kms_force_connector_basic (force-connector-state) [307.415118] Starting subtest: force-connector-state [308.019701] Subtest force-connector-state: SUCCESS (0.604s) [308.979726] [030/132] (716s left) syncobj_wait (invalid-reset-illegal-handle) [309.031447] Starting subtest: invalid-reset-illegal-handle [309.032326] Subtest invalid-reset-illegal-handle: SUCCESS (0.000s) [309.153302] [031/132] (716s left) kms_addfb_basic (too-wide) [309.247747] Starting subtest: too-wide [309.248951] Subtest too-wide: SUCCESS (0.000s) [309.355264] [032/132] (716s left) kms_chamelium_color (degamma) [309.434040] Subtest degamma: SKIP (0.000s) [309.475451] [033/132] (716s left) kms_flip_scaled_crc (flip-32bpp-linear-to-64bpp-linear-downscaling) [309.562720] Starting subtest: flip-32bpp-linear-to-64bpp-linear-downscaling [309.563961] Starting dynamic subtest: pipe-A-default-mode [310.769301] Dynamic subtest pipe-A-default-mode: SKIP (1.205s) [310.771184] Subtest flip-32bpp-linear-to-64bpp-linear-downscaling: SKIP (1.207s) [310.956235] [034/132] (714s left) gem_ctx_create (basic-files) [311.022714] Starting subtest: basic-files [313.132603] Subtest basic-files: SUCCESS (2.109s) [314.915800] [035/132] (710s left) gem_exec_fence (syncobj-timeline-invalid-wait) [315.517435] Starting subtest: syncobj-timeline-invalid-wait [315.522732] Subtest syncobj-timeline-invalid-wait: SUCCESS (0.007s) [317.010381] [036/132] (708s left) gem_mmap_offset (bad-object) [317.060875] Starting subtest: bad-object [317.062111] Subtest bad-object: SUCCESS (0.001s) [317.188436] [037/132] (708s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-onoff) [317.290122] Starting subtest: psr-2p-primscrn-spr-indfb-onoff [317.292645] Subtest psr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s) [317.406001] [038/132] (708s left) kms_frontbuffer_tracking (fbc-1p-indfb-fliptrack-mmap-gtt) [317.505591] Starting subtest: fbc-1p-indfb-fliptrack-mmap-gtt [317.507462] Subtest fbc-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s) [317.633558] [039/132] (708s left) kms_selftest (drm_format_helper) [317.674600] Starting subtest: drm_format_helper [317.682378] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8 [317.828496] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8: SUCCESS (0.146s) [317.837796] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332 [317.965616] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332: SUCCESS (0.134s) [317.974770] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565 [318.121009] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565: SUCCESS (0.154s) [318.129161] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555 [318.260435] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555: SUCCESS (0.139s) [318.268316] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555 [318.405854] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555: SUCCESS (0.145s) [318.416760] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551 [318.553880] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551: SUCCESS (0.147s) [318.562186] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888 [318.701093] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888: SUCCESS (0.144s) [318.709358] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888 [318.840708] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888: SUCCESS (0.138s) [318.848653] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888 [318.966477] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888: SUCCESS (0.126s) [318.980380] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010 [319.103553] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010: SUCCESS (0.135s) [319.111844] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010 [319.251514] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010: SUCCESS (0.146s) [319.259862] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_mono [319.382288] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_mono: SUCCESS (0.129s) [319.390130] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_swab [319.513444] Dynamic subtest drm_format_helper_test-drm_test_fb_swab: SUCCESS (0.129s) [319.525076] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888 [319.625822] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888: SUCCESS (0.113s) [319.638382] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888 [319.768362] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888: SUCCESS (0.140s) [319.777239] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_clip_offset [319.884245] Dynamic subtest drm_format_helper_test-drm_test_fb_clip_offset: SUCCESS (0.116s) [319.892156] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_memcpy [320.018563] Dynamic subtest drm_format_helper_test-drm_test_fb_memcpy: SUCCESS (0.133s) [320.019821] Subtest drm_format_helper: SUCCESS (2.343s) [320.204969] [040/132] (705s left) gem_exec_capture (capture-invisible) [320.274346] Starting subtest: capture-invisible [320.275731] Starting dynamic subtest: smem0 [320.278129] Dynamic subtest smem0: SKIP (0.000s) [320.280211] Subtest capture-invisible: SKIP (0.001s) [320.408959] [041/132] (705s left) kms_psr (pr-cursor-mmap-cpu) [320.498555] Starting subtest: pr-cursor-mmap-cpu [320.500447] Subtest pr-cursor-mmap-cpu: SKIP (0.000s) [320.590171] [042/132] (705s left) kms_cursor_crc (cursor-onscreen-64x64) [320.795458] Starting subtest: cursor-onscreen-64x64 [320.798743] Starting dynamic subtest: pipe-A-eDP-1 [322.916947] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.118s) [322.952906] Starting dynamic subtest: pipe-D-eDP-1 [325.675237] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.736s) [325.676125] Subtest cursor-onscreen-64x64: SUCCESS (4.878s) [326.570630] [043/132] (699s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0) [326.676472] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0 [327.699315] Subtest x-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (1.023s) [327.874392] [044/132] (697s left) prime_vgem (busy) [327.942115] Starting subtest: busy [327.943316] Starting dynamic subtest: rcs0 [328.017329] Dynamic subtest rcs0: SUCCESS (0.075s) [328.025547] Starting dynamic subtest: bcs0 [328.097573] Dynamic subtest bcs0: SUCCESS (0.079s) [328.105558] Starting dynamic subtest: vcs0 [328.149883] Dynamic subtest vcs0: SUCCESS (0.051s) [328.157884] Starting dynamic subtest: vcs1 [328.195423] Dynamic subtest vcs1: SUCCESS (0.044s) [328.203331] Starting dynamic subtest: vecs0 [328.240598] Dynamic subtest vecs0: SUCCESS (0.044s) [328.248651] Starting dynamic subtest: ccs0 [328.289886] Dynamic subtest ccs0: SUCCESS (0.048s) [328.291176] Subtest busy: SUCCESS (0.348s) [328.448301] [045/132] (697s left) i915_pm_rps (thresholds-idle) [328.505578] Starting subtest: thresholds-idle [328.508447] Subtest thresholds-idle: SKIP (0.001s) [328.633421] [046/132] (697s left) gem_mmap (basic) [328.676761] Subtest basic: SKIP (0.000s) [328.743749] [047/132] (697s left) gem_mmap_gtt (cpuset-big-copy) [328.801788] Subtest cpuset-big-copy: SKIP (0.000s) [328.859451] [048/132] (697s left) kms_big_fb (linear-16bpp-rotate-90) [328.960419] Starting subtest: linear-16bpp-rotate-90 [328.980725] Subtest linear-16bpp-rotate-90: SKIP (0.019s) [329.134415] [049/132] (696s left) i915_pm_rpm (gem-evict-pwrite) [330.967564] Starting subtest: gem-evict-pwrite [330.970026] Subtest gem-evict-pwrite: SKIP (0.000s) [331.471581] [050/132] (694s left) gem_pxp (verify-pxp-key-change-after-suspend-resume) [331.588782] Starting subtest: verify-pxp-key-change-after-suspend-resume [338.782893] Subtest verify-pxp-key-change-after-suspend-resume: SUCCESS (7.194s) [345.958394] [051/132] (687s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted) [346.017302] Starting subtest: etime-multi-wait-for-submit-unsubmitted [346.127122] Subtest etime-multi-wait-for-submit-unsubmitted: SUCCESS (0.108s) [346.225898] [052/132] (686s left) syncobj_basic (bad-destroy) [346.286659] Starting subtest: bad-destroy [346.287723] Subtest bad-destroy: SUCCESS (0.000s) [346.417284] [053/132] (686s left) kms_plane (planar-pixel-format-settings) [346.513634] Starting subtest: planar-pixel-format-settings [346.551978] Subtest planar-pixel-format-settings: SUCCESS (0.038s) [346.677167] [054/132] (686s left) kms_psr (psr2-cursor-plane-move) [346.767684] Starting subtest: psr2-cursor-plane-move [346.769116] Starting dynamic subtest: eDP-1 [348.479386] Dynamic subtest eDP-1: SUCCESS (1.712s) [348.480416] Subtest psr2-cursor-plane-move: SUCCESS (1.713s) [349.365140] [055/132] (683s left) kms_ccs (crc-sprite-planes-basic-4-tiled-lnl-ccs) [349.458535] Starting subtest: crc-sprite-planes-basic-4-tiled-lnl-ccs [349.461141] Subtest crc-sprite-planes-basic-4-tiled-lnl-ccs: SKIP (0.000s) [350.566995] [056/132] (682s left) kms_legacy_colorkey (basic) [350.662708] Starting subtest: basic [350.663650] Starting dynamic subtest: pipe-A [350.707975] Dynamic subtest pipe-A: SUCCESS (0.045s) [350.720027] Starting dynamic subtest: pipe-B [350.721513] Dynamic subtest pipe-B: SUCCESS (0.001s) [350.729648] Starting dynamic subtest: pipe-C [350.730945] Dynamic subtest pipe-C: SUCCESS (0.000s) [350.738916] Starting dynamic subtest: pipe-D [350.740384] Dynamic subtest pipe-D: SUCCESS (0.000s) [350.741595] Subtest basic: SUCCESS (0.052s) [350.793831] [057/132] (682s left) kms_atomic_interruptible (legacy-setmode) [350.894099] Starting subtest: legacy-setmode [350.895583] Starting dynamic subtest: pipe-A-eDP-1 [357.758587] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.863s) [357.759833] Subtest legacy-setmode: SUCCESS (6.864s) [358.569982] [058/132] (674s left) kms_flip (bo-too-big-interruptible) [358.665683] Starting subtest: bo-too-big-interruptible [358.668414] Starting dynamic subtest: A-eDP1 [359.961437] Dynamic subtest A-eDP1: SUCCESS (1.293s) [359.977885] Starting dynamic subtest: B-eDP1 [361.270816] Dynamic subtest B-eDP1: SUCCESS (1.306s) [361.280966] Starting dynamic subtest: C-eDP1 [362.570174] Dynamic subtest C-eDP1: SUCCESS (1.298s) [362.580452] Starting dynamic subtest: D-eDP1 [363.874743] Dynamic subtest D-eDP1: SUCCESS (1.302s) [363.877948] Subtest bo-too-big-interruptible: SUCCESS (5.211s) [365.063435] [059/132] (668s left) kms_plane_alpha_blend (constant-alpha-max) [365.146054] Starting subtest: constant-alpha-max [365.443596] Starting dynamic subtest: pipe-A-eDP-1 [366.386976] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.942s) [366.395596] Starting dynamic subtest: pipe-D-eDP-1 [368.051609] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.663s) [368.052833] Subtest constant-alpha-max: SUCCESS (2.906s) [368.867202] [060/132] (664s left) perf (polling-parameterized) [369.005657] Starting subtest: polling-parameterized [389.032034] Subtest polling-parameterized: SUCCESS (20.019s) [389.074441] [061/132] (644s left) kms_pm_rpm (modeset-pc8-residency-stress) [390.997282] Starting subtest: modeset-pc8-residency-stress [390.999304] Subtest modeset-pc8-residency-stress: SKIP (0.000s) [391.386957] [062/132] (642s left) gem_pwrite (basic-exhaustion) [391.440418] Subtest basic-exhaustion: SKIP (0.000s) [391.509169] [063/132] (642s left) kms_psr (fbc-pr-sprite-mmap-cpu) [391.598883] Starting subtest: fbc-pr-sprite-mmap-cpu [391.601829] Subtest fbc-pr-sprite-mmap-cpu: SKIP (0.000s) [391.701907] [064/132] (641s left) kms_chamelium_hpd (dp-hpd-enable-disable-mode) [392.085875] Subtest dp-hpd-enable-disable-mode: SKIP (0.000s) [392.912656] [065/132] (640s left) perf_pmu (all-busy-idle-check-all) [392.947910] Starting subtest: all-busy-idle-check-all [394.860203] Subtest all-busy-idle-check-all: SUCCESS (1.909s) [394.993074] [066/132] (638s left) drm_read (short-buffer-block) [395.147818] Starting subtest: short-buffer-block [395.149174] Subtest short-buffer-block: SUCCESS (0.000s) [395.313699] [067/132] (638s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip) [395.414085] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip [395.416004] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.000s) [395.536453] [068/132] (638s left) gem_create (create-ext-cpu-access-big) [395.724724] Starting subtest: create-ext-cpu-access-big [395.727417] Subtest create-ext-cpu-access-big: SKIP (0.001s) [395.823216] [069/132] (637s left) gem_eio (suspend) [396.042729] Starting subtest: suspend [408.304988] Subtest suspend: SUCCESS (12.260s) [416.492465] [070/132] (625s left) gem_exec_reloc (basic-active) [416.557647] Subtest basic-active: SKIP (0.000s) [416.631034] [071/132] (625s left) syncobj_timeline (invalid-single-wait-all-unsubmitted) [416.687073] Starting subtest: invalid-single-wait-all-unsubmitted [416.688362] Subtest invalid-single-wait-all-unsubmitted: SUCCESS (0.000s) [416.825998] [072/132] (625s left) dumb_buffer (invalid-bpp) [416.886551] Starting subtest: invalid-bpp [416.888011] Subtest invalid-bpp: SUCCESS (0.000s) [417.022387] [073/132] (624s left) prime_vgem (fence-write-hang) [417.099587] Subtest fence-write-hang: SKIP (0.000s) [417.235857] [074/132] (624s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-render) [417.350804] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-render [424.587535] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (7.234s) [424.729868] [075/132] (617s left) kms_color (gamma) [424.824486] Starting subtest: gamma [424.825273] Starting dynamic subtest: pipe-A-eDP-1 [425.523537] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.697s) [425.532468] Starting dynamic subtest: pipe-B-eDP-1 [426.912594] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.387s) [426.925701] Starting dynamic subtest: pipe-C-eDP-1 [428.284767] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.372s) [428.297409] Starting dynamic subtest: pipe-D-eDP-1 [429.667958] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.382s) [429.669406] Subtest gamma: SUCCESS (4.841s) [430.485196] [076/132] (611s left) kms_ccs (bad-rotation-90-y-tiled-gen12-mc-ccs) [430.568054] Starting subtest: bad-rotation-90-y-tiled-gen12-mc-ccs [430.569313] Starting dynamic subtest: pipe-A-eDP-1 [430.579995] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [430.588444] Starting dynamic subtest: pipe-B-eDP-1 [430.599247] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [430.608344] Starting dynamic subtest: pipe-C-eDP-1 [430.618914] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [430.627131] Starting dynamic subtest: pipe-D-eDP-1 [430.637932] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [430.639917] Subtest bad-rotation-90-y-tiled-gen12-mc-ccs: SKIP (0.005s) [432.871898] [077/132] (609s left) kms_ccs (crc-primary-basic-yf-tiled-ccs) [432.971549] Starting subtest: crc-primary-basic-yf-tiled-ccs [432.972605] Starting dynamic subtest: pipe-A-eDP-1 [432.981272] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [432.991537] Starting dynamic subtest: pipe-B-eDP-1 [433.000401] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [433.009382] Starting dynamic subtest: pipe-C-eDP-1 [433.019269] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [433.027091] Starting dynamic subtest: pipe-D-eDP-1 [433.036523] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [433.038445] Subtest crc-primary-basic-yf-tiled-ccs: SKIP (0.006s) [435.271045] [078/132] (606s left) gem_exec_whisper (basic-sync-all) [435.336114] Starting subtest: basic-sync-all [443.165832] Subtest basic-sync-all: SUCCESS (7.826s) [443.368940] [079/132] (598s left) kms_invalid_mode (bad-hsync-start) [443.455921] Starting subtest: bad-hsync-start [443.456787] Starting dynamic subtest: pipe-A-eDP-1 [443.741686] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.284s) [443.751893] Starting dynamic subtest: pipe-B-eDP-1 [443.753212] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [443.761868] Starting dynamic subtest: pipe-C-eDP-1 [443.763196] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s) [443.771409] Starting dynamic subtest: pipe-D-eDP-1 [443.772827] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [443.773831] Subtest bad-hsync-start: SUCCESS (0.293s) [444.574796] [080/132] (597s left) kms_big_fb (yf-tiled-8bpp-rotate-90) [444.676395] Starting subtest: yf-tiled-8bpp-rotate-90 [444.678478] Subtest yf-tiled-8bpp-rotate-90: SKIP (0.000s) [444.791462] [081/132] (597s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-plflip-blt) [444.889628] Starting subtest: fbc-2p-scndscrn-indfb-plflip-blt [444.891417] Subtest fbc-2p-scndscrn-indfb-plflip-blt: SKIP (0.000s) [445.016191] [082/132] (597s left) syncobj_wait (single-wait-all-for-submit-unsubmitted) [445.068730] Starting subtest: single-wait-all-for-submit-unsubmitted [445.175478] Subtest single-wait-all-for-submit-unsubmitted: SUCCESS (0.104s) [445.270137] [083/132] (596s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-move) [445.364379] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-move [445.366444] Subtest fbcpsr-2p-scndscrn-cur-indfb-move: SKIP (0.000s) [445.495494] [084/132] (596s left) prime_mmap (test_forked) [445.550546] Starting subtest: test_forked [445.551773] Starting dynamic subtest: test_forked-smem [445.588982] Dynamic subtest test_forked-smem: SUCCESS (0.039s) [445.590805] Subtest test_forked: SUCCESS (0.041s) [445.702863] [085/132] (596s left) gem_exec_balancer (parallel) [445.959133] Starting subtest: parallel [446.870428] Subtest parallel: SUCCESS (0.911s) [447.976881] [086/132] (594s left) gem_exec_flush (basic-batch-kernel-default-uc) [448.042480] Starting subtest: basic-batch-kernel-default-uc [455.073544] Subtest basic-batch-kernel-default-uc: SUCCESS (7.028s) [455.285250] [087/132] (587s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-wc) [455.386911] Starting subtest: fbcpsr-rgb565-draw-mmap-wc [462.130812] Subtest fbcpsr-rgb565-draw-mmap-wc: SUCCESS (6.742s) [462.284065] [088/132] (580s left) kms_chamelium_frames (dp-crc-multiple) [462.656314] Subtest dp-crc-multiple: SKIP (0.000s) [463.441011] [089/132] (579s left) kms_psr2_sf (psr2-primary-plane-update-sf-dmg-area) [468.442624] Starting subtest: psr2-primary-plane-update-sf-dmg-area [468.443915] Starting dynamic subtest: pipe-A-eDP-1 [474.928279] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.483s) [474.938169] Starting dynamic subtest: pipe-B-eDP-1 [481.428361] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.494s) [481.429491] Subtest psr2-primary-plane-update-sf-dmg-area: SUCCESS (12.981s) [482.287958] [090/132] (560s left) kms_atomic_transition (plane-all-transition-nonblocking) [482.383485] Starting subtest: plane-all-transition-nonblocking [482.384704] Starting dynamic subtest: pipe-A-eDP-1 [484.876774] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.494s) [485.202094] Starting dynamic subtest: pipe-B-eDP-1 [488.478987] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.284s) [488.780660] Subtest plane-all-transition-nonblocking: SUCCESS (6.397s) [489.602211] [091/132] (552s left) gem_ctx_shared (q-independent) [489.665935] Starting subtest: Q-independent [489.667590] Starting dynamic subtest: rcs0 [489.733817] Dynamic subtest rcs0: SUCCESS (0.067s) [489.745542] Starting dynamic subtest: vcs0 [489.777245] Dynamic subtest vcs0: SUCCESS (0.043s) [489.787353] Starting dynamic subtest: vcs1 [489.820015] Dynamic subtest vcs1: SUCCESS (0.042s) [489.830969] Starting dynamic subtest: vecs0 [489.859677] Dynamic subtest vecs0: SUCCESS (0.039s) [489.868938] Starting dynamic subtest: ccs0 [489.910121] Dynamic subtest ccs0: SUCCESS (0.050s) [489.911723] Subtest Q-independent: SUCCESS (0.245s) [491.057440] [092/132] (551s left) kms_atomic_transition (plane-primary-toggle-with-vblank-wait) [491.151369] Starting subtest: plane-primary-toggle-with-vblank-wait [491.152438] Starting dynamic subtest: pipe-A-eDP-1 [491.325349] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.174s) [491.639958] Starting dynamic subtest: pipe-B-eDP-1 [492.534978] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.902s) [492.835644] Subtest plane-primary-toggle-with-vblank-wait: SUCCESS (1.683s) [493.685556] [093/132] (548s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-pwrite) [493.781508] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-pwrite [498.142764] Subtest fbc-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (4.360s) [499.298899] [094/132] (543s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset) [499.378328] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset [499.379364] Starting dynamic subtest: A-eDP1 [503.010208] Dynamic subtest A-eDP1: SUCCESS (3.630s) [503.019977] Starting dynamic subtest: B-eDP1 [506.287525] Dynamic subtest B-eDP1: SUCCESS (3.273s) [506.296667] Starting dynamic subtest: C-eDP1 [509.614331] Dynamic subtest C-eDP1: SUCCESS (3.325s) [509.622853] Starting dynamic subtest: D-eDP1 [512.903812] Dynamic subtest D-eDP1: SUCCESS (3.286s) [512.905126] Subtest single-buffer-flip-vs-dpms-off-vs-modeset: SUCCESS (13.523s) [513.788755] [095/132] (528s left) syncobj_basic (bad-pad-fd-to-handle) [513.852537] Starting subtest: bad-pad-fd-to-handle [513.853982] Subtest bad-pad-fd-to-handle: SUCCESS (0.000s) [513.971884] [096/132] (528s left) kms_psr (psr-sprite-plane-onoff) [514.070127] Starting subtest: psr-sprite-plane-onoff [514.071415] Starting dynamic subtest: eDP-1 [515.884371] Dynamic subtest eDP-1: SUCCESS (1.813s) [515.885257] Subtest psr-sprite-plane-onoff: SUCCESS (1.814s) [516.702286] [097/132] (526s left) syncobj_timeline (etime-single-wait-for-submit-available-unsubmitted) [516.760813] Starting subtest: etime-single-wait-for-submit-available-unsubmitted [516.861873] Subtest etime-single-wait-for-submit-available-unsubmitted: SUCCESS (0.101s) [516.958254] [098/132] (525s left) gem_exec_schedule (u-submit-early-slice) [517.027752] Starting subtest: u-submit-early-slice [517.028794] Starting dynamic subtest: rcs0 [517.076520] Dynamic subtest rcs0: SUCCESS (0.049s) [517.086741] Starting dynamic subtest: bcs0 [517.119791] Dynamic subtest bcs0: SUCCESS (0.042s) [517.135582] Starting dynamic subtest: vcs0 [517.167128] Dynamic subtest vcs0: SUCCESS (0.047s) [517.176310] Starting dynamic subtest: vcs1 [517.212102] Dynamic subtest vcs1: SUCCESS (0.044s) [517.220861] Starting dynamic subtest: vecs0 [517.256378] Dynamic subtest vecs0: SUCCESS (0.043s) [517.267924] Starting dynamic subtest: ccs0 [517.303339] Dynamic subtest ccs0: SUCCESS (0.046s) [517.304283] Subtest u-submit-early-slice: SUCCESS (0.277s) [519.041358] [099/132] (523s left) kms_cursor_legacy (cursora-vs-flipb-varying-size) [519.154619] Starting subtest: cursorA-vs-flipB-varying-size [519.156434] Subtest cursorA-vs-flipB-varying-size: SKIP (0.001s) [519.316784] [100/132] (523s left) kms_properties (connector-properties-atomic) [519.400642] Starting subtest: connector-properties-atomic [519.401495] Starting dynamic subtest: pipe-A-eDP-1 [527.543920] Dynamic subtest pipe-A-eDP-1: SUCCESS (8.138s) [527.553924] Starting dynamic subtest: pipe-None-DP-1 [527.556529] Dynamic subtest pipe-None-DP-1: SUCCESS (0.001s) [527.565039] Starting dynamic subtest: pipe-None-HDMI-A-1 [527.567550] Dynamic subtest pipe-None-HDMI-A-1: SUCCESS (0.001s) [527.576101] Starting dynamic subtest: pipe-None-DP-2 [527.578633] Dynamic subtest pipe-None-DP-2: SUCCESS (0.001s) [527.587274] Starting dynamic subtest: pipe-None-HDMI-A-2 [527.589525] Dynamic subtest pipe-None-HDMI-A-2: SUCCESS (0.001s) [527.598390] Starting dynamic subtest: pipe-None-DP-3 [527.601126] Dynamic subtest pipe-None-DP-3: SUCCESS (0.001s) [527.611274] Starting dynamic subtest: pipe-None-DP-4 [527.613492] Dynamic subtest pipe-None-DP-4: SUCCESS (0.001s) [527.614436] Subtest connector-properties-atomic: SUCCESS (8.149s) [528.398112] [101/132] (514s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite) [528.495432] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite [528.497740] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s) [528.628958] [102/132] (514s left) kms_cursor_crc (cursor-alpha-transparent) [528.719374] Starting subtest: cursor-alpha-transparent [528.720380] Starting dynamic subtest: pipe-A-eDP-1 [529.327669] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.607s) [529.336301] Starting dynamic subtest: pipe-D-eDP-1 [530.619058] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.291s) [530.620297] Subtest cursor-alpha-transparent: SUCCESS (1.901s) [531.491735] [103/132] (511s left) gem_exec_schedule (pi-ringfull) [531.671987] Starting subtest: pi-ringfull [531.673622] Starting dynamic subtest: rcs0 [531.706158] Dynamic subtest rcs0: SUCCESS (0.035s) [531.716143] Starting dynamic subtest: bcs0 [531.740010] Dynamic subtest bcs0: SUCCESS (0.033s) [531.750718] Starting dynamic subtest: vcs0 [531.773093] Dynamic subtest vcs0: SUCCESS (0.032s) [531.783837] Starting dynamic subtest: vcs1 [531.804338] Dynamic subtest vcs1: SUCCESS (0.030s) [531.813120] Starting dynamic subtest: vecs0 [531.834627] Dynamic subtest vecs0: SUCCESS (0.029s) [531.843459] Starting dynamic subtest: ccs0 [531.863337] Dynamic subtest ccs0: SUCCESS (0.028s) [531.864708] Subtest pi-ringfull: SUCCESS (0.193s) [532.107171] [104/132] (510s left) kms_flip (2x-flip-vs-fences-interruptible) [532.206170] Starting subtest: 2x-flip-vs-fences-interruptible [532.208962] Subtest 2x-flip-vs-fences-interruptible: SKIP (0.000s) [532.350459] [105/132] (510s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-blt) [532.455097] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-blt [532.457048] Subtest psr-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s) [532.580151] [106/132] (510s left) gem_render_copy (yf-tiled-ccs-to-y-tiled) [532.647646] Starting subtest: yf-tiled-ccs-to-y-tiled [532.649856] Subtest yf-tiled-ccs-to-y-tiled: SKIP (0.000s) [532.848813] [107/132] (510s left) kms_plane_scaling (plane-upscale-20x20-with-modifiers) [532.941506] Starting subtest: plane-upscale-20x20-with-modifiers [532.942780] Starting dynamic subtest: pipe-A [533.278422] Dynamic subtest pipe-A: SUCCESS (0.338s) [533.287132] Starting dynamic subtest: pipe-B [534.642096] Dynamic subtest pipe-B: SUCCESS (1.363s) [534.650858] Starting dynamic subtest: pipe-C [536.040486] Dynamic subtest pipe-C: SUCCESS (1.397s) [536.049255] Starting dynamic subtest: pipe-D [537.436254] Dynamic subtest pipe-D: SUCCESS (1.395s) [537.437097] Subtest plane-upscale-20x20-with-modifiers: SUCCESS (4.495s) [538.597879] [108/132] (504s left) kms_cursor_legacy (basic-flip-after-cursor-atomic) [538.718697] Starting subtest: basic-flip-after-cursor-atomic [539.644396] Subtest basic-flip-after-cursor-atomic: SUCCESS (0.925s) [540.505993] [109/132] (502s left) kms_vrr (flipline) [540.601057] Starting subtest: flipline [540.604358] Subtest flipline: SKIP (0.000s) [540.696010] [110/132] (502s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-cpu) [540.786281] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-cpu [540.788247] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s) [540.915585] [111/132] (502s left) kms_big_fb (4-tiled-8bpp-rotate-0) [541.012688] Starting subtest: 4-tiled-8bpp-rotate-0 [542.315122] Subtest 4-tiled-8bpp-rotate-0: SUCCESS (1.303s) [542.483908] [112/132] (500s left) kms_sequence (queue-idle) [542.582825] Starting subtest: queue-idle [542.583769] Starting dynamic subtest: pipe-A-eDP-1 [544.375001] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.791s) [544.383939] Starting dynamic subtest: pipe-B-eDP-1 [546.825698] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.450s) [546.838881] Starting dynamic subtest: pipe-C-eDP-1 [549.310462] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.480s) [549.324112] Starting dynamic subtest: pipe-D-eDP-1 [551.802388] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.493s) [551.803297] Subtest queue-idle: SUCCESS (9.218s) [552.701384] [113/132] (490s left) gem_exec_reloc (basic-wc) [552.769152] Subtest basic-wc: SKIP (0.000s) [552.819832] [114/132] (490s left) gem_mmap_gtt (basic-read-write-distinct) [552.882552] Subtest basic-read-write-distinct: SKIP (0.000s) [552.937236] [115/132] (490s left) gem_eio (in-flight-contexts-10ms) [553.164821] Starting subtest: in-flight-contexts-10ms [566.922380] Subtest in-flight-contexts-10ms: SUCCESS (13.752s) [567.119298] [116/132] (476s left) kms_cursor_legacy (torture-move) [567.229704] Starting subtest: torture-move [567.230738] Starting dynamic subtest: pipe-A [573.096434] Dynamic subtest pipe-A: SUCCESS (5.862s) [573.109777] Starting dynamic subtest: pipe-B [579.682441] Dynamic subtest pipe-B: SUCCESS (6.580s) [579.692435] Starting dynamic subtest: pipe-C [587.081152] Dynamic subtest pipe-C: SUCCESS (7.396s) [587.093238] Starting dynamic subtest: pipe-D [592.878634] Dynamic subtest pipe-D: SUCCESS (5.792s) [592.890416] Starting dynamic subtest: all-pipes [599.408089] Dynamic subtest all-pipes: SUCCESS (6.522s) [599.416689] Subtest torture-move: SUCCESS (32.163s) [599.580956] [117/132] (443s left) kms_feature_discovery (display-2x) [599.673798] Starting subtest: display-2x [599.675734] Subtest display-2x: SKIP (0.000s) [599.786730] [118/132] (443s left) syncobj_timeline (single-wait-for-submit-available-signaled) [599.845719] Starting subtest: single-wait-for-submit-available-signaled [599.846943] Subtest single-wait-for-submit-available-signaled: SUCCESS (0.000s) [599.974231] [119/132] (443s left) i915_drm_fdinfo (isolation) [600.014768] Starting subtest: isolation [600.015873] Starting dynamic subtest: rcs0 [600.053896] Dynamic subtest rcs0: SKIP (0.038s) [600.065011] Starting dynamic subtest: bcs0 [600.067324] Dynamic subtest bcs0: SKIP (0.000s) [600.076308] Starting dynamic subtest: vcs0 [600.078324] Dynamic subtest vcs0: SKIP (0.001s) [600.087312] Starting dynamic subtest: vcs1 [600.089117] Dynamic subtest vcs1: SKIP (0.000s) [600.097287] Starting dynamic subtest: vecs0 [600.098976] Dynamic subtest vecs0: SKIP (0.000s) [600.107035] Starting dynamic subtest: ccs0 [600.108670] Dynamic subtest ccs0: SKIP (0.000s) [600.110237] Subtest isolation: SKIP (0.046s) [600.150314] [120/132] (443s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-5) [600.246035] Starting subtest: planes-unity-scaling-downscale-factor-0-5 [600.247252] Starting dynamic subtest: pipe-A [600.272882] Dynamic subtest pipe-A: SKIP (0.015s) [600.286978] Starting dynamic subtest: pipe-B [600.301438] Dynamic subtest pipe-B: SKIP (0.027s) [600.312362] Starting dynamic subtest: pipe-C [600.318710] Dynamic subtest pipe-C: SKIP (0.027s) [600.327026] Starting dynamic subtest: pipe-D [600.346660] Dynamic subtest pipe-D: SKIP (0.028s) [600.348432] Subtest planes-unity-scaling-downscale-factor-0-5: SKIP (0.100s) [600.459662] [121/132] (443s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-pwrite) [600.552156] Starting subtest: psr-2p-primscrn-cur-indfb-draw-pwrite [600.553962] Subtest psr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s) [600.683230] [122/132] (442s left) api_intel_bb (intel-bb-blit-y) [600.745904] Starting subtest: intel-bb-blit-y [604.317314] Subtest intel-bb-blit-y: SUCCESS (3.569s) [604.471395] [123/132] (439s left) kms_frontbuffer_tracking (psr-1p-pri-indfb-multidraw) [604.565944] Starting subtest: psr-1p-pri-indfb-multidraw [626.789405] Subtest psr-1p-pri-indfb-multidraw: SUCCESS (22.216s) [626.957412] [124/132] (416s left) gem_partial_pwrite_pread (writes-after-reads-display) [627.026044] Subtest writes-after-reads-display: SKIP (0.000s) [627.094830] [125/132] (416s left) kms_getfb (getfb-handle-protection) [627.186442] Starting subtest: getfb-handle-protection [627.213355] Subtest getfb-handle-protection: SUCCESS (0.027s) [627.345508] [126/132] (416s left) gem_exec_schedule (u-fairslice-all) [627.408526] Starting subtest: u-fairslice-all [629.476999] Subtest u-fairslice-all: SUCCESS (2.070s) [629.815102] [127/132] (414s left) syncobj_wait (wait-for-submit-delayed-submit) [629.867585] Starting subtest: wait-for-submit-delayed-submit [629.969419] Subtest wait-for-submit-delayed-submit: SUCCESS (0.102s) [630.072567] [128/132] (413s left) gem_madvise (dontneed-after-mmap) [630.105641] Starting subtest: dontneed-after-mmap [630.129648] Subtest dontneed-after-mmap: SUCCESS (0.026s) [630.263187] [129/132] (413s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf) [635.276994] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf [635.280538] Starting dynamic subtest: pipe-A-eDP-1 [636.047139] Dynamic subtest pipe-A-eDP-1: SKIP (0.766s) [636.055900] Starting dynamic subtest: pipe-B-eDP-1 [637.156429] Dynamic subtest pipe-B-eDP-1: SKIP (1.107s) [637.158504] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf: SKIP (1.878s) [638.338435] [130/132] (405s left) kms_frontbuffer_tracking (fbc-tiling-linear) [638.438286] Starting subtest: fbc-tiling-linear [642.233703] Subtest fbc-tiling-linear: SUCCESS (3.795s) [643.433447] [131/132] (400s left) gem_userptr_blits (huge-split) [643.518598] Starting subtest: huge-split [643.525886] Subtest huge-split: SUCCESS (0.007s) [643.688781] [132/132] (400s left) kms_properties (colorop-properties-legacy) [643.783962] Starting subtest: colorop-properties-legacy [643.785130] Starting dynamic subtest: pipe-A-eDP-1 [644.147206] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.363s) [644.157368] Starting dynamic subtest: pipe-B-eDP-1 [645.239410] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.089s) [645.249178] Starting dynamic subtest: pipe-C-eDP-1 [646.329892] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.090s) [646.343914] Starting dynamic subtest: pipe-D-eDP-1 [647.437544] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.106s) [647.438778] Subtest colorop-properties-legacy: SUCCESS (3.653s) [648.319869] Closing watchdogs results: parsing output: 0/ for test: kms_psr results: parsing output: 1/ for test: kms_frontbuffer_tracking results: parsing output: 2/ for test: perf_pmu results: parsing output: 3/ for test: gem_spin_batch results: parsing output: 4/ for test: kms_addfb_basic results: parsing output: 5/ for test: kms_properties results: parsing output: 6/ for test: i915_pm_freq_api results: parsing output: 7/ for test: kms_cursor_crc results: parsing output: 8/ for test: kms_atomic results: parsing output: 9/ for test: syncobj_timeline results: parsing output: 10/ for test: kms_cursor_edge_walk results: parsing output: 11/ for test: kms_big_fb results: parsing output: 12/ for test: gem_ctx_isolation results: parsing output: 13/ for test: kms_flip results: parsing output: 14/ for test: gem_partial_pwrite_pread results: parsing output: 15/ for test: gen9_exec_parse results: parsing output: 16/ for test: kms_flip_scaled_crc results: parsing output: 17/ for test: gem_fenced_exec_thrash results: parsing output: 18/ for test: vgem_basic results: parsing output: 19/ for test: kms_big_fb results: parsing output: 20/ for test: gem_ctx_persistence results: parsing output: 21/ for test: syncobj_basic results: parsing output: 22/ for test: kms_frontbuffer_tracking results: parsing output: 23/ for test: kms_rotation_crc results: parsing output: 24/ for test: fbdev results: parsing output: 25/ for test: kms_addfb_basic results: parsing output: 26/ for test: kms_ccs results: parsing output: 27/ for test: gem_mmap_gtt results: parsing output: 28/ for test: kms_force_connector_basic results: parsing output: 29/ for test: syncobj_wait results: parsing output: 30/ for test: kms_addfb_basic results: parsing output: 31/ for test: kms_chamelium_color results: parsing output: 32/ for test: kms_flip_scaled_crc results: parsing output: 33/ for test: gem_ctx_create results: parsing output: 34/ for test: gem_exec_fence results: parsing output: 35/ for test: gem_mmap_offset results: parsing output: 36/ for test: kms_frontbuffer_tracking results: parsing output: 37/ for test: kms_frontbuffer_tracking results: parsing output: 38/ for test: kms_selftest results: parsing output: 39/ for test: gem_exec_capture results: parsing output: 40/ for test: kms_psr results: parsing output: 41/ for test: kms_cursor_crc results: parsing output: 42/ for test: kms_big_fb results: parsing output: 43/ for test: prime_vgem results: parsing output: 44/ for test: i915_pm_rps results: parsing output: 45/ for test: gem_mmap results: parsing output: 46/ for test: gem_mmap_gtt results: parsing output: 47/ for test: kms_big_fb results: parsing output: 48/ for test: i915_pm_rpm results: parsing output: 49/ for test: gem_pxp results: parsing output: 50/ for test: syncobj_timeline results: parsing output: 51/ for test: syncobj_basic results: parsing output: 52/ for test: kms_plane results: parsing output: 53/ for test: kms_psr results: parsing output: 54/ for test: kms_ccs results: parsing output: 55/ for test: kms_legacy_colorkey results: parsing output: 56/ for test: kms_atomic_interruptible results: parsing output: 57/ for test: kms_flip results: parsing output: 58/ for test: kms_plane_alpha_blend results: parsing output: 59/ for test: perf results: parsing output: 60/ for test: kms_pm_rpm results: parsing output: 61/ for test: gem_pwrite results: parsing output: 62/ for test: kms_psr results: parsing output: 63/ for test: kms_chamelium_hpd results: parsing output: 64/ for test: perf_pmu results: parsing output: 65/ for test: drm_read results: parsing output: 66/ for test: kms_big_fb results: parsing output: 67/ for test: gem_create results: parsing output: 68/ for test: gem_eio results: parsing output: 69/ for test: gem_exec_reloc results: parsing output: 70/ for test: syncobj_timeline results: parsing output: 71/ for test: dumb_buffer results: parsing output: 72/ for test: prime_vgem results: parsing output: 73/ for test: kms_frontbuffer_tracking results: parsing output: 74/ for test: kms_color results: parsing output: 75/ for test: kms_ccs results: parsing output: 76/ for test: kms_ccs results: parsing output: 77/ for test: gem_exec_whisper results: parsing output: 78/ for test: kms_invalid_mode results: parsing output: 79/ for test: kms_big_fb results: parsing output: 80/ for test: kms_frontbuffer_tracking results: parsing output: 81/ for test: syncobj_wait results: parsing output: 82/ for test: kms_frontbuffer_tracking results: parsing output: 83/ for test: prime_mmap results: parsing output: 84/ for test: gem_exec_balancer results: parsing output: 85/ for test: gem_exec_flush results: parsing output: 86/ for test: kms_frontbuffer_tracking results: parsing output: 87/ for test: kms_chamelium_frames results: parsing output: 88/ for test: kms_psr2_sf results: parsing output: 89/ for test: kms_atomic_transition results: parsing output: 90/ for test: gem_ctx_shared results: parsing output: 91/ for test: kms_atomic_transition results: parsing output: 92/ for test: kms_frontbuffer_tracking results: parsing output: 93/ for test: kms_flip results: parsing output: 94/ for test: syncobj_basic results: parsing output: 95/ for test: kms_psr results: parsing output: 96/ for test: syncobj_timeline results: parsing output: 97/ for test: gem_exec_schedule results: parsing output: 98/ for test: kms_cursor_legacy results: parsing output: 99/ for test: kms_properties results: parsing output: 100/ for test: kms_frontbuffer_tracking results: parsing output: 101/ for test: kms_cursor_crc results: parsing output: 102/ for test: gem_exec_schedule results: parsing output: 103/ for test: kms_flip results: parsing output: 104/ for test: kms_frontbuffer_tracking results: parsing output: 105/ for test: gem_render_copy results: parsing output: 106/ for test: kms_plane_scaling results: parsing output: 107/ for test: kms_cursor_legacy results: parsing output: 108/ for test: kms_vrr results: parsing output: 109/ for test: kms_frontbuffer_tracking results: parsing output: 110/ for test: kms_big_fb results: parsing output: 111/ for test: kms_sequence results: parsing output: 112/ for test: gem_exec_reloc results: parsing output: 113/ for test: gem_mmap_gtt results: parsing output: 114/ for test: gem_eio results: parsing output: 115/ for test: kms_cursor_legacy results: parsing output: 116/ for test: kms_feature_discovery results: parsing output: 117/ for test: syncobj_timeline results: parsing output: 118/ for test: i915_drm_fdinfo results: parsing output: 119/ for test: kms_plane_scaling results: parsing output: 120/ for test: kms_frontbuffer_tracking results: parsing output: 121/ for test: api_intel_bb results: parsing output: 122/ for test: kms_frontbuffer_tracking results: parsing output: 123/ for test: gem_partial_pwrite_pread results: parsing output: 124/ for test: kms_getfb results: parsing output: 125/ for test: gem_exec_schedule results: parsing output: 126/ for test: syncobj_wait results: parsing output: 127/ for test: gem_madvise results: parsing output: 128/ for test: kms_psr2_sf results: parsing output: 129/ for test: kms_frontbuffer_tracking results: parsing output: 130/ for test: gem_userptr_blits results: parsing output: 131/ for test: kms_properties Done.