[54.339894] Initializing watchdogs [54.340062] /dev/watchdog0 [54.353771] [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] [54.358038] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [54.360140] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [54.364224] [001/134] (960s left) kms_flip (wf_vblank-ts-check) [54.481973] Starting subtest: wf_vblank-ts-check [54.484202] Starting dynamic subtest: A-eDP1 [75.290371] Dynamic subtest A-eDP1: SUCCESS (21.021s) [75.298865] Starting dynamic subtest: B-eDP1 [84.213216] Dynamic subtest B-eDP1: SUCCESS (8.931s) [84.222571] Starting dynamic subtest: C-eDP1 [93.126068] Dynamic subtest C-eDP1: SUCCESS (8.908s) [93.133050] Starting dynamic subtest: D-eDP1 [102.065784] Dynamic subtest D-eDP1: SUCCESS (8.936s) [102.071667] Subtest wf_vblank-ts-check: SUCCESS (47.802s) [103.352748] [002/134] (911s left) kms_color (ctm-signed) [103.446385] Starting subtest: ctm-signed [103.448675] Starting dynamic subtest: pipe-A-eDP-1 [105.586416] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.141s) [105.594722] Starting dynamic subtest: pipe-B-eDP-1 [108.446717] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.859s) [108.455818] Starting dynamic subtest: pipe-C-eDP-1 [111.096775] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.647s) [111.104075] Starting dynamic subtest: pipe-D-eDP-1 [113.752600] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.657s) [113.754818] Subtest ctm-signed: SUCCESS (10.306s) [114.586379] [003/134] (900s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-render) [114.687707] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-render [118.393227] Subtest fbc-1p-primscrn-cur-indfb-draw-render: SUCCESS (3.709s) [119.608328] [004/134] (895s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs) [119.691746] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs [119.694132] Starting dynamic subtest: pipe-A-eDP-1 [119.755400] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [119.762150] Starting dynamic subtest: pipe-B-eDP-1 [119.820573] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [119.829472] Starting dynamic subtest: pipe-C-eDP-1 [119.888481] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [119.897857] Starting dynamic subtest: pipe-D-eDP-1 [119.955416] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [119.959595] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs: SKIP (0.007s) [121.945682] [005/134] (893s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-fullscreen) [122.054730] Starting subtest: fbc-2p-scndscrn-spr-indfb-fullscreen [122.058887] Subtest fbc-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s) [122.161617] [006/134] (892s left) gen7_exec_parse (basic-allocation) [122.221258] Subtest basic-allocation: SKIP (0.000s) [122.281844] [007/134] (892s left) syncobj_timeline (device-submit-unordered) [122.335030] Starting subtest: device-submit-unordered [122.337406] Subtest device-submit-unordered: SUCCESS (0.000s) [122.448539] [008/134] (892s left) gem_ctx_sseu (mmap-args) [122.499726] Subtest mmap-args: SKIP (0.000s) [122.569963] [009/134] (892s left) kms_psr_stress_test (flip-primary-invalidate-overlay) [122.655020] Starting subtest: flip-primary-invalidate-overlay [134.200858] Subtest flip-primary-invalidate-overlay: SUCCESS (11.546s) [134.348041] [010/134] (880s left) kms_flip (2x-flip-vs-panning) [134.441421] Starting subtest: 2x-flip-vs-panning [134.450725] Subtest 2x-flip-vs-panning: SKIP (0.011s) [134.580366] [011/134] (880s left) syncobj_timeline (invalid-query-illegal-handle) [134.631638] Starting subtest: invalid-query-illegal-handle [134.633672] Subtest invalid-query-illegal-handle: SUCCESS (0.000s) [134.748961] [012/134] (880s left) kms_big_fb (4-tiled-32bpp-rotate-180) [134.847103] Starting subtest: 4-tiled-32bpp-rotate-180 [136.315551] Subtest 4-tiled-32bpp-rotate-180: SUCCESS (1.467s) [136.479647] [013/134] (878s left) gem_exec_fence (submit67) [136.653688] Starting subtest: submit67 [136.658447] Subtest submit67: SKIP (0.000s) [138.062183] [FACT gem_exec_fence (submit67)] new: kernel.kmod_is_loaded.vgem: true [138.065390] [014/134] (877s left) syncobj_wait (wait-delayed-signal) [138.126822] Starting subtest: wait-delayed-signal [138.227540] Subtest wait-delayed-signal: SUCCESS (0.102s) [138.311317] [015/134] (877s left) kms_writeback (writeback-check-output-xrgb2101010) [138.417068] Subtest writeback-check-output-XRGB2101010: SKIP (0.000s) [138.462216] [016/134] (877s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180) [138.556226] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180 [139.647522] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180: SUCCESS (1.091s) [139.807236] [017/134] (875s left) kms_colorop (plane-xr24-xr24-gamma_2_2_inv_oetf-gamma_2_2_oetf) [139.939515] Subtest plane-XR24-XR24-gamma_2_2_inv_oetf-gamma_2_2_oetf: SKIP (0.000s) [140.047236] [018/134] (875s left) kms_invalid_mode (overflow-vrefresh) [140.131414] Starting subtest: overflow-vrefresh [140.133424] Starting dynamic subtest: pipe-A-eDP-1 [140.416642] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.283s) [140.424059] Starting dynamic subtest: pipe-B-eDP-1 [140.426338] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [140.433550] Starting dynamic subtest: pipe-C-eDP-1 [140.435712] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [140.442677] Starting dynamic subtest: pipe-D-eDP-1 [140.444560] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [140.446410] Subtest overflow-vrefresh: SUCCESS (0.287s) [141.274571] [019/134] (874s left) gem_mmap_offset (blt-coherency) [141.327368] Starting subtest: blt-coherency [141.332508] Subtest blt-coherency: SUCCESS (0.007s) [141.490247] [020/134] (874s left) syncobj_wait (wait-all-snapshot) [141.545880] Starting subtest: wait-all-snapshot [141.625749] Subtest wait-all-snapshot: SUCCESS (0.081s) [141.710748] [021/134] (873s left) syncobj_timeline (signal-point-0) [141.763598] Starting subtest: signal-point-0 [141.765486] Subtest signal-point-0: SUCCESS (0.000s) [141.864700] [022/134] (873s left) syncobj_wait (invalid-wait-illegal-handle) [141.924633] Starting subtest: invalid-wait-illegal-handle [141.926992] Subtest invalid-wait-illegal-handle: SUCCESS (0.000s) [142.033592] [023/134] (873s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs) [142.117743] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs [142.120029] Starting dynamic subtest: pipe-A-eDP-1 [142.141943] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [142.149681] Starting dynamic subtest: pipe-B-eDP-1 [142.170075] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [142.176591] Starting dynamic subtest: pipe-C-eDP-1 [142.194258] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [142.200526] Starting dynamic subtest: pipe-D-eDP-1 [142.219061] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [142.222613] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs: SKIP (0.005s) [144.419194] [024/134] (871s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-pgflip-blt) [144.521309] Starting subtest: psr-2p-primscrn-shrfb-pgflip-blt [144.525184] Subtest psr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s) [144.634604] [025/134] (871s left) syncobj_wait (wait-all-for-submit-delayed-submit) [144.692190] Starting subtest: wait-all-for-submit-delayed-submit [144.795868] Subtest wait-all-for-submit-delayed-submit: SUCCESS (0.103s) [144.879517] [026/134] (870s left) perf_pmu (enable-race) [144.917445] Starting subtest: enable-race [144.919523] Starting dynamic subtest: rcs0 [157.685890] Dynamic subtest rcs0: SUCCESS (12.773s) [157.695854] Starting dynamic subtest: bcs0 [170.420477] Dynamic subtest bcs0: SUCCESS (12.735s) [170.430136] Starting dynamic subtest: vcs0 [185.875263] Dynamic subtest vcs0: SUCCESS (15.453s) [185.883854] Starting dynamic subtest: vcs1 [201.939768] Dynamic subtest vcs1: SUCCESS (16.063s) [201.950732] Starting dynamic subtest: vecs0 [217.875684] Dynamic subtest vecs0: SUCCESS (15.934s) [217.884874] Starting dynamic subtest: ccs0 [230.622351] Dynamic subtest ccs0: SUCCESS (12.747s) [230.624810] Subtest enable-race: SUCCESS (85.713s) [230.760938] [027/134] (785s left) i915_pm_rc6_residency (rc6-fence) [230.812303] Starting subtest: rc6-fence [230.846775] Starting dynamic subtest: gt0 [243.169597] Dynamic subtest gt0: SUCCESS (12.322s) [243.180332] Starting dynamic subtest: gt1 [257.875456] Dynamic subtest gt1: SUCCESS (14.702s) [257.878530] Subtest rc6-fence: SUCCESS (27.065s) [257.996257] [028/134] (757s left) kms_plane_scaling (plane-downscale-factor-0-75-with-pixel-format) [258.103837] Starting subtest: plane-downscale-factor-0-75-with-pixel-format [258.106129] Starting dynamic subtest: pipe-A [259.232020] Dynamic subtest pipe-A: SUCCESS (1.130s) [259.239506] Starting dynamic subtest: pipe-B [261.517383] Dynamic subtest pipe-B: SUCCESS (2.284s) [261.527135] Starting dynamic subtest: pipe-C [262.692431] Dynamic subtest pipe-C: SUCCESS (1.174s) [262.700661] Starting dynamic subtest: pipe-D [263.922225] Dynamic subtest pipe-D: SUCCESS (1.228s) [263.924607] Subtest plane-downscale-factor-0-75-with-pixel-format: SUCCESS (5.821s) [265.143778] [029/134] (750s left) syncobj_timeline (multi-wait-available-submitted-signaled) [265.210652] Starting subtest: multi-wait-available-submitted-signaled [265.213107] Subtest multi-wait-available-submitted-signaled: SUCCESS (0.000s) [265.353976] [030/134] (750s left) gem_eio (in-flight-internal-immediate) [265.577540] Starting subtest: in-flight-internal-immediate [266.970198] Subtest in-flight-internal-immediate: SUCCESS (1.393s) [267.147895] [031/134] (748s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-pwrite) [267.237552] Starting subtest: fbcpsr-rgb101010-draw-pwrite [274.211887] Subtest fbcpsr-rgb101010-draw-pwrite: SUCCESS (6.977s) [274.365426] [032/134] (741s left) gen9_exec_parse (valid-registers) [274.430589] Subtest valid-registers: SKIP (0.000s) [274.520331] [033/134] (741s left) kms_colorop (plane-xr30-xr30-srgb_inv_eotf_lut-srgb_eotf_lut) [274.663799] Subtest plane-XR30-XR30-srgb_inv_eotf_lut-srgb_eotf_lut: SKIP (0.000s) [274.746090] [034/134] (741s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size) [274.867597] Starting subtest: basic-flip-after-cursor-varying-size [275.796489] Subtest basic-flip-after-cursor-varying-size: SUCCESS (0.929s) [276.642836] [035/134] (739s left) sysfs_heartbeat_interval (invalid) [276.696932] Starting subtest: invalid [276.699132] Starting dynamic subtest: vecs0 [276.701347] Dynamic subtest vecs0: SUCCESS (0.000s) [276.709174] Starting dynamic subtest: ccs0 [276.710984] Dynamic subtest ccs0: SUCCESS (0.000s) [276.718416] Starting dynamic subtest: vcs0 [276.720312] Dynamic subtest vcs0: SUCCESS (0.000s) [276.727692] Starting dynamic subtest: bcs0 [276.729589] Dynamic subtest bcs0: SUCCESS (0.000s) [276.736864] Starting dynamic subtest: rcs0 [276.739049] Dynamic subtest rcs0: SUCCESS (0.000s) [276.746369] Starting dynamic subtest: vcs1 [276.748325] Dynamic subtest vcs1: SUCCESS (0.000s) [276.750506] Subtest invalid: SUCCESS (0.005s) [276.822955] [036/134] (739s left) kms_atomic (plane-primary-overlay-mutable-zpos) [276.909226] Starting subtest: plane-primary-overlay-mutable-zpos [280.369057] Subtest plane-primary-overlay-mutable-zpos: SKIP (3.456s) [281.561084] [037/134] (734s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-upscaling) [281.651231] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-upscaling [281.653535] Starting dynamic subtest: pipe-A-default-mode [284.409393] Dynamic subtest pipe-A-default-mode: SUCCESS (2.757s) [284.411685] Subtest flip-64bpp-4tile-to-16bpp-4tile-upscaling: SUCCESS (2.759s) [285.255058] [038/134] (731s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt) [285.352518] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt [285.356987] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [285.487371] [039/134] (730s left) gem_exec_schedule (preemptive-hang) [285.655217] Starting subtest: preemptive-hang [285.657482] Starting dynamic subtest: rcs0 [295.040788] Dynamic subtest rcs0: SUCCESS (9.382s) [295.050544] Starting dynamic subtest: bcs0 [303.997425] Dynamic subtest bcs0: SUCCESS (8.956s) [304.005497] Starting dynamic subtest: vcs0 [313.081265] Dynamic subtest vcs0: SUCCESS (9.084s) [313.091709] Starting dynamic subtest: vcs1 [322.042630] Dynamic subtest vcs1: SUCCESS (8.959s) [322.050704] Starting dynamic subtest: vecs0 [331.006141] Dynamic subtest vecs0: SUCCESS (8.960s) [331.014059] Starting dynamic subtest: ccs0 [340.026801] Dynamic subtest ccs0: SUCCESS (9.020s) [340.029199] Subtest preemptive-hang: SUCCESS (54.370s) [340.309108] [040/134] (676s left) sw_sync (sync_multi_producer_single_consumer) [340.346091] Starting subtest: sync_multi_producer_single_consumer [341.419500] Subtest sync_multi_producer_single_consumer: SUCCESS (1.075s) [341.491598] [041/134] (674s left) dumb_buffer (map-invalid-size) [341.554447] Starting subtest: map-invalid-size [341.556583] Subtest map-invalid-size: SUCCESS (0.000s) [341.673833] [042/134] (674s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc) [341.769252] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc [341.773240] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s) [341.878642] [043/134] (674s left) gem_exec_nop (basic-parallel) [341.955606] Starting subtest: basic-parallel [356.885243] Subtest basic-parallel: SUCCESS (14.939s) [357.130823] [044/134] (659s left) gem_media_vme [357.285641] [045/134] (659s left) kms_flip (2x-single-buffer-flip-vs-dpms-off-vs-modeset) [357.387100] Starting subtest: 2x-single-buffer-flip-vs-dpms-off-vs-modeset [357.395694] Subtest 2x-single-buffer-flip-vs-dpms-off-vs-modeset: SKIP (0.010s) [357.487302] [046/134] (659s left) gem_pxp (create-regular-context-2) [357.608037] Starting subtest: create-regular-context-2 [357.610374] Subtest create-regular-context-2: SUCCESS (0.002s) [357.747249] [047/134] (658s left) gem_create (create-massive) [357.800193] Starting subtest: create-massive [357.802448] Subtest create-massive: SUCCESS (0.000s) [358.010657] [048/134] (658s left) kms_busy (extended-pageflip-hang-oldfb) [358.112493] Starting subtest: extended-pageflip-hang-oldfb [358.114672] Starting dynamic subtest: pipe-A [358.505684] Dynamic subtest pipe-A: SUCCESS (0.392s) [358.515955] Starting dynamic subtest: pipe-D [359.646617] Dynamic subtest pipe-D: SUCCESS (1.138s) [359.649045] Subtest extended-pageflip-hang-oldfb: SUCCESS (1.535s) [360.516668] [049/134] (656s left) kms_chamelium_hpd (dp-hpd-storm) [360.902457] Subtest dp-hpd-storm: SKIP (0.000s) [361.696410] [050/134] (655s left) gem_mmap_gtt (basic) [361.751691] Subtest basic: SKIP (0.000s) [361.817413] [051/134] (655s left) perf (disabled-read-error) [361.957335] Starting subtest: disabled-read-error [361.971615] Subtest disabled-read-error: SUCCESS (0.015s) [362.016797] [052/134] (654s left) kms_selftest (drm_damage_helper) [362.051792] Starting subtest: drm_damage_helper [362.070029] Starting dynamic subtest: drm_test_damage_iter_no_damage [362.194082] Dynamic subtest drm_test_damage_iter_no_damage: SUCCESS (0.123s) [362.203661] Starting dynamic subtest: drm_test_damage_iter_no_damage_fractional_src [362.314808] Dynamic subtest drm_test_damage_iter_no_damage_fractional_src: SUCCESS (0.120s) [362.323289] Starting dynamic subtest: drm_test_damage_iter_no_damage_src_moved [362.462807] Dynamic subtest drm_test_damage_iter_no_damage_src_moved: SUCCESS (0.147s) [362.473131] Starting dynamic subtest: drm_test_damage_iter_no_damage_fractional_src_moved [362.600486] Dynamic subtest drm_test_damage_iter_no_damage_fractional_src_moved: SUCCESS (0.133s) [362.609527] Starting dynamic subtest: drm_test_damage_iter_no_damage_not_visible [362.748083] Dynamic subtest drm_test_damage_iter_no_damage_not_visible: SUCCESS (0.147s) [362.756885] Starting dynamic subtest: drm_test_damage_iter_no_damage_no_crtc [362.897548] Dynamic subtest drm_test_damage_iter_no_damage_no_crtc: SUCCESS (0.147s) [362.905587] Starting dynamic subtest: drm_test_damage_iter_no_damage_no_fb [363.040301] Dynamic subtest drm_test_damage_iter_no_damage_no_fb: SUCCESS (0.141s) [363.050332] Starting dynamic subtest: drm_test_damage_iter_simple_damage [363.174660] Dynamic subtest drm_test_damage_iter_simple_damage: SUCCESS (0.134s) [363.182839] Starting dynamic subtest: drm_test_damage_iter_single_damage [363.320258] Dynamic subtest drm_test_damage_iter_single_damage: SUCCESS (0.144s) [363.328199] Starting dynamic subtest: drm_test_damage_iter_single_damage_intersect_src [363.460410] Dynamic subtest drm_test_damage_iter_single_damage_intersect_src: SUCCESS (0.139s) [363.468096] Starting dynamic subtest: drm_test_damage_iter_single_damage_outside_src [363.590373] Dynamic subtest drm_test_damage_iter_single_damage_outside_src: SUCCESS (0.128s) [363.598257] Starting dynamic subtest: drm_test_damage_iter_single_damage_fractional_src [363.743237] Dynamic subtest drm_test_damage_iter_single_damage_fractional_src: SUCCESS (0.152s) [363.753286] Starting dynamic subtest: drm_test_damage_iter_single_damage_intersect_fractional_src [363.859650] Dynamic subtest drm_test_damage_iter_single_damage_intersect_fractional_src: SUCCESS (0.116s) [363.869432] Starting dynamic subtest: drm_test_damage_iter_single_damage_outside_fractional_src [363.997063] Dynamic subtest drm_test_damage_iter_single_damage_outside_fractional_src: SUCCESS (0.136s) [364.005440] Starting dynamic subtest: drm_test_damage_iter_single_damage_src_moved [364.132617] Dynamic subtest drm_test_damage_iter_single_damage_src_moved: SUCCESS (0.134s) [364.140288] Starting dynamic subtest: drm_test_damage_iter_single_damage_fractional_src_moved [364.260245] Dynamic subtest drm_test_damage_iter_single_damage_fractional_src_moved: SUCCESS (0.128s) [364.267793] Starting dynamic subtest: drm_test_damage_iter_damage [364.410398] Dynamic subtest drm_test_damage_iter_damage: SUCCESS (0.148s) [364.418297] Starting dynamic subtest: drm_test_damage_iter_damage_one_intersect [364.551545] Dynamic subtest drm_test_damage_iter_damage_one_intersect: SUCCESS (0.140s) [364.559496] Starting dynamic subtest: drm_test_damage_iter_damage_one_outside [364.703495] Dynamic subtest drm_test_damage_iter_damage_one_outside: SUCCESS (0.151s) [364.711450] Starting dynamic subtest: drm_test_damage_iter_damage_src_moved [364.860450] Dynamic subtest drm_test_damage_iter_damage_src_moved: SUCCESS (0.158s) [364.868918] Starting dynamic subtest: drm_test_damage_iter_damage_not_visible [365.000483] Dynamic subtest drm_test_damage_iter_damage_not_visible: SUCCESS (0.138s) [365.002748] Subtest drm_damage_helper: SUCCESS (2.947s) [365.196630] [053/134] (651s left) core_auth (getclient-master-drop) [365.230973] Starting subtest: getclient-master-drop [365.252803] Subtest getclient-master-drop: SUCCESS (0.024s) [365.393492] [054/134] (651s left) gem_tiled_blits (basic) [365.458109] Subtest basic: SKIP (0.000s) [365.539678] [055/134] (651s left) kms_rotation_crc (primary-yf-tiled-reflect-x-90) [365.636984] Starting subtest: primary-yf-tiled-reflect-x-90 [365.641545] Subtest primary-yf-tiled-reflect-x-90: SKIP (0.001s) [365.723032] [056/134] (651s left) syncobj_wait (invalid-signal-illegal-handle) [365.781593] Starting subtest: invalid-signal-illegal-handle [365.783545] Subtest invalid-signal-illegal-handle: SUCCESS (0.000s) [365.904473] [057/134] (651s left) gem_softpin (32b-excludes-last-page) [365.960583] Starting subtest: 32b-excludes-last-page [365.965390] Subtest 32b-excludes-last-page: SUCCESS (0.003s) [366.110213] [058/134] (651s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt) [366.214109] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt [366.217689] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [366.345815] [059/134] (650s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-hflip) [366.448506] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-hflip [366.452506] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s) [366.566644] [060/134] (650s left) gem_exec_balancer (full-pulse) [366.623054] Starting subtest: full-pulse [371.769682] Subtest full-pulse: SUCCESS (5.146s) [372.104501] [061/134] (645s left) kms_ccs (bad-pixel-format-y-tiled-ccs) [372.199191] Starting subtest: bad-pixel-format-y-tiled-ccs [372.201526] Starting dynamic subtest: pipe-A-eDP-1 [372.224635] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [372.235260] Starting dynamic subtest: pipe-B-eDP-1 [372.256685] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [372.264979] Starting dynamic subtest: pipe-C-eDP-1 [372.287034] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [372.296023] Starting dynamic subtest: pipe-D-eDP-1 [372.317774] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [372.322227] Subtest bad-pixel-format-y-tiled-ccs: SKIP (0.004s) [374.509817] [062/134] (642s left) kms_vblank (query-idle-hang) [374.603089] Starting subtest: query-idle-hang [374.605389] Starting dynamic subtest: pipe-A-eDP-1 [400.722494] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.118s) [400.735901] Starting dynamic subtest: pipe-D-eDP-1 [415.639733] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.912s) [415.641692] Subtest query-idle-hang: SUCCESS (41.035s) [416.474562] [063/134] (600s left) kms_prop_blob (blob-prop-lifetime) [416.534288] Starting subtest: blob-prop-lifetime [416.536624] Subtest blob-prop-lifetime: SUCCESS (0.001s) [416.667347] [064/134] (600s left) kms_big_fb (yf-tiled-64bpp-rotate-0) [416.771523] Starting subtest: yf-tiled-64bpp-rotate-0 [416.775716] Subtest yf-tiled-64bpp-rotate-0: SKIP (0.000s) [416.894593] [065/134] (600s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-gtt) [416.986844] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-gtt [416.991131] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [417.093094] [066/134] (600s left) kms_cursor_crc (cursor-onscreen-32x10) [417.257657] Starting subtest: cursor-onscreen-32x10 [417.305824] Subtest cursor-onscreen-32x10: SKIP (0.044s) [417.613764] [067/134] (599s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted) [417.666286] Starting subtest: multi-wait-all-for-submit-unsubmitted [417.768301] Subtest multi-wait-all-for-submit-unsubmitted: SUCCESS (0.102s) [417.853542] [068/134] (599s left) syncobj_timeline (etime-single-wait-all-for-submit-available-unsubmitted) [417.899090] Starting subtest: etime-single-wait-all-for-submit-available-unsubmitted [418.008557] Subtest etime-single-wait-all-for-submit-available-unsubmitted: SUCCESS (0.108s) [418.099418] [069/134] (599s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-msflip-blt) [418.191975] Starting subtest: psr-2p-scndscrn-shrfb-msflip-blt [418.196282] Subtest psr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s) [418.325935] [070/134] (599s left) syncobj_basic (create-signaled) [418.375260] Starting subtest: create-signaled [418.377390] Subtest create-signaled: SUCCESS (0.000s) [418.513627] [071/134] (599s left) sysfs_preempt_timeout (timeout) [418.579787] Starting subtest: timeout [418.582116] Starting dynamic subtest: vecs0 [427.932789] Dynamic subtest vecs0: SUCCESS (9.352s) [427.943042] Starting dynamic subtest: ccs0 [429.249030] Dynamic subtest ccs0: SUCCESS (1.314s) [429.260248] Starting dynamic subtest: vcs0 [438.947837] Dynamic subtest vcs0: SUCCESS (9.695s) [438.956963] Starting dynamic subtest: bcs0 [440.293039] Dynamic subtest bcs0: SUCCESS (1.344s) [440.305048] Starting dynamic subtest: rcs0 [441.681950] Dynamic subtest rcs0: SUCCESS (1.388s) [441.693373] Starting dynamic subtest: vcs1 [450.915292] Dynamic subtest vcs1: SUCCESS (9.231s) [450.917927] Subtest timeout: SUCCESS (32.338s) [451.006208] [072/134] (566s left) kms_pm_rpm (pm-caching) [453.033334] Starting subtest: pm-caching [453.038780] Subtest pm-caching: SKIP (0.000s) [453.423871] [073/134] (564s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12) [453.515931] Starting subtest: compare-crc-sanitycheck-nv12 [453.518279] Starting dynamic subtest: pipe-A-eDP-1 [454.182772] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.665s) [454.191342] Starting dynamic subtest: pipe-B-eDP-1 [455.461975] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.276s) [455.471242] Starting dynamic subtest: pipe-C-eDP-1 [456.675616] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.210s) [456.685055] Starting dynamic subtest: pipe-D-eDP-1 [457.847979] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.173s) [457.850605] Subtest compare-crc-sanitycheck-nv12: SUCCESS (4.332s) [458.725417] [074/134] (559s left) kms_psr2_sf (pr-cursor-plane-update-sf) [463.781918] Starting subtest: pr-cursor-plane-update-sf [463.786615] Subtest pr-cursor-plane-update-sf: SKIP (0.002s) [464.644968] [075/134] (553s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-plflip-blt) [464.737710] Starting subtest: fbc-2p-scndscrn-indfb-plflip-blt [464.742157] Subtest fbc-2p-scndscrn-indfb-plflip-blt: SKIP (0.000s) [464.862863] [076/134] (553s left) kms_pm_backlight (bad-brightness) [464.949105] Starting subtest: bad-brightness [464.996163] Starting dynamic subtest: eDP-1 [465.319383] Dynamic subtest eDP-1: SUCCESS (0.320s) [465.321942] Subtest bad-brightness: SUCCESS (0.370s) [466.177359] [077/134] (551s left) gem_ctx_persistence (engines-queued) [466.239145] Starting subtest: engines-queued [466.241413] Starting dynamic subtest: rcs0 [466.365538] Dynamic subtest rcs0: SUCCESS (0.128s) [466.377642] Starting dynamic subtest: bcs0 [466.397627] Dynamic subtest bcs0: SUCCESS (0.031s) [466.405840] Starting dynamic subtest: vcs0 [467.891375] Dynamic subtest vcs0: SUCCESS (1.490s) [467.903219] Starting dynamic subtest: vcs1 [469.873955] Dynamic subtest vcs1: SUCCESS (1.980s) [469.886037] Starting dynamic subtest: vecs0 [471.858465] Dynamic subtest vecs0: SUCCESS (1.981s) [471.870681] Starting dynamic subtest: ccs0 [472.032782] Dynamic subtest ccs0: SUCCESS (0.173s) [472.035275] Subtest engines-queued: SUCCESS (5.796s) [472.180536] [078/134] (545s left) kms_ccs (random-ccs-data-y-tiled-ccs) [472.281086] Starting subtest: random-ccs-data-y-tiled-ccs [472.283579] Starting dynamic subtest: pipe-A-eDP-1 [472.309338] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [472.320305] Starting dynamic subtest: pipe-B-eDP-1 [472.344438] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [472.353458] Starting dynamic subtest: pipe-C-eDP-1 [472.377587] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [472.386870] Starting dynamic subtest: pipe-D-eDP-1 [472.412754] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [472.417067] Subtest random-ccs-data-y-tiled-ccs: SKIP (0.005s) [474.457532] [079/134] (543s left) kms_chamelium_frames (hdmi-crc-single) [474.834808] Subtest hdmi-crc-single: SKIP (0.000s) [475.651975] [080/134] (542s left) sw_sync (timeline_closed_signaled) [475.687512] Starting subtest: timeline_closed_signaled [475.689467] Subtest timeline_closed_signaled: SUCCESS (0.000s) [475.759766] [081/134] (542s left) kms_fbcon_fbt (psr-suspend) [475.813231] Starting subtest: psr-suspend [525.577211] Subtest psr-suspend: SUCCESS (20.059s) [525.629737] Aborting: Kernel badly tainted (0x44244, 0x200) (check dmesg for details): TAINT_WARN: WARN_ON has happened. [525.646916] [FACT kms_fbcon_fbt (psr-suspend)] new: kernel.is_tainted.taint_warn: true [525.647789] Closing watchdogs results: parsing output: 0/ for test: kms_flip results: parsing output: 1/ for test: kms_color results: parsing output: 2/ for test: kms_frontbuffer_tracking results: parsing output: 3/ for test: kms_ccs results: parsing output: 4/ for test: kms_frontbuffer_tracking results: parsing output: 5/ for test: gen7_exec_parse results: parsing output: 6/ for test: syncobj_timeline results: parsing output: 7/ for test: gem_ctx_sseu results: parsing output: 8/ for test: kms_psr_stress_test results: parsing output: 9/ for test: kms_flip results: parsing output: 10/ for test: syncobj_timeline results: parsing output: 11/ for test: kms_big_fb results: parsing output: 12/ for test: gem_exec_fence results: parsing output: 13/ for test: syncobj_wait results: parsing output: 14/ for test: kms_writeback results: parsing output: 15/ for test: kms_big_fb results: parsing output: 16/ for test: kms_colorop results: parsing output: 17/ for test: kms_invalid_mode results: parsing output: 18/ for test: gem_mmap_offset results: parsing output: 19/ for test: syncobj_wait results: parsing output: 20/ for test: syncobj_timeline results: parsing output: 21/ for test: syncobj_wait results: parsing output: 22/ for test: kms_ccs results: parsing output: 23/ for test: kms_frontbuffer_tracking results: parsing output: 24/ for test: syncobj_wait results: parsing output: 25/ for test: perf_pmu results: parsing output: 26/ for test: i915_pm_rc6_residency results: parsing output: 27/ for test: kms_plane_scaling results: parsing output: 28/ for test: syncobj_timeline results: parsing output: 29/ for test: gem_eio results: parsing output: 30/ for test: kms_frontbuffer_tracking results: parsing output: 31/ for test: gen9_exec_parse results: parsing output: 32/ for test: kms_colorop results: parsing output: 33/ for test: kms_cursor_legacy results: parsing output: 34/ for test: sysfs_heartbeat_interval results: parsing output: 35/ for test: kms_atomic results: parsing output: 36/ for test: kms_flip_scaled_crc results: parsing output: 37/ for test: kms_frontbuffer_tracking results: parsing output: 38/ for test: gem_exec_schedule results: parsing output: 39/ for test: sw_sync results: parsing output: 40/ for test: dumb_buffer results: parsing output: 41/ for test: kms_frontbuffer_tracking results: parsing output: 42/ for test: gem_exec_nop results: parsing output: 43/ for test: gem_media_vme results: parsing output: 44/ for test: kms_flip results: parsing output: 45/ for test: gem_pxp results: parsing output: 46/ for test: gem_create results: parsing output: 47/ for test: kms_busy results: parsing output: 48/ for test: kms_chamelium_hpd results: parsing output: 49/ for test: gem_mmap_gtt results: parsing output: 50/ for test: perf results: parsing output: 51/ for test: kms_selftest results: parsing output: 52/ for test: core_auth results: parsing output: 53/ for test: gem_tiled_blits results: parsing output: 54/ for test: kms_rotation_crc results: parsing output: 55/ for test: syncobj_wait results: parsing output: 56/ for test: gem_softpin results: parsing output: 57/ for test: kms_frontbuffer_tracking results: parsing output: 58/ for test: kms_big_fb results: parsing output: 59/ for test: gem_exec_balancer results: parsing output: 60/ for test: kms_ccs results: parsing output: 61/ for test: kms_vblank results: parsing output: 62/ for test: kms_prop_blob results: parsing output: 63/ for test: kms_big_fb results: parsing output: 64/ for test: kms_frontbuffer_tracking results: parsing output: 65/ for test: kms_cursor_crc results: parsing output: 66/ for test: syncobj_wait results: parsing output: 67/ for test: syncobj_timeline results: parsing output: 68/ for test: kms_frontbuffer_tracking results: parsing output: 69/ for test: syncobj_basic results: parsing output: 70/ for test: sysfs_preempt_timeout results: parsing output: 71/ for test: kms_pm_rpm results: parsing output: 72/ for test: kms_pipe_crc_basic results: parsing output: 73/ for test: kms_psr2_sf results: parsing output: 74/ for test: kms_frontbuffer_tracking results: parsing output: 75/ for test: kms_pm_backlight results: parsing output: 76/ for test: gem_ctx_persistence results: parsing output: 77/ for test: kms_ccs results: parsing output: 78/ for test: kms_chamelium_frames results: parsing output: 79/ for test: sw_sync results: parsing output: 80/ for test: kms_fbcon_fbt results: parsing output: 81/ for test: kms_plane_scaling results: no output, setting notrun results: parsing output: 82/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 83/ for test: gem_exec_schedule results: no output, setting notrun results: parsing output: 84/ for test: kms_psr2_sf results: no output, setting notrun results: parsing output: 85/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 86/ for test: gem_exec_whisper results: no output, setting notrun results: parsing output: 87/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 88/ for test: vgem_basic results: no output, setting notrun results: parsing output: 89/ for test: i915_pm_rps results: no output, setting notrun results: parsing output: 90/ for test: intel_hwmon results: no output, setting notrun results: parsing output: 91/ for test: api_intel_allocator results: no output, setting notrun results: parsing output: 92/ for test: gem_ctx_persistence results: no output, setting notrun results: parsing output: 93/ for test: kms_dsc results: no output, setting notrun results: parsing output: 94/ for test: gem_softpin results: no output, setting notrun results: parsing output: 95/ for test: kms_big_fb results: no output, setting notrun results: parsing output: 96/ for test: perf results: no output, setting notrun results: parsing output: 97/ for test: gem_eio results: no output, setting notrun results: parsing output: 98/ for test: kms_cursor_legacy results: no output, setting notrun results: parsing output: 99/ for test: kms_cursor_legacy results: no output, setting notrun results: parsing output: 100/ for test: kms_psr results: no output, setting notrun results: parsing output: 101/ for test: sw_sync results: no output, setting notrun results: parsing output: 102/ for test: kms_flip_scaled_crc results: no output, setting notrun results: parsing output: 103/ for test: kms_rotation_crc results: no output, setting notrun results: parsing output: 104/ for test: gem_render_copy results: no output, setting notrun results: parsing output: 105/ for test: kms_atomic_transition results: no output, setting notrun results: parsing output: 106/ for test: kms_psr results: no output, setting notrun results: parsing output: 107/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 108/ for test: kms_invalid_mode results: no output, setting notrun results: parsing output: 109/ for test: gem_readwrite results: no output, setting notrun results: parsing output: 110/ for test: kms_ccs results: no output, setting notrun results: parsing output: 111/ for test: kms_big_fb results: no output, setting notrun results: parsing output: 112/ for test: kms_plane_lowres results: no output, setting notrun results: parsing output: 113/ for test: gem_exec_params results: no output, setting notrun results: parsing output: 114/ for test: i915_hangman results: no output, setting notrun results: parsing output: 115/ for test: kms_content_protection results: no output, setting notrun results: parsing output: 116/ for test: core_getstats results: no output, setting notrun results: parsing output: 117/ for test: gen9_exec_parse results: no output, setting notrun results: parsing output: 118/ for test: i915_query results: no output, setting notrun results: parsing output: 119/ for test: kms_draw_crc results: no output, setting notrun results: parsing output: 120/ for test: kms_cursor_crc results: no output, setting notrun results: parsing output: 121/ for test: kms_cursor_legacy results: no output, setting notrun results: parsing output: 122/ for test: gem_exec_endless results: no output, setting notrun results: parsing output: 123/ for test: gem_lmem_swapping results: no output, setting notrun results: parsing output: 124/ for test: gem_pxp results: no output, setting notrun results: parsing output: 125/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 126/ for test: kms_atomic_interruptible results: no output, setting notrun results: parsing output: 127/ for test: gem_tiled_wb results: no output, setting notrun results: parsing output: 128/ for test: kms_flip results: no output, setting notrun results: parsing output: 129/ for test: kms_psr results: no output, setting notrun results: parsing output: 130/ for test: kms_flip results: no output, setting notrun results: parsing output: 131/ for test: gem_exec_reloc results: no output, setting notrun results: parsing output: 132/ for test: kms_cursor_legacy results: no output, setting notrun results: parsing output: 133/ for test: kms_psr results: no output, setting notrun Done.