Profiling results ----------------- Total cpu time observed: 15442ms (out of 15620ms) Number of samples taken: 68 (once every 227ms) ====================================================================== Caller Idx Total Self Name+src Local% ms(pct) ms(pct) Callee ====================================================================== [1] 15442(100.0%) 0(0.0%) ??? ...lects/racket/private/more-scheme.rkt:261:28 profile-thunk16 [3] 100.0% ---------------------------------------------------------------------- hash-ref! [32] 100.0% [2] 2642(17.1%) 0(0.0%) ??? ...htlies/herbie/master/src/programs.rkt:161:5 loop [18] 100.0% ---------------------------------------------------------------------- ??? [1] 100.0% [3] 15442(100.0%) 0(0.0%) profile-thunk16 ...e/pkgs/profile-lib/main.rkt:9:0 run [4] 100.0% ---------------------------------------------------------------------- profile-thunk16 [3] 100.0% [4] 15442(100.0%) 0(0.0%) run ...et-7.5/share/pkgs/profile-lib/main.rkt:39:2 .../more-scheme.rkt:261:28 [5] 100.0% ---------------------------------------------------------------------- run [4] 100.0% [5] 15442(100.0%) 0(0.0%) .../more-scheme.rkt:261:28 (unknown source) loop [8] 81.0% run-improve47 [6] 16.3% errors [29] 1.4% eval-errors [7] 1.3% ---------------------------------------------------------------------- .../more-scheme.rkt:261:28 [5] 100.0% [6] 2512(16.3%) 0(0.0%) run-improve47 ...bie/master/src/mainloop.rkt:346:0 loop [8] 52.9% for-loop [9] 37.5% simplify! [15] 9.6% ---------------------------------------------------------------------- .../more-scheme.rkt:261:28 [5] 100.0% [7] 208(1.3%) 0(0.0%) eval-errors .../herbie/master/src/points.rkt:179:0 for-loop [10] 100.0% ---------------------------------------------------------------------- run-improve47 [6] 9.6% .../more-scheme.rkt:261:28 [5] 90.4% [8] 13836(89.6%) 0(0.0%) loop ...ghtlies/herbie/master/src/points.rkt:277:2 loop [11] 46.3% make-exacts-walkup [13] 29.2% loop [14] 24.5% ---------------------------------------------------------------------- run-improve47 [6] 100.0% [9] 942(6.1%) 0(0.0%) for-loop ...s/herbie/master/src/mainloop.rkt:365:4 run-iter! [12] 100.0% ---------------------------------------------------------------------- eval-errors [7] 100.0% [10] 208(1.3%) 208(1.3%) for-loop ...ies/herbie/master/src/points.rkt:181:2 ---------------------------------------------------------------------- loop [8] 100.0% [11] 6412(41.5%) 0(0.0%) loop ...ghtlies/herbie/master/src/points.rkt:240:2 make-exacts-walkup [13] 66.1% loop [14] 33.9% ---------------------------------------------------------------------- for-loop [9] 100.0% [12] 942(6.1%) 0(0.0%) run-iter! .../herbie/master/src/mainloop.rkt:327:0 simplify! [15] 56.1% localize! [16] 22.5% finalize-iter! [17] 21.4% ---------------------------------------------------------------------- loop [8] 48.8% loop [11] 51.2% [13] 8280(53.6%) 0(0.0%) make-exacts-walkup .../master/src/points.rkt:218:0 loop [18] 65.1% eval-prog [31] 34.9% ---------------------------------------------------------------------- loop [11] 39.1% loop [8] 60.9% [14] 5556(36.0%) 0(0.0%) loop ...ghtlies/herbie/master/src/points.rkt:223:4 loop [18] 100.0% ---------------------------------------------------------------------- run-improve47 [6] 31.2% run-iter! [12] 68.8% [15] 768(5.0%) 0(0.0%) simplify! .../herbie/master/src/mainloop.rkt:224:0 egraph-run [19] 100.0% ---------------------------------------------------------------------- run-iter! [12] 100.0% [16] 212(1.4%) 0(0.0%) localize! .../herbie/master/src/mainloop.rkt:127:0 localize-error [20] 100.0% ---------------------------------------------------------------------- run-iter! [12] 100.0% [17] 202(1.3%) 0(0.0%) finalize-iter! ...ie/master/src/mainloop.rkt:278:0 ??? [21] 100.0% ---------------------------------------------------------------------- loop [14] 0.3% make-exacts-walkup [13] 0.3% ??? [2] 19.4% loop [18] 80.0% [18] 13588(88.0%) 0(0.0%) loop (unknown source) loop [18] 80.0% hash-ref! [32] 19.4% composed [22] 0.6% ---------------------------------------------------------------------- simplify! [15] 100.0% [19] 768(5.0%) 0(0.0%) egraph-run ...bie/master/src/core/eggmath.rkt:51:0 egraph-add-exprs [23] 100.0% ---------------------------------------------------------------------- localize! [16] 100.0% [20] 212(1.4%) 0(0.0%) localize-error ...aster/src/core/localize.rkt:66:0 hash-ref! [32] 100.0% ---------------------------------------------------------------------- finalize-iter! [17] 100.0% [21] 202(1.3%) 0(0.0%) ??? ...contract/private/arrow-val-first.rkt:486:18 for-loop [24] 100.0% ---------------------------------------------------------------------- loop [18] 100.0% [22] 10946(70.9%) 0(0.0%) composed ...ollects/racket/private/list.rkt:321:16 ??? [25] 100.0% ---------------------------------------------------------------------- egraph-run [19] 100.0% [23] 768(5.0%) 0(0.0%) egraph-add-exprs ...ter/src/core/eggmath.rkt:113:0 ??? [26] 100.0% ---------------------------------------------------------------------- ??? [21] 100.0% [24] 202(1.3%) 0(0.0%) for-loop ...bie/master/src/core/alt-table.rkt:55:2 atab-add-altn [27] 100.0% ---------------------------------------------------------------------- composed [22] 100.0% [25] 10946(70.9%) 466(3.0%) ??? ...htlies/herbie/master/src/programs.rkt:115:2 ??? [42] 87.1% ??? [50] 6.4% ??? [30] 2.2% ---------------------------------------------------------------------- egraph-add-exprs [23] 100.0% [26] 768(5.0%) 0(0.0%) ??? ...es/herbie/master/src/core/simplify.rkt:72:6 for-loop [28] 100.0% ---------------------------------------------------------------------- for-loop [24] 100.0% [27] 202(1.3%) 0(0.0%) atab-add-altn ...ster/src/core/alt-table.rkt:203:0 errors [29] 100.0% ---------------------------------------------------------------------- ??? [26] 100.0% [28] 768(5.0%) 768(5.0%) for-loop ...rbie/master/src/core/simplify.rkt:91:2 ---------------------------------------------------------------------- atab-add-altn [27] 48.3% .../more-scheme.rkt:261:28 [5] 51.7% [29] 418(2.7%) 0(0.0%) errors ...tlies/herbie/master/src/points.rkt:201:0 eval-prog [31] 100.0% ---------------------------------------------------------------------- ??? [25] 100.0% [30] 238(1.5%) 238(1.5%) ??? ...tract/private/arrow-higher-order.rkt:375:33 ---------------------------------------------------------------------- errors [29] 12.6% make-exacts-walkup [13] 87.4% [31] 3308(21.4%) 0(0.0%) eval-prog ...s/herbie/master/src/programs.rkt:83:0 hash-ref! [32] 87.4% temp85_0 [33] 12.6% ---------------------------------------------------------------------- localize-error [20] 1.4% map [39] 5.5% eval-prog [31] 30.2% loop [18] 62.9% [32] 3102(20.1%) 240(1.6%) hash-ref! .../racket/private/more-scheme.rkt:376:2 ??? [2] 62.9% bigfloat-hash [34] 26.4% parse-loop30 [36] 6.8% ---------------------------------------------------------------------- eval-prog [31] 100.0% [33] 418(2.7%) 0(0.0%) temp85_0 (unknown source) compile15 [35] 100.0% ---------------------------------------------------------------------- hash-ref! [32] 100.0% [34] 2650(17.2%) 0(0.0%) bigfloat-hash ...h/private/bigfloat/mpfr.rkt:168:0 bfcanonicalize [37] 100.0% ---------------------------------------------------------------------- temp85_0 [33] 100.0% [35] 418(2.7%) 0(0.0%) compile15 (unknown source) temp91_0 [38] 100.0% ---------------------------------------------------------------------- hash-ref! [32] 100.0% [36] 212(1.4%) 0(0.0%) parse-loop30 (unknown source) map [39] 100.0% ---------------------------------------------------------------------- bigfloat-hash [34] 100.0% [37] 2650(17.2%) 2650(17.2%) bfcanonicalize .../private/bigfloat/mpfr.rkt:158:0 ---------------------------------------------------------------------- compile15 [35] 100.0% [38] 418(2.7%) 0(0.0%) temp91_0 (unknown source) temp118_0 [40] 100.0% ---------------------------------------------------------------------- parse-loop30 [36] 100.0% [39] 212(1.4%) 0(0.0%) map ...t-7.5/collects/racket/private/map.rkt:35:13 hash-ref! [32] 80.0% loop [41] 20.0% ---------------------------------------------------------------------- temp91_0 [38] 100.0% [40] 418(2.7%) 0(0.0%) temp118_0 (unknown source) expand-capturing-lifts [43] 100.0% ---------------------------------------------------------------------- map [39] 1.6% loop [41] 98.4% [41] 212(1.4%) 0(0.0%) loop ...-7.5/collects/racket/private/map.rkt:40:19 loop [41] 98.4% ??? [42] 1.6% ---------------------------------------------------------------------- loop [41] 2.2% ??? [25] 97.8% [42] 9748(63.1%) 0(0.0%) ??? ...tract/private/arrow-higher-order.rkt:379:33 bf-complex-mult [44] 93.1% bf-complex-add [45] 6.9% ---------------------------------------------------------------------- temp118_0 [40] 100.0% [43] 418(2.7%) 0(0.0%) expand-capturing-lifts (unknown source) lambda-clause-expander [46] 100.0% ---------------------------------------------------------------------- ??? [42] 100.0% [44] 9074(58.8%) 442(2.9%) bf-complex-mult .../master/src/bigcomplex.rkt:30:0 bf* [47] 55.3% ??? [50] 37.4% ...higher-order.rkt:379:33 [48] 2.4% ---------------------------------------------------------------------- ??? [42] 100.0% [45] 674(4.4%) 0(0.0%) bf-complex-add ...e/master/src/bigcomplex.rkt:23:0 ??? [50] 66.8% ...higher-order.rkt:379:33 [48] 33.2% ---------------------------------------------------------------------- expand-capturing-lifts [43] 100.0% [46] 418(2.7%) 0(0.0%) lambda-clause-expander (unknown source) finish-bodys [49] 100.0% ---------------------------------------------------------------------- bf-complex-mult [44] 100.0% [47] 5018(32.5%) 260(1.7%) bf* ...ath/private/bigfloat/bigfloat-mpfr.rkt:95:0 ??? [50] 94.8% ---------------------------------------------------------------------- bf-complex-mult [44] 49.1% bf-complex-add [45] 50.9% [48] 440(2.8%) 216(1.4%) ...higher-order.rkt:379:33 (unknown source) ??? [52] 50.9% ---------------------------------------------------------------------- lambda-clause-expander [46] 13.8% for-loop [51] 86.2% [49] 418(2.7%) 0(0.0%) finish-bodys (unknown source) for-loop [51] 100.0% ---------------------------------------------------------------------- bf-complex-add [45] 4.8% ??? [25] 7.6% bf-complex-mult [44] 36.5% bf* [47] 51.1% [50] 9312(60.3%) 2710(17.5%) ??? ...-racket/utils/simple-result-arrow.rkt:39:12 bfmul [53] 54.4% bfneg [54] 16.5% ---------------------------------------------------------------------- for-loop [51] 6.9% finish-bodys [49] 93.1% [51] 418(2.7%) 216(1.4%) for-loop (unknown source) finish-bodys [49] 80.5% for-loop [51] 6.9% dispatch-transformer41 [55] 6.9% ---------------------------------------------------------------------- ...higher-order.rkt:379:33 [48]100.0% [52] 224(1.5%) 224(1.5%) ??? ...cts/racket/contract/private/list.rkt:209:10 ---------------------------------------------------------------------- ??? [50] 100.0% [53] 5062(32.8%) 240(1.6%) bfmul ...-lib/math/private/bigfloat/mpfr.rkt:835:4 new-mpfr [56] 62.6% ??? [57] 32.7% ---------------------------------------------------------------------- ??? [50] 100.0% [54] 1540(10.0%) 0(0.0%) bfneg ...-lib/math/private/bigfloat/mpfr.rkt:632:4 new-mpfr [56] 56.6% ??? [57] 43.4% ---------------------------------------------------------------------- for-loop [51] 100.0% [55] 202(1.3%) 0(0.0%) dispatch-transformer41 (unknown source) apply-transformer52 [58] 100.0% ---------------------------------------------------------------------- bfneg [54] 21.6% bfmul [53] 78.4% [56] 4040(26.2%) 4040(26.2%) new-mpfr ...b/math/private/bigfloat/mpfr.rkt:348:0 ---------------------------------------------------------------------- bfneg [54] 28.8% bfmul [53] 71.2% [57] 2322(15.0%) 2322(15.0%) ??? /opt/racket-7.5/collects/ffi/unsafe.rkt:938:4 ---------------------------------------------------------------------- dispatch-transformer41 [55] 100.0% [58] 202(1.3%) 202(1.3%) apply-transformer52 (unknown source) ----------------------------------------------------------------------