Lines Matching refs:idle
817 <idle>-0 [001] dNs4 21169.031481: wake_up_idle_cpu <-add_timer_on
818 <idle>-0 [001] dNs4 21169.031482: _raw_spin_unlock_irqrestore <-add_timer_on
819 <idle>-0 [001] .Ns4 21169.031484: sub_preempt_count <-_raw_spin_unlock_irqrestore
821 <idle>-0 [002] .N.1 21169.031484: rcu_idle_exit <-cpu_idle
822 <idle>-0 [001] .Ns3 21169.031484: _raw_spin_unlock <-clocksource_watchdog
823 <idle>-0 [001] .Ns3 21169.031485: sub_preempt_count <-_raw_spin_unlock
891 <idle>-0 [002] 23636.756054: ttwu_do_activate.constprop.89 <-try_to_wake_up
892 <idle>-0 [002] 23636.756054: activate_task <-ttwu_do_activate.constprop.89
893 <idle>-0 [002] 23636.756055: enqueue_task <-activate_task
958 <idle>-0 0d.s2 0us+: _raw_spin_lock_irq <-run_timer_softirq
959 <idle>-0 0dNs3 17us : _raw_spin_unlock_irq <-run_timer_softirq
960 <idle>-0 0dNs3 17us+: trace_hardirqs_on <-run_timer_softirq
961 <idle>-0 0dNs3 25us : <stack trace>
1420 <idle>-0 3dNs7 0us : 0:120:R + [003] 312:100:R kworker/3:1H
1421 <idle>-0 3dNs7 1us+: ttwu_do_activate.constprop.87 <-try_to_wake_up
1422 <idle>-0 3d..3 15us : __schedule <-schedule
1423 <idle>-0 3d..3 15us : 0:120:R ==> [003] 312:100:R kworker/3:1H
1488 <idle>-0 3d.h4 0us : 0:120:R + [003] 2389: 94:R sleep
1489 <idle>-0 3d.h4 1us+: ttwu_do_activate.constprop.87 <-try_to_wake_up
1490 <idle>-0 3d..3 5us : __schedule <-schedule
1491 <idle>-0 3d..3 5us : 0:120:R ==> [003] 2389: 94:R sleep
1494 Running this on an idle system, we see that it only took 5 microseconds
1507 <idle>-0 3d..3 5us : 0:120:R ==> [003] 2389: 94:R sleep
1509 The 0:120:R means idle was running with a nice priority of 0 (120 - 20)
1535 <idle>-0 3d.h4 1us+: 0:120:R + [003] 2448: 94:R sleep
1536 <idle>-0 3d.h4 2us : ttwu_do_activate.constprop.87 <-try_to_wake_up
1537 <idle>-0 3d.h3 3us : check_preempt_curr <-ttwu_do_wakeup
1538 <idle>-0 3d.h3 3us : resched_curr <-check_preempt_curr
1539 <idle>-0 3dNh3 4us : task_woken_rt <-ttwu_do_wakeup
1540 <idle>-0 3dNh3 4us : _raw_spin_unlock <-try_to_wake_up
1541 <idle>-0 3dNh3 4us : sub_preempt_count <-_raw_spin_unlock
1542 <idle>-0 3dNh2 5us : ttwu_stat <-try_to_wake_up
1543 <idle>-0 3dNh2 5us : _raw_spin_unlock_irqrestore <-try_to_wake_up
1544 <idle>-0 3dNh2 6us : sub_preempt_count <-_raw_spin_unlock_irqrestore
1545 <idle>-0 3dNh1 6us : _raw_spin_lock <-__run_hrtimer
1546 <idle>-0 3dNh1 6us : add_preempt_count <-_raw_spin_lock
1547 <idle>-0 3dNh2 7us : _raw_spin_unlock <-hrtimer_interrupt
1548 <idle>-0 3dNh2 7us : sub_preempt_count <-_raw_spin_unlock
1549 <idle>-0 3dNh1 7us : tick_program_event <-hrtimer_interrupt
1550 <idle>-0 3dNh1 7us : clockevents_program_event <-tick_program_event
1551 <idle>-0 3dNh1 8us : ktime_get <-clockevents_program_event
1552 <idle>-0 3dNh1 8us : lapic_next_event <-clockevents_program_event
1553 <idle>-0 3dNh1 8us : irq_exit <-smp_apic_timer_interrupt
1554 <idle>-0 3dNh1 9us : sub_preempt_count <-irq_exit
1555 <idle>-0 3dN.2 9us : idle_cpu <-irq_exit
1556 <idle>-0 3dN.2 9us : rcu_irq_exit <-irq_exit
1557 <idle>-0 3dN.2 10us : rcu_eqs_enter_common.isra.45 <-rcu_irq_exit
1558 <idle>-0 3dN.2 10us : sub_preempt_count <-irq_exit
1559 <idle>-0 3.N.1 11us : rcu_idle_exit <-cpu_idle
1560 <idle>-0 3dN.1 11us : rcu_eqs_exit_common.isra.43 <-rcu_idle_exit
1561 <idle>-0 3.N.1 11us : tick_nohz_idle_exit <-cpu_idle
1562 <idle>-0 3dN.1 12us : menu_hrtimer_cancel <-tick_nohz_idle_exit
1563 <idle>-0 3dN.1 12us : ktime_get <-tick_nohz_idle_exit
1564 <idle>-0 3dN.1 12us : tick_do_update_jiffies64 <-tick_nohz_idle_exit
1565 <idle>-0 3dN.1 13us : update_cpu_load_nohz <-tick_nohz_idle_exit
1566 <idle>-0 3dN.1 13us : _raw_spin_lock <-update_cpu_load_nohz
1567 <idle>-0 3dN.1 13us : add_preempt_count <-_raw_spin_lock
1568 <idle>-0 3dN.2 13us : __update_cpu_load <-update_cpu_load_nohz
1569 <idle>-0 3dN.2 14us : sched_avg_update <-__update_cpu_load
1570 <idle>-0 3dN.2 14us : _raw_spin_unlock <-update_cpu_load_nohz
1571 <idle>-0 3dN.2 14us : sub_preempt_count <-_raw_spin_unlock
1572 <idle>-0 3dN.1 15us : calc_load_exit_idle <-tick_nohz_idle_exit
1573 <idle>-0 3dN.1 15us : touch_softlockup_watchdog <-tick_nohz_idle_exit
1574 <idle>-0 3dN.1 15us : hrtimer_cancel <-tick_nohz_idle_exit
1575 <idle>-0 3dN.1 15us : hrtimer_try_to_cancel <-hrtimer_cancel
1576 <idle>-0 3dN.1 16us : lock_hrtimer_base.isra.18 <-hrtimer_try_to_cancel
1577 <idle>-0 3dN.1 16us : _raw_spin_lock_irqsave <-lock_hrtimer_base.isra.18
1578 <idle>-0 3dN.1 16us : add_preempt_count <-_raw_spin_lock_irqsave
1579 <idle>-0 3dN.2 17us : __remove_hrtimer <-remove_hrtimer.part.16
1580 <idle>-0 3dN.2 17us : hrtimer_force_reprogram <-__remove_hrtimer
1581 <idle>-0 3dN.2 17us : tick_program_event <-hrtimer_force_reprogram
1582 <idle>-0 3dN.2 18us : clockevents_program_event <-tick_program_event
1583 <idle>-0 3dN.2 18us : ktime_get <-clockevents_program_event
1584 <idle>-0 3dN.2 18us : lapic_next_event <-clockevents_program_event
1585 <idle>-0 3dN.2 19us : _raw_spin_unlock_irqrestore <-hrtimer_try_to_cancel
1586 <idle>-0 3dN.2 19us : sub_preempt_count <-_raw_spin_unlock_irqrestore
1587 <idle>-0 3dN.1 19us : hrtimer_forward <-tick_nohz_idle_exit
1588 <idle>-0 3dN.1 20us : ktime_add_safe <-hrtimer_forward
1589 <idle>-0 3dN.1 20us : ktime_add_safe <-hrtimer_forward
1590 <idle>-0 3dN.1 20us : hrtimer_start_range_ns <-hrtimer_start_expires.constprop.11
1591 <idle>-0 3dN.1 20us : __hrtimer_start_range_ns <-hrtimer_start_range_ns
1592 <idle>-0 3dN.1 21us : lock_hrtimer_base.isra.18 <-__hrtimer_start_range_ns
1593 <idle>-0 3dN.1 21us : _raw_spin_lock_irqsave <-lock_hrtimer_base.isra.18
1594 <idle>-0 3dN.1 21us : add_preempt_count <-_raw_spin_lock_irqsave
1595 <idle>-0 3dN.2 22us : ktime_add_safe <-__hrtimer_start_range_ns
1596 <idle>-0 3dN.2 22us : enqueue_hrtimer <-__hrtimer_start_range_ns
1597 <idle>-0 3dN.2 22us : tick_program_event <-__hrtimer_start_range_ns
1598 <idle>-0 3dN.2 23us : clockevents_program_event <-tick_program_event
1599 <idle>-0 3dN.2 23us : ktime_get <-clockevents_program_event
1600 <idle>-0 3dN.2 23us : lapic_next_event <-clockevents_program_event
1601 <idle>-0 3dN.2 24us : _raw_spin_unlock_irqrestore <-__hrtimer_start_range_ns
1602 <idle>-0 3dN.2 24us : sub_preempt_count <-_raw_spin_unlock_irqrestore
1603 <idle>-0 3dN.1 24us : account_idle_ticks <-tick_nohz_idle_exit
1604 <idle>-0 3dN.1 24us : account_idle_time <-account_idle_ticks
1605 <idle>-0 3.N.1 25us : sub_preempt_count <-cpu_idle
1606 <idle>-0 3.N.. 25us : schedule <-cpu_idle
1607 <idle>-0 3.N.. 25us : __schedule <-preempt_schedule
1608 <idle>-0 3.N.. 26us : add_preempt_count <-__schedule
1609 <idle>-0 3.N.1 26us : rcu_note_context_switch <-__schedule
1610 <idle>-0 3.N.1 26us : rcu_sched_qs <-rcu_note_context_switch
1611 <idle>-0 3dN.1 27us : rcu_preempt_qs <-rcu_note_context_switch
1612 <idle>-0 3.N.1 27us : _raw_spin_lock_irq <-__schedule
1613 <idle>-0 3dN.1 27us : add_preempt_count <-_raw_spin_lock_irq
1614 <idle>-0 3dN.2 28us : put_prev_task_idle <-__schedule
1615 <idle>-0 3dN.2 28us : pick_next_task_stop <-pick_next_task
1616 <idle>-0 3dN.2 28us : pick_next_task_rt <-pick_next_task
1617 <idle>-0 3dN.2 29us : dequeue_pushable_task <-pick_next_task_rt
1618 <idle>-0 3d..3 29us : __schedule <-preempt_schedule
1619 <idle>-0 3d..3 30us : 0:120:R ==> [003] 2448: 94:R sleep
1624 The interrupt went off while when the system was idle. Somewhere
1660 <idle>-0 2d.h4 0us : 0:120:R + [002] 5882: 94:R sleep
1661 <idle>-0 2d.h4 0us : ttwu_do_activate.constprop.87 <-try_to_wake_up
1662 <idle>-0 2d.h4 1us : sched_wakeup: comm=sleep pid=5882 prio=94 success=1 target_cpu=002
1663 <idle>-0 2dNh2 1us : hrtimer_expire_exit: hrtimer=ffff88007796feb8
1664 <idle>-0 2.N.2 2us : power_end: cpu_id=2
1665 <idle>-0 2.N.2 3us : cpu_idle: state=4294967295 cpu_id=2
1666 <idle>-0 2dN.3 4us : hrtimer_cancel: hrtimer=ffff88007d50d5e0
1667 …<idle>-0 2dN.3 4us : hrtimer_start: hrtimer=ffff88007d50d5e0 function=tick_sched_timer ex…
1668 <idle>-0 2.N.2 5us : rcu_utilization: Start context switch
1669 <idle>-0 2.N.2 5us : rcu_utilization: End context switch
1670 <idle>-0 2d..3 6us : __schedule <-schedule
1671 <idle>-0 2d..3 6us : 0:120:R ==> [002] 5882: 94:R sleep
2195 <idle>-0 [001] d.h1 4186.475409: hrtimer_interrupt <-smp_apic_timer_interrupt
2197 <idle>-0 [003] d.h1 4186.475426: hrtimer_interrupt <-smp_apic_timer_interrupt
2198 <idle>-0 [002] d.h1 4186.475427: hrtimer_interrupt <-smp_apic_timer_interrupt
2237 <idle>-0 [003] dN.1 4228.547803: hrtimer_cancel <-tick_nohz_idle_exit
2238 <idle>-0 [003] dN.1 4228.547804: hrtimer_try_to_cancel <-hrtimer_cancel
2239 <idle>-0 [003] dN.2 4228.547805: hrtimer_force_reprogram <-__remove_hrtimer
2240 <idle>-0 [003] dN.1 4228.547805: hrtimer_forward <-tick_nohz_idle_exit
2241 … <idle>-0 [003] dN.1 4228.547805: hrtimer_start_range_ns <-hrtimer_start_expires.constprop.11
2242 <idle>-0 [003] d..1 4228.547858: hrtimer_get_next_event <-get_next_timer_interrupt
2243 <idle>-0 [003] d..1 4228.547859: hrtimer_start <-__tick_nohz_idle_enter
2244 <idle>-0 [003] d..2 4228.547860: hrtimer_force_reprogram <-__rem
2684 …<idle>-0 [005] d... 2440.603828: sched_switch: prev_comm=swapper/5 prev_pid=0 prev_prio=120 p…
2687 …<idle>-0 [002] d... 2440.707230: sched_switch: prev_comm=swapper/2 prev_pid=0 prev_prio=120 p…
2701 …<idle>-0 [007] d... 2440.707395: sched_switch: prev_comm=swapper/7 prev_pid=0 prev_prio=120 p…
2777 …<idle>-0 [003] d.h3 136.676906: sched_wakeup: comm=rcu_preempt pid=9 prio=120 success=1 targ…
2778 …<idle>-0 [003] d..3 136.676909: sched_switch: prev_comm=swapper/3 prev_pid=0 prev_prio=120 p…
2789 <idle>-0 [001] dNh3 138.732725: softirq_raise: vec=3 [action=NET_RX]