[77.993748] Initializing watchdogs [77.993879] /dev/watchdog0 [78.013188] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:0102 Intel Sandybridge (Gen6) 2nd Generation Core Processor Family Integrated Graphics Controller (XPS 8300) [78.021476] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [78.025170] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [78.028234] [001/133] (960s left) gem_exec_whisper (basic-fds-all) [78.132943] Starting subtest: basic-fds-all [80.202276] Subtest basic-fds-all: SUCCESS (2.069s) [80.402276] [002/133] (958s left) syncobj_timeline (single-wait-all-for-submit-available-submitted) [80.461607] Starting subtest: single-wait-all-for-submit-available-submitted [80.462246] Subtest single-wait-all-for-submit-available-submitted: SUCCESS (0.001s) [80.555314] [003/133] (958s left) kms_plane_multiple (2x-tiling-x) [81.038015] Starting subtest: 2x-tiling-x [81.040207] Starting dynamic subtest: pipe-A-VGA-1-pipe-B-HDMI-A-1 [81.740068] Dynamic subtest pipe-A-VGA-1-pipe-B-HDMI-A-1: SUCCESS (0.700s) [81.784576] Starting dynamic subtest: pipe-A-HDMI-A-1-pipe-B-VGA-1 [82.587415] Dynamic subtest pipe-A-HDMI-A-1-pipe-B-VGA-1: SUCCESS (0.812s) [82.631876] Starting dynamic subtest: pipe-B-VGA-1-pipe-A-HDMI-A-1 [83.280440] Dynamic subtest pipe-B-VGA-1-pipe-A-HDMI-A-1: SUCCESS (0.658s) [83.308306] Starting dynamic subtest: pipe-B-HDMI-A-1-pipe-A-VGA-1 [84.108083] Dynamic subtest pipe-B-HDMI-A-1-pipe-A-VGA-1: SUCCESS (0.808s) [84.124494] Subtest 2x-tiling-x: SUCCESS (3.086s) [84.313958] [004/133] (954s left) gem_lmem_swapping (heavy-random) [84.383075] Subtest heavy-random: SKIP (0.000s) [84.434332] [005/133] (954s left) perf (blocking-parameterized) [84.564362] Subtest blocking-parameterized: SKIP (0.000s) [84.617617] [006/133] (954s left) gem_ppgtt (flink-and-close-vma-leak) [84.675315] Starting subtest: flink-and-close-vma-leak [84.676805] Subtest flink-and-close-vma-leak: SKIP (0.001s) [84.729935] [007/133] (954s left) gem_exec_schedule (pi-ringfull) [84.798930] Subtest pi-ringfull: SKIP (0.000s) [84.986208] [008/133] (953s left) kms_ccs (random-ccs-data-4-tiled-mtl-mc-ccs) [85.041288] Subtest random-ccs-data-4-tiled-mtl-mc-ccs: SKIP (0.000s) [85.099801] [009/133] (953s left) kms_dirtyfb (psr-dirtyfb-ioctl) [85.580049] Starting subtest: psr-dirtyfb-ioctl [85.585636] Subtest psr-dirtyfb-ioctl: SKIP (0.000s) [85.688074] [010/133] (953s left) kms_rotation_crc (primary-rotation-270) [86.176347] Starting subtest: primary-rotation-270 [86.178420] Subtest primary-rotation-270: SKIP (0.001s) [86.268974] [011/133] (952s left) kms_psr2_su (page_flip-p010) [86.326665] Subtest page_flip-P010: SKIP (0.000s) [86.385193] [012/133] (952s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-pwrite) [86.879460] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-pwrite [86.880933] Subtest psr-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s) [86.981298] [013/133] (952s left) gem_softpin (allocator-basic-reserve) [87.041880] Subtest allocator-basic-reserve: SKIP (0.000s) [87.184992] [014/133] (951s left) kms_atomic_transition (modeset-transition-nonblocking) [87.666347] Starting subtest: modeset-transition-nonblocking [87.667173] Starting dynamic subtest: 1x-outputs [88.497078] Dynamic subtest 1x-outputs: SUCCESS (0.830s) [88.507018] Starting dynamic subtest: 2x-outputs [90.680638] Dynamic subtest 2x-outputs: SUCCESS (2.182s) [90.681728] Subtest modeset-transition-nonblocking: SUCCESS (3.015s) [90.941325] [015/133] (948s left) gem_exec_schedule (u-fairslice) [91.012497] Subtest u-fairslice: SKIP (0.000s) [91.205887] [016/133] (948s left) kms_psr2_sf (pr-overlay-plane-move-continuous-sf) [91.688016] Subtest pr-overlay-plane-move-continuous-sf: SKIP (0.000s) [91.748320] [017/133] (947s left) kms_content_protection (srm) [92.254451] Starting subtest: srm [92.260806] Subtest srm: SKIP (0.006s) [92.359802] [018/133] (946s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-pwrite) [92.849529] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-pwrite [92.851145] Subtest psr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s) [92.957801] [019/133] (946s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted) [93.016399] Starting subtest: etime-multi-wait-for-submit-unsubmitted [93.123154] Subtest etime-multi-wait-for-submit-unsubmitted: SUCCESS (0.106s) [93.206554] [020/133] (946s left) kms_flip (2x-flip-vs-fences) [93.690616] Starting subtest: 2x-flip-vs-fences [93.692191] Starting dynamic subtest: AB-VGA1-HDMI-A1 [124.096919] Dynamic subtest AB-VGA1-HDMI-A1: SUCCESS (30.402s) [124.098698] Subtest 2x-flip-vs-fences: SUCCESS (30.405s) [124.380589] [021/133] (915s left) gem_set_tiling_vs_blt (untiled-to-tiled) [124.447706] Starting subtest: untiled-to-tiled [124.478139] Subtest untiled-to-tiled: SUCCESS (0.030s) [124.599480] [022/133] (914s left) gem_pxp (verify-pxp-stale-ctx-execution) [127.171266] Starting subtest: verify-pxp-stale-ctx-execution [127.172881] Subtest verify-pxp-stale-ctx-execution: SKIP (0.000s) [127.271467] [023/133] (912s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-32bpp-xtile-downscaling) [127.333412] Subtest flip-64bpp-xtile-to-32bpp-xtile-downscaling: SKIP (0.000s) [127.396318] [024/133] (912s left) prime_vgem (basic-fence-blt) [127.523241] Starting subtest: basic-fence-blt [127.612731] Subtest basic-fence-blt: SUCCESS (0.088s) [127.735841] [FACT prime_vgem (basic-fence-blt)] new: kernel.kmod_is_loaded.vgem: true [127.738707] [025/133] (911s left) gem_ctx_persistence (legacy-engines-queued) [127.797918] Subtest legacy-engines-queued: SKIP (0.000s) [127.867623] [026/133] (911s left) kms_ccs (bad-aux-stride-y-tiled-gen12-mc-ccs) [127.920803] Subtest bad-aux-stride-y-tiled-gen12-mc-ccs: SKIP (0.000s) [127.987794] [027/133] (911s left) api_intel_allocator (reopen) [128.042316] Starting subtest: reopen [128.047385] Subtest reopen: SUCCESS (0.006s) [128.163286] [028/133] (911s left) gem_exec_params (invalid-ring2) [128.222773] Starting subtest: invalid-ring2 [128.223480] Subtest invalid-ring2: SUCCESS (0.000s) [128.330422] [029/133] (911s left) i915_pm_rps (thresholds) [128.392365] Starting subtest: thresholds [128.393243] Starting dynamic subtest: gt0 [138.437597] Dynamic subtest gt0: SUCCESS (10.044s) [138.438913] Subtest thresholds: SUCCESS (10.045s) [138.540942] [030/133] (901s left) syncobj_timeline (invalid-multi-wait-unsubmitted-signaled) [138.610925] Starting subtest: invalid-multi-wait-unsubmitted-signaled [138.612363] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.001s) [138.709187] [031/133] (901s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-wc) [139.197693] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-wc [140.599652] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-wc: SUCCESS (1.401s) [140.818054] [032/133] (899s left) kms_cursor_edge_walk (64x64-left-edge) [141.303287] Starting subtest: 64x64-left-edge [141.304376] Starting dynamic subtest: pipe-A-VGA-1 [144.699215] Dynamic subtest pipe-A-VGA-1: SUCCESS (3.396s) [144.709904] Starting dynamic subtest: pipe-B-HDMI-A-1 [148.028780] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (3.329s) [148.029462] Subtest 64x64-left-edge: SUCCESS (6.727s) [148.273299] [033/133] (891s left) i915_pm_rc6_residency (rc6-idle) [148.336587] Starting subtest: rc6-idle [148.340296] Subtest rc6-idle: SKIP (0.004s) [148.438899] [034/133] (891s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip) [148.934016] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip [148.935723] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s) [149.038263] [035/133] (891s left) kms_frontbuffer_tracking (pipe-fbc-rte) [149.526488] Starting subtest: pipe-fbc-rte [149.528493] Starting dynamic subtest: pipe-B-VGA-1 [152.820238] Dynamic subtest pipe-B-VGA-1: SUCCESS (3.295s) [152.821618] Subtest pipe-fbc-rte: SUCCESS (3.296s) [153.166278] [036/133] (887s left) gen7_exec_parse (batch-without-end) [153.225967] Subtest batch-without-end: SKIP (0.000s) [153.291437] [037/133] (886s left) kms_cursor_crc (cursor-onscreen-128x42) [153.774399] Starting subtest: cursor-onscreen-128x42 [153.825917] Subtest cursor-onscreen-128x42: SKIP (0.050s) [153.975714] [038/133] (886s left) gem_eio (in-flight-contexts-immediate) [154.040970] Starting subtest: in-flight-contexts-immediate [159.060276] Subtest in-flight-contexts-immediate: SUCCESS (5.019s) [159.586998] [039/133] (880s left) kms_addfb_basic (size-max) [160.073690] Starting subtest: size-max [160.074717] Subtest size-max: SUCCESS (0.000s) [160.187342] [040/133] (880s left) perf (enable-disable) [160.322944] Subtest enable-disable: SKIP (0.000s) [160.380468] [041/133] (880s left) gem_exec_balancer (persistence) [160.440901] Subtest persistence: SKIP (0.000s) [160.536109] [042/133] (880s left) sysfs_preempt_timeout (timeout) [160.595108] Starting subtest: timeout [160.597197] Starting dynamic subtest: vcs0 [160.598854] Dynamic subtest vcs0: SKIP (0.000s) [160.611374] Starting dynamic subtest: bcs0 [160.613528] Dynamic subtest bcs0: SKIP (0.000s) [160.625411] Starting dynamic subtest: rcs0 [160.627450] Dynamic subtest rcs0: SKIP (0.000s) [160.629321] Subtest timeout: SKIP (0.003s) [160.685043] [043/133] (879s left) gem_exec_flush (basic-wb-rw-default) [160.752959] Starting subtest: basic-wb-rw-default [166.202292] Subtest basic-wb-rw-default: SUCCESS (5.449s) [166.409201] [044/133] (874s left) kms_flip (2x-modeset-vs-vblank-race-interruptible) [166.903632] Starting subtest: 2x-modeset-vs-vblank-race-interruptible [166.904296] Starting dynamic subtest: AB-VGA1-HDMI-A1 [177.598792] Dynamic subtest AB-VGA1-HDMI-A1: SUCCESS (10.694s) [177.603539] Subtest 2x-modeset-vs-vblank-race-interruptible: SUCCESS (10.698s) [177.858378] [045/133] (862s left) kms_lease (invalid-create-leases) [178.382541] Starting subtest: invalid-create-leases [178.387585] Subtest invalid-create-leases: SUCCESS (0.005s) [178.489957] [046/133] (862s left) kms_psr (fbc-pr-suspend) [178.968861] Subtest fbc-pr-suspend: SKIP (0.000s) [179.037304] [047/133] (861s left) gem_render_copy (y-tiled-mc-ccs-to-y-tiled-ccs) [179.108340] Starting subtest: y-tiled-mc-ccs-to-y-tiled-ccs [179.110801] Subtest y-tiled-mc-ccs-to-y-tiled-ccs: SKIP (0.000s) [179.319362] [048/133] (861s left) gem_exec_fence (syncobj-invalid-flags) [179.524925] Starting subtest: syncobj-invalid-flags [179.525752] Subtest syncobj-invalid-flags: SUCCESS (0.001s) [179.871162] [049/133] (861s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-async-flip) [180.355876] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-async-flip [180.959592] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SUCCESS (0.604s) [181.281600] [050/133] (859s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-modifier-source-clamping) [181.761627] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-modifier-source-clamping [181.763196] Subtest pixel-format-y-tiled-gen12-rc-ccs-modifier-source-clamping: SKIP (0.000s) [181.862428] [051/133] (859s left) kms_addfb_basic (addfb25-modifier-no-flag) [182.340589] Starting subtest: addfb25-modifier-no-flag [182.341425] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s) [182.461682] [052/133] (858s left) kms_ccs (crc-primary-rotation-180-4-tiled-dg2-rc-ccs) [182.522730] Subtest crc-primary-rotation-180-4-tiled-dg2-rc-ccs: SKIP (0.000s) [182.589191] [053/133] (858s left) gem_partial_pwrite_pread (reads-display) [182.647493] Starting subtest: reads-display [183.817863] Subtest reads-display: SUCCESS (1.169s) [183.944333] [054/133] (857s left) i915_drm_fdinfo (busy) [184.004710] Subtest busy: SKIP (0.000s) [184.071842] [055/133] (857s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc) [184.555854] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc [184.557401] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s) [184.669404] [056/133] (856s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-fullscreen) [185.150338] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-fullscreen [185.151875] Subtest fbcpsr-1p-primscrn-spr-indfb-fullscreen: SKIP (0.000s) [185.278711] [057/133] (856s left) kms_draw_crc (draw-method-blt) [185.758150] Starting subtest: draw-method-blt [185.758977] Starting dynamic subtest: xrgb8888-untiled [186.073453] Dynamic subtest xrgb8888-untiled: SUCCESS (0.314s) [186.087207] Starting dynamic subtest: rgb565-untiled [186.341506] Dynamic subtest rgb565-untiled: SUCCESS (0.266s) [186.355509] Starting dynamic subtest: xrgb2101010-untiled [186.608861] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.265s) [186.622892] Starting dynamic subtest: xbgr16161616f-untiled [186.893096] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.282s) [186.907541] Starting dynamic subtest: xrgb8888-xtiled [187.026951] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.131s) [187.042486] Starting dynamic subtest: rgb565-xtiled [187.160638] Dynamic subtest rgb565-xtiled: SUCCESS (0.131s) [187.175476] Starting dynamic subtest: xrgb2101010-xtiled [187.294290] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.131s) [187.308608] Starting dynamic subtest: xbgr16161616f-xtiled [187.444892] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.148s) [187.449382] Subtest draw-method-blt: SUCCESS (1.688s) [187.685740] [058/133] (853s left) kms_psr (psr2-primary-blt) [188.167486] Subtest psr2-primary-blt: SKIP (0.000s) [188.228549] [059/133] (853s left) kms_setmode (invalid-clone-exclusive-crtc) [188.284573] Starting subtest: invalid-clone-exclusive-crtc [188.484204] Subtest invalid-clone-exclusive-crtc: SKIP (0.198s) [188.739727] [060/133] (852s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs) [188.797054] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs: SKIP (0.000s) [188.862957] [061/133] (852s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-rc-ccs) [188.917150] Subtest ccs-on-another-bo-y-tiled-gen12-rc-ccs: SKIP (0.000s) [188.983254] [062/133] (852s left) gem_mmap (bad-offset) [189.039557] Starting subtest: bad-offset [189.040294] Subtest bad-offset: SUCCESS (0.000s) [189.152720] [063/133] (852s left) kms_panel_fitting (atomic-fastset) [189.631755] Starting subtest: atomic-fastset [189.633192] Subtest atomic-fastset: SKIP (0.000s) [189.726497] [064/133] (852s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip) [190.216174] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip [190.217594] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.000s) [190.323382] [065/133] (851s left) kms_flip (2x-flip-vs-suspend-interruptible) [190.808204] Starting subtest: 2x-flip-vs-suspend-interruptible [190.808867] Starting dynamic subtest: AB-VGA1-HDMI-A1 [394.842110] Per-test timeout exceeded. Killing the current test with SIGQUIT. [402.358774] Closing watchdogs [402.366184] Initializing watchdogs [402.366257] /dev/watchdog0 [402.394624] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:0102 Intel Sandybridge (Gen6) 2nd Generation Core Processor Family Integrated Graphics Controller (XPS 8300) [402.407203] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [402.408805] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [402.409542] [FACT before any test] new: kernel.kmod_is_loaded.vgem: true [402.413432] [066/133] (646s left) kms_async_flips (async-flip-with-page-flip-events-tiled) [402.923741] Starting subtest: async-flip-with-page-flip-events-tiled [403.159174] Starting dynamic subtest: pipe-A-VGA-1-x [405.256947] Dynamic subtest pipe-A-VGA-1-x: SUCCESS (2.097s) [405.383732] Starting dynamic subtest: pipe-A-HDMI-A-1-x [407.516577] Dynamic subtest pipe-A-HDMI-A-1-x: SUCCESS (2.145s) [407.678611] Starting dynamic subtest: pipe-B-VGA-1-x [409.777807] Dynamic subtest pipe-B-VGA-1-x: SUCCESS (2.116s) [409.884180] Starting dynamic subtest: pipe-B-HDMI-A-1-x [412.015721] Dynamic subtest pipe-B-HDMI-A-1-x: SUCCESS (2.145s) [412.024823] Subtest async-flip-with-page-flip-events-tiled: SUCCESS (9.094s) [412.404507] [067/133] (636s left) kms_psr (psr-primary-page-flip) [412.885576] Subtest psr-primary-page-flip: SKIP (0.000s) [412.951977] [068/133] (636s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip) [413.436585] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip [413.438461] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s) [413.553090] [069/133] (635s left) kms_cursor_legacy (basic-flip-after-cursor-legacy) [414.032555] Starting subtest: basic-flip-after-cursor-legacy [415.028578] Subtest basic-flip-after-cursor-legacy: SUCCESS (0.995s) [415.300696] [070/133] (633s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-signaled) [415.361549] Starting subtest: invalid-multi-wait-all-unsubmitted-signaled [415.362422] Subtest invalid-multi-wait-all-unsubmitted-signaled: SUCCESS (0.000s) [415.464444] [071/133] (633s left) kms_psr (fbc-psr2-sprite-plane-onoff) [415.942498] Subtest fbc-psr2-sprite-plane-onoff: SKIP (0.000s) [416.011124] [072/133] (633s left) kms_chamelium_hpd (hdmi-hpd) [416.616354] Subtest hdmi-hpd: SKIP (0.000s) [416.827307] [073/133] (632s left) kms_plane (pixel-format-yf-tiled-modifier-source-clamping) [417.303379] Starting subtest: pixel-format-yf-tiled-modifier-source-clamping [417.304952] Subtest pixel-format-yf-tiled-modifier-source-clamping: SKIP (0.000s) [417.401361] [074/133] (631s left) kms_chamelium_frames (dp-crc-multiple) [417.979514] Subtest dp-crc-multiple: SKIP (0.000s) [418.193111] [075/133] (631s left) gem_mmap_wc (read-write) [418.254177] Starting subtest: read-write [418.270631] Subtest read-write: SUCCESS (0.017s) [418.382473] [076/133] (631s left) gem_tiled_partial_pwrite_pread (writes) [418.441952] Starting subtest: writes [418.921202] Subtest writes: SUCCESS (0.479s) [419.050875] [077/133] (630s left) kms_vblank (query-forked-hang) [419.530226] Starting subtest: query-forked-hang [419.531062] Starting dynamic subtest: pipe-A-VGA-1 [425.733586] Dynamic subtest pipe-A-VGA-1: SUCCESS (6.202s) [425.749516] Starting dynamic subtest: pipe-A-HDMI-A-1 [431.732242] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (5.997s) [431.748770] Starting dynamic subtest: pipe-B-VGA-1 [437.707665] Dynamic subtest pipe-B-VGA-1: SUCCESS (5.972s) [437.728555] Starting dynamic subtest: pipe-B-HDMI-A-1 [443.753078] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (6.042s) [443.755371] Subtest query-forked-hang: SUCCESS (24.223s) [444.028538] [078/133] (605s left) sw_sync (sync_random_merge) [444.091532] Starting subtest: sync_random_merge [444.201774] Subtest sync_random_merge: SUCCESS (0.108s) [444.293362] [079/133] (605s left) kms_sequence (queue-idle) [444.770382] Starting subtest: queue-idle [444.772429] Starting dynamic subtest: pipe-A-VGA-1 [447.067751] Dynamic subtest pipe-A-VGA-1: SUCCESS (2.296s) [447.083507] Starting dynamic subtest: pipe-A-HDMI-A-1 [449.309749] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.239s) [449.325568] Starting dynamic subtest: pipe-B-VGA-1 [451.479507] Dynamic subtest pipe-B-VGA-1: SUCCESS (2.167s) [451.495360] Starting dynamic subtest: pipe-B-HDMI-A-1 [453.722863] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (2.240s) [453.723618] Subtest queue-idle: SUCCESS (8.952s) [453.985884] [080/133] (595s left) kms_color_pipeline (plane-ctm3x4) [454.469374] Starting subtest: plane-ctm3x4 [455.114694] Subtest plane-ctm3x4: SKIP (0.646s) [455.364447] [081/133] (594s left) gem_exec_schedule (fifo) [455.438406] Starting subtest: fifo [455.439260] Starting dynamic subtest: rcs0 [455.470247] Dynamic subtest rcs0: SUCCESS (0.031s) [455.487643] Starting dynamic subtest: bcs0 [455.502609] Dynamic subtest bcs0: SUCCESS (0.030s) [455.505898] Subtest fifo: SUCCESS (0.065s) [455.744664] [082/133] (594s left) gem_render_copy (y-tiled-ccs-to-linear) [455.813553] Starting subtest: y-tiled-ccs-to-linear [455.815617] Starting dynamic subtest: smem [455.816877] Dynamic subtest smem: SKIP (0.000s) [455.818115] Subtest y-tiled-ccs-to-linear: SKIP (0.003s) [456.025511] [083/133] (593s left) kms_flip (flip-vs-rmfb-interruptible) [456.506270] Starting subtest: flip-vs-rmfb-interruptible [456.508557] Starting dynamic subtest: A-VGA1 [464.289788] Dynamic subtest A-VGA1: SUCCESS (7.781s) [464.308144] Starting dynamic subtest: B-VGA1 [471.978178] Dynamic subtest B-VGA1: SUCCESS (7.685s) [471.993974] Starting dynamic subtest: A-HDMI-A1 [479.693976] Dynamic subtest A-HDMI-A1: SUCCESS (7.713s) [479.711288] Starting dynamic subtest: B-HDMI-A1 [487.429565] Dynamic subtest B-HDMI-A1: SUCCESS (7.732s) [487.432615] Subtest flip-vs-rmfb-interruptible: SUCCESS (30.924s) [487.624197] [084/133] (562s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt) [488.116884] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt [488.118299] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [488.228369] [085/133] (561s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-cpu) [488.720331] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-cpu [488.722382] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s) [488.826408] [086/133] (561s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-move) [489.307462] Starting subtest: fbc-2p-primscrn-cur-indfb-move [491.786289] Subtest fbc-2p-primscrn-cur-indfb-move: SUCCESS (2.478s) [491.954493] [087/133] (558s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-render) [492.441725] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-render [492.443291] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s) [492.560345] [088/133] (557s left) kms_atomic_transition (plane-all-transition-nonblocking) [493.033282] Starting subtest: plane-all-transition-nonblocking [493.035701] Starting dynamic subtest: pipe-A-VGA-1 [494.293131] Dynamic subtest pipe-A-VGA-1: SUCCESS (1.258s) [494.344967] Starting dynamic subtest: pipe-A-HDMI-A-1 [495.650842] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.319s) [495.751391] Starting dynamic subtest: pipe-B-VGA-1 [496.989906] Dynamic subtest pipe-B-VGA-1: SUCCESS (1.254s) [497.047557] Starting dynamic subtest: pipe-B-HDMI-A-1 [498.355320] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (1.323s) [498.439388] Subtest plane-all-transition-nonblocking: SUCCESS (5.406s) [498.707257] [089/133] (551s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-fullscreen) [499.198536] Starting subtest: psr-1p-primscrn-spr-indfb-fullscreen [499.200127] Subtest psr-1p-primscrn-spr-indfb-fullscreen: SKIP (0.000s) [499.315187] [090/133] (550s left) gem_eio (kms) [499.791037] Starting subtest: kms [504.620874] Subtest kms: SUCCESS (4.829s) [504.872247] [091/133] (545s left) gem_exec_balancer (full-late-pulse) [504.941823] Subtest full-late-pulse: SKIP (0.000s) [505.037325] [092/133] (545s left) api_intel_bb (intel-bb-blit-none) [505.102613] Starting subtest: intel-bb-blit-none [508.387177] Subtest intel-bb-blit-none: SUCCESS (3.284s) [508.514418] [093/133] (541s left) kms_pm_backlight (bad-brightness) [508.990107] Subtest bad-brightness: SKIP (0.000s) [509.057185] [094/133] (541s left) syncobj_basic (illegal-fd-to-handle) [509.115992] Starting subtest: illegal-fd-to-handle [509.116727] Subtest illegal-fd-to-handle: SUCCESS (0.000s) [509.212606] [095/133] (541s left) kms_flip (2x-flip-vs-dpms-off-vs-modeset-interruptible) [509.690433] Starting subtest: 2x-flip-vs-dpms-off-vs-modeset-interruptible [509.692653] Starting dynamic subtest: AB-VGA1-HDMI-A1 [511.317966] Dynamic subtest AB-VGA1-HDMI-A1: SUCCESS (1.625s) [511.318769] Subtest 2x-flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (1.628s) [511.593319] [096/133] (539s left) kms_flip (2x-flip-vs-modeset) [512.082642] Starting subtest: 2x-flip-vs-modeset [512.083929] Starting dynamic subtest: AB-VGA1-HDMI-A1 [514.484756] Dynamic subtest AB-VGA1-HDMI-A1: SUCCESS (2.400s) [514.485439] Subtest 2x-flip-vs-modeset: SUCCESS (2.403s) [514.746331] [097/133] (535s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-0) [515.242214] Starting subtest: linear-max-hw-stride-32bpp-rotate-0 [516.446069] Subtest linear-max-hw-stride-32bpp-rotate-0: SUCCESS (1.203s) [516.715031] [098/133] (533s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip) [517.206685] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip [517.208291] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.000s) [517.320818] [099/133] (533s left) syncobj_wait (invalid-reset-illegal-handle) [517.382098] Starting subtest: invalid-reset-illegal-handle [517.382922] Subtest invalid-reset-illegal-handle: SUCCESS (0.000s) [517.484149] [100/133] (533s left) kms_prop_blob (blob-prop-core) [517.541521] Starting subtest: blob-prop-core [517.542317] Subtest blob-prop-core: SUCCESS (0.000s) [517.633515] [101/133] (533s left) gem_ctx_exec (basic-invalid-context) [517.692489] Starting subtest: basic-invalid-context [517.695301] Subtest basic-invalid-context: SUCCESS (0.002s) [517.818437] [102/133] (533s left) gem_eio (execbuf) [517.881411] Starting subtest: execbuf [517.904763] Subtest execbuf: SUCCESS (0.023s) [518.420551] [103/133] (532s left) sw_sync (sync_merge) [518.478927] Starting subtest: sync_merge [518.479661] Subtest sync_merge: SUCCESS (0.000s) [518.570119] [104/133] (532s left) gem_ctx_param (invalid-param-get) [518.630287] Starting subtest: invalid-param-get [518.631305] Subtest invalid-param-get: SUCCESS (0.000s) [518.734546] [105/133] (532s left) gem_ctx_persistence (engines-hostile) [518.794596] Subtest engines-hostile: SKIP (0.000s) [518.865243] [106/133] (532s left) kms_cursor_crc (cursor-rapid-movement-max-size) [519.350137] Starting subtest: cursor-rapid-movement-max-size [519.352811] Subtest cursor-rapid-movement-max-size: SKIP (0.000s) [519.466433] [107/133] (531s left) kms_pm_rpm (pm-caching) [531.228635] Subtest pm-caching: SKIP (0.000s) [531.288741] [108/133] (519s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-wc) [531.778671] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-wc [533.697876] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (1.919s) [533.939647] [109/133] (517s left) kms_getfb (getfb-reject-nv12) [534.418436] Starting subtest: getfb-reject-nv12 [534.420039] Subtest getfb-reject-nv12: SKIP (0.000s) [534.540892] [110/133] (516s left) perf_pmu (busy-no-semaphores) [534.602539] Starting subtest: busy-no-semaphores [534.603499] Starting dynamic subtest: rcs0 [535.120834] Dynamic subtest rcs0: SUCCESS (0.519s) [535.138552] Starting dynamic subtest: bcs0 [535.643635] Dynamic subtest bcs0: SUCCESS (0.521s) [535.660231] Starting dynamic subtest: vcs0 [536.663008] Dynamic subtest vcs0: SUCCESS (1.018s) [536.663889] Subtest busy-no-semaphores: SUCCESS (2.063s) [536.785907] [111/133] (514s left) syncobj_timeline (multi-wait-available-submitted-signaled) [536.846191] Starting subtest: multi-wait-available-submitted-signaled [536.848421] Subtest multi-wait-available-submitted-signaled: SUCCESS (0.001s) [536.948571] [112/133] (514s left) gem_wait (wait) [537.022843] Starting subtest: wait [537.023605] Starting dynamic subtest: all-engines [538.043407] Dynamic subtest all-engines: SUCCESS (1.019s) [538.061433] Starting dynamic subtest: rcs0 [539.068263] Dynamic subtest rcs0: SUCCESS (1.021s) [539.085356] Starting dynamic subtest: bcs0 [540.088256] Dynamic subtest bcs0: SUCCESS (1.017s) [540.105107] Starting dynamic subtest: vcs0 [541.111364] Dynamic subtest vcs0: SUCCESS (1.020s) [541.115015] Subtest wait: SUCCESS (4.090s) [541.340917] [113/133] (510s left) kms_psr (fbc-psr-suspend) [541.820635] Subtest fbc-psr-suspend: SKIP (0.000s) [541.887374] [114/133] (509s left) kms_setmode (clone-exclusive-crtc) [541.947848] Starting subtest: clone-exclusive-crtc [542.106107] Starting dynamic subtest: pipe-A-VGA-1-pipe-B-HDMI-A-1 [542.338342] Dynamic subtest pipe-A-VGA-1-pipe-B-HDMI-A-1: SUCCESS (0.232s) [542.522941] Starting dynamic subtest: pipe-B-VGA-1-pipe-A-HDMI-A-1 [542.740527] Dynamic subtest pipe-B-VGA-1-pipe-A-HDMI-A-1: SUCCESS (0.230s) [542.870207] Subtest clone-exclusive-crtc: SUCCESS (0.923s) [543.143697] [115/133] (508s left) kms_cursor_legacy (nonblocking-modeset-vs-cursor-atomic) [543.627898] Starting subtest: nonblocking-modeset-vs-cursor-atomic [543.893178] Subtest nonblocking-modeset-vs-cursor-atomic: SUCCESS (0.266s) [544.153735] [116/133] (507s left) kms_big_fb (y-tiled-16bpp-rotate-0) [544.638604] Starting subtest: y-tiled-16bpp-rotate-0 [544.640112] Subtest y-tiled-16bpp-rotate-0: SKIP (0.000s) [544.756780] [117/133] (507s left) kms_joiner (invalid-modeset-force-big-joiner) [545.231389] Starting subtest: invalid-modeset-force-big-joiner [545.233078] Subtest invalid-modeset-force-big-joiner: SKIP (0.000s) [545.334142] [118/133] (506s left) i915_pm_freq_api (freq-reset) [545.394795] Subtest freq-reset: SKIP (0.000s) [545.463777] [119/133] (506s left) kms_flip (2x-plain-flip-ts-check-interruptible) [545.944892] Starting subtest: 2x-plain-flip-ts-check-interruptible [545.947120] Starting dynamic subtest: AB-VGA1-HDMI-A1 [576.600660] Dynamic subtest AB-VGA1-HDMI-A1: SUCCESS (30.653s) [576.604967] Subtest 2x-plain-flip-ts-check-interruptible: SUCCESS (30.657s) [576.879221] [120/133] (475s left) syncobj_wait (invalid-multi-wait-unsubmitted-submitted) [576.950089] Starting subtest: invalid-multi-wait-unsubmitted-submitted [576.950922] Subtest invalid-multi-wait-unsubmitted-submitted: SUCCESS (0.000s) [577.052309] [121/133] (474s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-render) [577.530893] Starting subtest: fbcpsr-rgb565-draw-render [577.532491] Subtest fbcpsr-rgb565-draw-render: SKIP (0.000s) [577.641173] [122/133] (474s left) gem_exec_params (sol-reset-invalid) [577.702373] Starting subtest: sol-reset-invalid [577.703237] Subtest sol-reset-invalid: SUCCESS (0.001s) [577.827295] [123/133] (474s left) core_setmaster (master-drop-set-root) [577.925969] Starting subtest: master-drop-set-root [577.955427] Subtest master-drop-set-root: SUCCESS (0.031s) [578.024294] [124/133] (474s left) gem_ccs (ctrl-surf-copy-new-ctx) [578.084057] Subtest ctrl-surf-copy-new-ctx: SKIP (0.000s) [578.151513] [125/133] (474s left) kms_addfb_basic (bad-pitch-256) [578.210398] Starting subtest: bad-pitch-256 [578.211218] Subtest bad-pitch-256: SUCCESS (0.000s) [578.743742] [126/133] (473s left) gem_mmap_wc (write-prefaulted) [578.803324] Starting subtest: write-prefaulted [578.954763] Subtest write-prefaulted: SUCCESS (0.152s) [579.060316] [127/133] (473s left) gem_mmap_offset (perf) [579.121852] Starting subtest: perf [579.123353] Starting dynamic subtest: smem0 [579.259630] Dynamic subtest smem0: SUCCESS (0.138s) [579.260617] Subtest perf: SUCCESS (0.140s) [579.401432] [128/133] (472s left) kms_pipe_stress (stress-xrgb8888-yftiled) [579.876449] Starting subtest: stress-xrgb8888-yftiled [579.877980] Subtest stress-xrgb8888-yftiled: SKIP (0.000s) [579.950157] [129/133] (472s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-msflip-blt) [580.435245] Starting subtest: fbc-2p-scndscrn-shrfb-msflip-blt [582.069449] Subtest fbc-2p-scndscrn-shrfb-msflip-blt: SUCCESS (1.633s) [582.219922] [130/133] (470s left) kms_frontbuffer_tracking (psr-rgb101010-draw-pwrite) [582.704071] Starting subtest: psr-rgb101010-draw-pwrite [582.705445] Subtest psr-rgb101010-draw-pwrite: SKIP (0.000s) [582.829658] [131/133] (469s left) kms_pm_dc (dc5-dpms) [593.938772] Subtest dc5-dpms: SKIP (0.000s) [594.013327] [132/133] (458s left) syncobj_timeline (etime-multi-wait-all-for-submit-submitted-signaled) [594.071903] Starting subtest: etime-multi-wait-all-for-submit-submitted-signaled [594.181818] Subtest etime-multi-wait-all-for-submit-submitted-signaled: SUCCESS (0.109s) [594.289923] [133/133] (458s left) gem_exec_parallel (fds) [594.359539] Starting subtest: fds [594.360360] Starting dynamic subtest: rcs0 [596.163143] Dynamic subtest rcs0: SUCCESS (1.801s) [596.179120] Starting dynamic subtest: bcs0 [597.958391] Dynamic subtest bcs0: SUCCESS (1.794s) [597.960108] Subtest fds: SUCCESS (3.600s) [598.180321] Closing watchdogs results: parsing output: 0/ for test: gem_exec_whisper results: parsing output: 1/ for test: syncobj_timeline results: parsing output: 2/ for test: kms_plane_multiple results: parsing output: 3/ for test: gem_lmem_swapping results: parsing output: 4/ for test: perf results: parsing output: 5/ for test: gem_ppgtt results: parsing output: 6/ for test: gem_exec_schedule results: parsing output: 7/ for test: kms_ccs results: parsing output: 8/ for test: kms_dirtyfb results: parsing output: 9/ for test: kms_rotation_crc results: parsing output: 10/ for test: kms_psr2_su results: parsing output: 11/ for test: kms_frontbuffer_tracking results: parsing output: 12/ for test: gem_softpin results: parsing output: 13/ for test: kms_atomic_transition results: parsing output: 14/ for test: gem_exec_schedule results: parsing output: 15/ for test: kms_psr2_sf results: parsing output: 16/ for test: kms_content_protection results: parsing output: 17/ for test: kms_frontbuffer_tracking results: parsing output: 18/ for test: syncobj_timeline results: parsing output: 19/ for test: kms_flip results: parsing output: 20/ for test: gem_set_tiling_vs_blt results: parsing output: 21/ for test: gem_pxp results: parsing output: 22/ for test: kms_flip_scaled_crc results: parsing output: 23/ for test: prime_vgem results: parsing output: 24/ for test: gem_ctx_persistence results: parsing output: 25/ for test: kms_ccs results: parsing output: 26/ for test: api_intel_allocator results: parsing output: 27/ for test: gem_exec_params results: parsing output: 28/ for test: i915_pm_rps results: parsing output: 29/ for test: syncobj_timeline results: parsing output: 30/ for test: kms_frontbuffer_tracking results: parsing output: 31/ for test: kms_cursor_edge_walk results: parsing output: 32/ for test: i915_pm_rc6_residency results: parsing output: 33/ for test: kms_big_fb results: parsing output: 34/ for test: kms_frontbuffer_tracking results: parsing output: 35/ for test: gen7_exec_parse results: parsing output: 36/ for test: kms_cursor_crc results: parsing output: 37/ for test: gem_eio results: parsing output: 38/ for test: kms_addfb_basic results: parsing output: 39/ for test: perf results: parsing output: 40/ for test: gem_exec_balancer results: parsing output: 41/ for test: sysfs_preempt_timeout results: parsing output: 42/ for test: gem_exec_flush results: parsing output: 43/ for test: kms_flip results: parsing output: 44/ for test: kms_lease results: parsing output: 45/ for test: kms_psr results: parsing output: 46/ for test: gem_render_copy results: parsing output: 47/ for test: gem_exec_fence results: parsing output: 48/ for test: kms_big_fb results: parsing output: 49/ for test: kms_plane results: parsing output: 50/ for test: kms_addfb_basic results: parsing output: 51/ for test: kms_ccs results: parsing output: 52/ for test: gem_partial_pwrite_pread results: parsing output: 53/ for test: i915_drm_fdinfo results: parsing output: 54/ for test: kms_frontbuffer_tracking results: parsing output: 55/ for test: kms_frontbuffer_tracking results: parsing output: 56/ for test: kms_draw_crc results: parsing output: 57/ for test: kms_psr results: parsing output: 58/ for test: kms_setmode results: parsing output: 59/ for test: kms_ccs results: parsing output: 60/ for test: kms_ccs results: parsing output: 61/ for test: gem_mmap results: parsing output: 62/ for test: kms_panel_fitting results: parsing output: 63/ for test: kms_big_fb results: parsing output: 64/ for test: kms_flip results: parsing output: 65/ for test: kms_async_flips results: parsing output: 66/ for test: kms_psr results: parsing output: 67/ for test: kms_big_fb results: parsing output: 68/ for test: kms_cursor_legacy results: parsing output: 69/ for test: syncobj_wait results: parsing output: 70/ for test: kms_psr results: parsing output: 71/ for test: kms_chamelium_hpd results: parsing output: 72/ for test: kms_plane results: parsing output: 73/ for test: kms_chamelium_frames results: parsing output: 74/ for test: gem_mmap_wc results: parsing output: 75/ for test: gem_tiled_partial_pwrite_pread results: parsing output: 76/ for test: kms_vblank results: parsing output: 77/ for test: sw_sync results: parsing output: 78/ for test: kms_sequence results: parsing output: 79/ for test: kms_color_pipeline results: parsing output: 80/ for test: gem_exec_schedule results: parsing output: 81/ for test: gem_render_copy results: parsing output: 82/ for test: kms_flip results: parsing output: 83/ for test: kms_frontbuffer_tracking results: parsing output: 84/ for test: kms_frontbuffer_tracking results: parsing output: 85/ for test: kms_frontbuffer_tracking results: parsing output: 86/ for test: kms_frontbuffer_tracking results: parsing output: 87/ for test: kms_atomic_transition results: parsing output: 88/ for test: kms_frontbuffer_tracking results: parsing output: 89/ for test: gem_eio results: parsing output: 90/ for test: gem_exec_balancer results: parsing output: 91/ for test: api_intel_bb results: parsing output: 92/ for test: kms_pm_backlight results: parsing output: 93/ for test: syncobj_basic results: parsing output: 94/ for test: kms_flip results: parsing output: 95/ for test: kms_flip results: parsing output: 96/ for test: kms_big_fb results: parsing output: 97/ for test: kms_big_fb results: parsing output: 98/ for test: syncobj_wait results: parsing output: 99/ for test: kms_prop_blob results: parsing output: 100/ for test: gem_ctx_exec results: parsing output: 101/ for test: gem_eio results: parsing output: 102/ for test: sw_sync results: parsing output: 103/ for test: gem_ctx_param results: parsing output: 104/ for test: gem_ctx_persistence results: parsing output: 105/ for test: kms_cursor_crc results: parsing output: 106/ for test: kms_pm_rpm results: parsing output: 107/ for test: kms_frontbuffer_tracking results: parsing output: 108/ for test: kms_getfb results: parsing output: 109/ for test: perf_pmu results: parsing output: 110/ for test: syncobj_timeline results: parsing output: 111/ for test: gem_wait results: parsing output: 112/ for test: kms_psr results: parsing output: 113/ for test: kms_setmode results: parsing output: 114/ for test: kms_cursor_legacy results: parsing output: 115/ for test: kms_big_fb results: parsing output: 116/ for test: kms_joiner results: parsing output: 117/ for test: i915_pm_freq_api results: parsing output: 118/ for test: kms_flip results: parsing output: 119/ for test: syncobj_wait results: parsing output: 120/ for test: kms_frontbuffer_tracking results: parsing output: 121/ for test: gem_exec_params results: parsing output: 122/ for test: core_setmaster results: parsing output: 123/ for test: gem_ccs results: parsing output: 124/ for test: kms_addfb_basic results: parsing output: 125/ for test: gem_mmap_wc results: parsing output: 126/ for test: gem_mmap_offset results: parsing output: 127/ for test: kms_pipe_stress results: parsing output: 128/ for test: kms_frontbuffer_tracking results: parsing output: 129/ for test: kms_frontbuffer_tracking results: parsing output: 130/ for test: kms_pm_dc results: parsing output: 131/ for test: syncobj_timeline results: parsing output: 132/ for test: gem_exec_parallel Done.