Go
Profilazione usando go tool pprof

Osservazioni

CPU di base e profilo di memoria

Aggiungi il seguente codice nel tuo programma principale.

var cpuprofile = flag.String("cpuprofile", "", "write cpu profile `file`")
var memprofile = flag.String("memprofile", "", "write memory profile to `file`")

func main() {
    flag.Parse()
    if *cpuprofile != "" {
        f, err := os.Create(*cpuprofile)
        if err != nil {
            log.Fatal("could not create CPU profile: ", err)
        }
        if err := pprof.StartCPUProfile(f); err != nil {
            log.Fatal("could not start CPU profile: ", err)
        }
        defer pprof.StopCPUProfile()
    }
    ...
    if *memprofile != "" {
        f, err := os.Create(*memprofile)
        if err != nil {
            log.Fatal("could not create memory profile: ", err)
        }
        runtime.GC() // get up-to-date statistics
        if err := pprof.WriteHeapProfile(f); err != nil {
            log.Fatal("could not write memory profile: ", err)
        }
        f.Close()
    }
}

dopo di ciò costruisci il programma go se aggiunto in main go build main.go Eseguire il programma principale con flag definiti nel codice main.exe -cpuprofile cpu.prof -memprof mem.prof . Se la profilazione viene eseguita per i casi di test, eseguire i test con gli stessi flag go test -cpuprofile cpu.prof -memprofile mem.prof

Profiling di memoria di base

var memprofile = flag.String("memprofile", "", "write memory profile to `file`")

func main() {
    flag.Parse()
    if *memprofile != "" {
        f, err := os.Create(*memprofile)
        if err != nil {
            log.Fatal("could not create memory profile: ", err)
        }
        runtime.GC() // get up-to-date statistics
        if err := pprof.WriteHeapProfile(f); err != nil {
            log.Fatal("could not write memory profile: ", err)
        }
        f.Close()
    }
}

go build main.go
main.exe -memprofile mem.prof
go tool pprof main.exe mem.prof

Imposta la velocità del profilo CPU / blocco

// Sets the CPU profiling rate to hz samples per second
// If hz <= 0, SetCPUProfileRate turns off profiling
runtime.SetCPUProfileRate(hz) 

// Controls the fraction of goroutine blocking events that are reported in the blocking profile
// Rate = 1 includes every blocking event in the profile
// Rate <= 0 turns off profiling
runtime.SetBlockProfileRate(rate)

Utilizzo dei benchmark per creare un profilo

Per i pacchetti non principali e principali, invece di aggiungere i flag all'interno del codice , scrivere benchmark nel pacchetto di test, ad esempio:

func BenchmarkHello(b *testing.B) {
    for i := 0; i < b.N; i++ {
        fmt.Sprintf("hello")
    }
}

Quindi esegui il test con il flag del profilo

vai test -cpuprofile cpu.prof -bench =.

E i benchmark verranno eseguiti e creare un file prof con nome file cpu.prof (nell'esempio precedente).

Accesso al file di profilo

una volta generato un file prof, è possibile accedere al file prof usando gli strumenti go :

go tool pprof cpu.prof

Questo entrerà in un'interfaccia a riga di comando per esplorare il profile

I comandi più comuni includono:

(pprof) top

elenca i processi più importanti in memoria

(pprof) peek

Elenca tutti i processi, usa regex per restringere la ricerca.

(pprof) web

Apre un grafico (in formato svg) del processo.

Un esempio del comando in top :

69.29s of 100.84s total (68.71%)
Dropped 176 nodes (cum <= 0.50s)
Showing top 10 nodes out of 73 (cum >= 12.03s)
      flat  flat%   sum%        cum   cum%
    12.44s 12.34% 12.34%     27.87s 27.64%  runtime.mapaccess1
    10.94s 10.85% 23.19%     10.94s 10.85%  runtime.duffcopy
     9.45s  9.37% 32.56%     54.61s 54.16%  github.com/tester/test.(*Circle).Draw
     8.88s  8.81% 41.36%      8.88s  8.81%  runtime.aeshashbody
     7.90s  7.83% 49.20%     11.04s 10.95%  runtime.mapaccess1_fast64
     5.86s  5.81% 55.01%      9.59s  9.51%  github.com/tester/test.(*Circle).isCircle
     5.03s  4.99% 60.00%      8.89s  8.82%  github.com/tester/test.(*Circle).openCircle
     3.14s  3.11% 63.11%      3.14s  3.11%  runtime.aeshash64
     3.08s  3.05% 66.16%      7.85s  7.78%  runtime.mallocgc
     2.57s  2.55% 68.71%     12.03s 11.93%  runtime.memhash