Profiling results ----------------- Total cpu time observed: 145336ms (out of 147548ms) Number of samples taken: 390 (once every 373ms) (Hiding functions with self<1.0% and local<2.0%: 2 of 101 hidden) ========================================================================= Caller Idx Total Self Name+src Local% ms(pct) ms(pct) Callee ========================================================================= run [10] 50.0% [1] 145336(100.0%) 0(0.0%) ??? ...lects/racket/private/more-scheme.rkt:261:28 profile-thunk16 [5] 50.0% loop [16] 47.3% run-improve39 [7] 2.7% ------------------------------------------------------------------------- loop [27] 0.4% loop [47] 99.6% [2] 136466(93.9%) 368(0.3%) composed ...ollects/racket/private/list.rkt:321:16 ??? [6] 99.7% ------------------------------------------------------------------------- loop [47] 100.0% [3] 612(0.4%) 0(0.0%) set-precompute! ...ket/src/core/simplify.rkt:140:0 for-loop [8] 100.0% ------------------------------------------------------------------------- for-loop [87] 100.0% [4] 360(0.2%) 0(0.0%) syntax-e (unknown source) syntax-e/no-taint [9] 100.0% ------------------------------------------------------------------------- ??? [1] 100.0% [5] 145336(100.0%) 0(0.0%) profile-thunk16 ...e/pkgs/profile-lib/main.rkt:9:0 run [10] 100.0% ------------------------------------------------------------------------- for-loop [70] 0.2% loop [47] 1.2% composed [2] 98.6% [6] 138088(95.0%) 0(0.0%) ??? .../herbie/typed-racket/src/programs.rkt:124:2 ??? [11] 93.8% bf [17] 6.2% ------------------------------------------------------------------------- ??? [1] 100.0% [7] 7862(5.4%) 0(0.0%) run-improve39 ...ped-racket/src/mainloop.rkt:287:0 setup-prog!32 [12] 67.4% for-loop [13] 28.7% for-loop [15] 3.9% ------------------------------------------------------------------------- set-precompute! [3] 100.0% [8] 612(0.4%) 0(0.0%) for-loop ...ped-racket/src/core/simplify.rkt:142:2 eval-const-expr [14] 100.0% ------------------------------------------------------------------------- syntax-e [4] 100.0% [9] 360(0.2%) 0(0.0%) syntax-e/no-taint (unknown source) loop [89] 100.0% ------------------------------------------------------------------------- profile-thunk16 [5] 100.0% [10] 145336(100.0%) 0(0.0%) run ...racket/share/pkgs/profile-lib/main.rkt:39:2 ??? [1] 100.0% ------------------------------------------------------------------------- ??? [6] 100.0% [11] 129562(89.1%) 3316(2.3%) ??? ...acket/collects/racket/private/kw.rkt:592:14 ??? [53] 94.7% bf [17] 1.3% ??? [88] 1.0% ??? [54] 0.2% ------------------------------------------------------------------------- run-improve39 [7] 100.0% [12] 5300(3.6%) 0(0.0%) setup-prog!32 ...yped-racket/src/mainloop.rkt:63:0 loop [16] 100.0% ------------------------------------------------------------------------- run-improve39 [7] 100.0% [13] 2254(1.6%) 0(0.0%) for-loop ...ie/typed-racket/src/mainloop.rkt:304:8 run-iter! [18] 100.0% ------------------------------------------------------------------------- for-loop [8] 100.0% [14] 612(0.4%) 0(0.0%) eval-const-expr ...d-racket/src/programs.rkt:127:0 eval-prog [35] 100.0% ------------------------------------------------------------------------- run-improve39 [7] 100.0% [15] 308(0.2%) 0(0.0%) for-loop ...e/typed-racket/src/mainloop.rkt:299:29 ??? [19] 100.0% ------------------------------------------------------------------------- setup-prog!32 [12] 3.7% ??? [1] 96.3% [16] 142774(98.2%) 0(0.0%) loop ...s/herbie/typed-racket/src/points.rkt:230:2 loop [27] 35.8% loop [20] 32.4% make-exacts-walkup [28] 31.6% for-loop [23] 0.2% ------------------------------------------------------------------------- ??? [11] 16.1% ??? [6] 83.9% [17] 10166(7.0%) 304(0.2%) bf ...ath-lib/math/private/bigfloat/mpfr.rkt:601:2 new-mpfr [85] 85.7% ??? [86] 11.3% ------------------------------------------------------------------------- for-loop [13] 100.0% [18] 2254(1.6%) 0(0.0%) run-iter! ...e/typed-racket/src/mainloop.rkt:268:0 localize-error [21] 58.2% gen-rewrites! [24] 14.4% finalize-iter! [25] 13.9% simplify! [26] 13.5% ------------------------------------------------------------------------- ??? [54] 49.7% for-loop [15] 50.3% [19] 612(0.4%) 0(0.0%) ??? ...bie/typed-racket/src/core/simplify.rkt:31:0 iterate-egraph!7 [22] 100.0% ------------------------------------------------------------------------- loop [16] 100.0% [20] 46210(31.8%) 308(0.2%) loop ...s/herbie/typed-racket/src/points.rkt:124:2 loop [27] 52.0% make-exacts-walkup [28] 47.4% ------------------------------------------------------------------------- run-iter! [18] 100.0% [21] 1312(0.9%) 0(0.0%) localize-error ...acket/src/core/localize.rkt:51:0 hash-ref! [29] 100.0% ------------------------------------------------------------------------- ??? [19] 100.0% [22] 612(0.4%) 0(0.0%) iterate-egraph!7 ...ket/src/core/simplify.rkt:55:0 map-enodes [30] 100.0% ------------------------------------------------------------------------- loop [16] 100.0% [23] 334(0.2%) 0(0.0%) for-loop ...bie/typed-racket/src/points.rkt:245:19 for-loop [31] 100.0% ------------------------------------------------------------------------- run-iter! [18] 100.0% [24] 324(0.2%) 0(0.0%) gen-rewrites! ...ped-racket/src/mainloop.rkt:165:0 for-loop [32] 100.0% ------------------------------------------------------------------------- run-iter! [18] 100.0% [25] 314(0.2%) 0(0.0%) finalize-iter! ...ed-racket/src/mainloop.rkt:222:0 ??? [33] 100.0% ------------------------------------------------------------------------- run-iter! [18] 100.0% [26] 304(0.2%) 0(0.0%) simplify! ...e/typed-racket/src/mainloop.rkt:182:0 for-loop [34] 100.0% ------------------------------------------------------------------------- loop [20] 31.9% loop [16] 68.1% [27] 75188(51.7%) 0(0.0%) loop ...s/herbie/typed-racket/src/points.rkt:107:4 loop [47] 99.3% composed [2] 0.7% ------------------------------------------------------------------------- loop [20] 32.7% loop [16] 67.3% [28] 66944(46.1%) 0(0.0%) make-exacts-walkup ...-racket/src/points.rkt:104:0 loop [47] 96.6% eval-prog [35] 3.4% ------------------------------------------------------------------------- localize-error [21] 30.6% loop [47] 34.1% map [42] 35.3% [29] 1312(0.9%) 0(0.0%) hash-ref! .../racket/private/more-scheme.rkt:376:2 f8 [37] 52.4% parse-loop14 [36] 47.6% ------------------------------------------------------------------------- iterate-egraph!7 [22] 100.0% [30] 612(0.4%) 0(0.0%) map-enodes ...ped-racket/src/core/egraph.rkt:140:0 loop [47] 100.0% ------------------------------------------------------------------------- for-loop [23] 100.0% [31] 334(0.2%) 0(0.0%) for-loop ...rbie/typed-racket/src/points.rkt:222:4 ??? [54] 100.0% ------------------------------------------------------------------------- gen-rewrites! [24] 100.0% [32] 324(0.2%) 0(0.0%) for-loop ...e/typed-racket/src/mainloop.rkt:170:11 ??? [38] 100.0% ------------------------------------------------------------------------- finalize-iter! [25] 100.0% [33] 314(0.2%) 0(0.0%) ??? ...contract/private/arrow-val-first.rkt:388:18 for-loop [39] 100.0% ------------------------------------------------------------------------- simplify! [26] 100.0% [34] 304(0.2%) 0(0.0%) for-loop ...ie/typed-racket/src/mainloop.rkt:186:6 for-loop [40] 100.0% ------------------------------------------------------------------------- eval-const-expr [14] 21.3% make-exacts-walkup [28] 78.7% [35] 2876(2.0%) 0(0.0%) eval-prog ...e/typed-racket/src/programs.rkt:108:0 temp68_2 [41] 56.1% inductor [43] 21.3% loop [89] 11.7% eval [45] 10.9% ------------------------------------------------------------------------- hash-ref! [29] 100.0% [36] 1312(0.9%) 0(0.0%) parse-loop14 ...s/racket/match/compiler.rkt:418:15 loop [47] 100.0% ------------------------------------------------------------------------- hash-ref! [29] 100.0% [37] 1312(0.9%) 0(0.0%) f8 ...et/collects/racket/match/compiler.rkt:507:40 map [42] 100.0% ------------------------------------------------------------------------- for-loop [32] 100.0% [38] 324(0.2%) 0(0.0%) ??? ...erbie/typed-racket/src/alternative.rkt:61:0 rewriter [44] 100.0% ------------------------------------------------------------------------- ??? [33] 100.0% [39] 314(0.2%) 0(0.0%) for-loop ...ped-racket/src/core/alt-table.rkt:51:2 atab-add-altn [46] 100.0% ------------------------------------------------------------------------- for-loop [34] 100.0% [40] 304(0.2%) 0(0.0%) for-loop ...ie/typed-racket/src/mainloop.rkt:210:8 ??? [54] 100.0% ------------------------------------------------------------------------- eval-prog [35] 100.0% [41] 1614(1.1%) 0(0.0%) temp68_2 (unknown source) compile16 [48] 100.0% ------------------------------------------------------------------------- f8 [37] 100.0% [42] 1312(0.9%) 0(0.0%) map ...acket/collects/racket/private/map.rkt:35:13 hash-ref! [29] 67.5% loop [47] 32.5% ------------------------------------------------------------------------- inductor [43] 33.6% eval-prog [35] 66.4% [43] 612(0.4%) 0(0.0%) inductor ...ie/typed-racket/src/programs.rkt:113:4 table-ref [49] 66.4% inductor [43] 33.6% ------------------------------------------------------------------------- matcher [58] 50.0% ??? [38] 50.0% [44] 324(0.2%) 0(0.0%) rewriter ...yped-racket/src/core/matcher.rkt:131:2 for-loop [50] 100.0% ------------------------------------------------------------------------- eval-prog [35] 100.0% [45] 314(0.2%) 0(0.0%) eval (unknown source) namespace-syntax-introduce3 [51]100.0% ------------------------------------------------------------------------- for-loop [39] 100.0% [46] 314(0.2%) 0(0.0%) atab-add-altn ...cket/src/core/alt-table.rkt:210:0 override-at-pnts [52] 100.0% ------------------------------------------------------------------------- map [42] 0.0% parse-loop14 [36] 0.1% map-enodes [30] 0.1% make-exacts-walkup [28] 1.3% loop [27] 1.5% loop [47] 96.9% [47] 141302(97.2%) 310(0.2%) loop ...cket/collects/racket/private/map.rkt:40:19 loop [47] 96.9% composed [2] 2.8% set-precompute! [3] 0.1% hash-ref! [29] 0.1% ??? [53] 0.0% ??? [6] 0.0% ??? [54] 0.0% ------------------------------------------------------------------------- temp68_2 [41] 100.0% [48] 1614(1.1%) 0(0.0%) compile16 (unknown source) temp74_0 [55] 100.0% ------------------------------------------------------------------------- inductor [43] 100.0% [49] 612(0.4%) 0(0.0%) table-ref ...rbie/typed-racket/src/common.rkt:47:0 ??? [56] 100.0% ------------------------------------------------------------------------- rewriter [44] 100.0% [50] 324(0.2%) 0(0.0%) for-loop ...ped-racket/src/core/matcher.rkt:134:10 matcher [58] 50.0% type-of [57] 50.0% ------------------------------------------------------------------------- eval [45] 100.0% [51] 314(0.2%) 0(0.0%) namespace-syntax-introduce3 (unknown source) free-identifier=? [59] 100.0% ------------------------------------------------------------------------- atab-add-altn [46] 100.0% [52] 314(0.2%) 0(0.0%) override-at-pnts ...t/src/core/alt-table.rkt:145:0 errors [60] 100.0% ------------------------------------------------------------------------- loop [47] 0.8% ??? [11] 99.2% [53] 123700(85.1%) 694(0.5%) ??? ...tract/private/arrow-higher-order.rkt:361:33 bf-complex-exp [61] 73.8% bf-complex-div [62] 20.6% bf-complex-add [63] 3.3% ------------------------------------------------------------------------- location-do [71] 5.7% for-loop [40] 5.7% ??? [11] 11.7% for-loop [31] 12.5% loop [47] 64.5% [54] 2678(1.8%) 0(0.0%) ??? ...tract/private/arrow-higher-order.rkt:357:33 ->flonum [64] 76.2% sample-multi-bounded [67] 12.5% location-do [71] 5.7% ??? [19] 5.7% ------------------------------------------------------------------------- compile16 [48] 100.0% [55] 1614(1.1%) 0(0.0%) temp74_0 (unknown source) expand-single [65] 100.0% ------------------------------------------------------------------------- table-ref [49] 100.0% [56] 612(0.4%) 0(0.0%) ??? ...ects/racket/contract/private/list.rkt:798:4 for-loop [66] 100.0% ------------------------------------------------------------------------- for-loop [50] 100.0% [57] 324(0.2%) 0(0.0%) type-of ...ie/typed-racket/src/type-check.rkt:34:0 for-loop [75] 100.0% ------------------------------------------------------------------------- for-loop [68] 50.0% for-loop [50] 50.0% [58] 324(0.2%) 0(0.0%) matcher ...typed-racket/src/core/matcher.rkt:168:2 for-loop [68] 50.0% rewriter [44] 50.0% ------------------------------------------------------------------------- namespace-syntax-introduce3 [51]100.0% [59] 314(0.2%) 0(0.0%) free-identifier=? (unknown source) resolve+shift28 [69] 100.0% ------------------------------------------------------------------------- override-at-pnts [52] 100.0% [60] 314(0.2%) 0(0.0%) errors ...herbie/typed-racket/src/points.rkt:271:0 for-loop [70] 100.0% ------------------------------------------------------------------------- ??? [53] 100.0% [61] 91344(62.9%) 1012(0.7%) bf-complex-exp ...d-racket/src/bigcomplex.rkt:37:0 ??? [78] 89.7% bf* [72] 9.2% ------------------------------------------------------------------------- ??? [53] 100.0% [62] 25434(17.5%) 730(0.5%) bf-complex-div ...d-racket/src/bigcomplex.rkt:54:0 ??? [78] 53.2% bf* [72] 38.7% ...higher-order.rkt:361:33 [74] 5.2% ------------------------------------------------------------------------- ??? [53] 100.0% [63] 4132(2.8%) 300(0.2%) bf-complex-add ...d-racket/src/bigcomplex.rkt:23:0 ??? [78] 92.7% ------------------------------------------------------------------------- ??? [54] 100.0% [64] 2040(1.4%) 1356(0.9%) ->flonum ...bie/typed-racket/src/programs.rkt:36:0 return/no-unsupplied [76] 17.8% ??? [86] 15.7% ------------------------------------------------------------------------- temp74_0 [55] 100.0% [65] 1614(1.1%) 0(0.0%) expand-single (unknown source) expand-capturing-lifts [73] 100.0% ------------------------------------------------------------------------- ??? [56] 100.0% [66] 612(0.4%) 0(0.0%) for-loop ...acket/contract/private/list.rkt:804:12 do-chaperone-procedure [77] 50.3% for-loop [75] 49.7% ------------------------------------------------------------------------- ??? [54] 100.0% [67] 334(0.2%) 334(0.2%) sample-multi-bounded ...racket/src/points.rkt:43:0 ------------------------------------------------------------------------- matcher [58] 100.0% [68] 324(0.2%) 0(0.0%) for-loop ...ped-racket/src/core/matcher.rkt:184:21 matcher [58] 100.0% ------------------------------------------------------------------------- free-identifier=? [59] 100.0% [69] 314(0.2%) 314(0.2%) resolve+shift28 (unknown source) ------------------------------------------------------------------------- errors [60] 100.0% [70] 314(0.2%) 0(0.0%) for-loop ...rbie/typed-racket/src/points.rkt:274:4 ??? [6] 100.0% ------------------------------------------------------------------------- ??? [54] 100.0% [71] 304(0.2%) 0(0.0%) location-do .../typed-racket/src/programs.rkt:89:0 ??? [54] 100.0% ------------------------------------------------------------------------- bf-complex-exp [61] 46.1% bf-complex-div [62] 53.9% [72] 18296(12.6%) 440(0.3%) bf* ...ath/private/bigfloat/bigfloat-mpfr.rkt:95:0 ??? [78] 97.6% ------------------------------------------------------------------------- loop [89] 17.2% expand-single [65] 82.8% [73] 1950(1.3%) 0(0.0%) expand-capturing-lifts (unknown source) lambda-clause-expander [80] 82.8% loop [89] 17.2% ------------------------------------------------------------------------- bf-complex-div [62] 100.0% [74] 1330(0.9%) 0(0.0%) ...higher-order.rkt:361:33 (unknown source) ??? [79] 100.0% ------------------------------------------------------------------------- for-loop [66] 48.4% type-of [57] 51.6% [75] 628(0.4%) 0(0.0%) for-loop ...racket/contract/private/hash.rkt:277:6 ??? [79] 100.0% ------------------------------------------------------------------------- ->flonum [64] 100.0% [76] 364(0.3%) 364(0.3%) return/no-unsupplied ...ct/private/arr-i.rkt:534:0 ------------------------------------------------------------------------- for-loop [66] 100.0% [77] 308(0.2%) 308(0.2%) do-chaperone-procedure ...et/private/kw.rkt:1762:2 ------------------------------------------------------------------------- bf-complex-add [63] 3.2% bf-complex-div [62] 11.3% bf* [72] 15.0% bf-complex-exp [61] 68.7% [78] 119194(82.0%) 75632(52.0%) ??? ...-racket/utils/simple-result-arrow.rkt:39:12 bfmul [81] 24.7% bfcos [82] 11.8% ------------------------------------------------------------------------- for-loop [75] 32.1% ...higher-order.rkt:361:33 [74] 67.9% [79] 1958(1.3%) 996(0.7%) ??? ...cts/racket/contract/private/list.rkt:209:10 ??? [84] 32.1% ??? [98] 17.1% ------------------------------------------------------------------------- expand-capturing-lifts [73] 100.0% [80] 1614(1.1%) 0(0.0%) lambda-clause-expander (unknown source) finish-bodys [83] 100.0% ------------------------------------------------------------------------- ??? [78] 100.0% [81] 29482(20.3%) 1656(1.1%) bfmul ...-lib/math/private/bigfloat/mpfr.rkt:821:4 new-mpfr [85] 72.0% ??? [86] 22.3% ------------------------------------------------------------------------- ??? [78] 100.0% [82] 14080(9.7%) 680(0.5%) bfcos ...-lib/math/private/bigfloat/mpfr.rkt:618:4 new-mpfr [85] 71.0% ??? [86] 24.2% ------------------------------------------------------------------------- lambda-clause-expander [80] 18.1% for-loop [87] 81.9% [83] 1614(1.1%) 0(0.0%) finish-bodys (unknown source) for-loop [87] 100.0% ------------------------------------------------------------------------- ??? [79] 100.0% [84] 628(0.4%) 0(0.0%) ??? ...ects/racket/contract/private/list.rkt:747:7 ??? [98] 51.6% ??? [88] 48.4% ------------------------------------------------------------------------- bf [17] 21.8% bfcos [82] 25.0% bfmul [81] 53.2% [85] 39950(27.5%) 39950(27.5%) new-mpfr ...b/math/private/bigfloat/mpfr.rkt:335:0 ------------------------------------------------------------------------- ->flonum [64] 2.8% bf [17] 10.0% bfcos [82] 29.7% bfmul [81] 57.5% [86] 11458(7.9%) 11458(7.9%) ??? /home/p92/racket/collects/ffi/unsafe.rkt:898:4 ------------------------------------------------------------------------- for-loop [87] 2.7% run-module-instance!125 [92] 8.6% loop [89] 8.6% finish-bodys [83] 80.1% [87] 1950(1.3%) 290(0.2%) for-loop (unknown source) finish-bodys [83] 65.4% loop [89] 9.1% run-module-instance!125 [92] 8.6% [running body] [91] 8.6% for-loop [87] 2.7% syntax-e [4] 1.8% add-local-binding!37 [93] 1.3% ------------------------------------------------------------------------- ??? [84] 19.5% ??? [11] 80.5% [88] 1562(1.1%) 302(0.2%) ??? ...ects/racket/contract/private/prop.rkt:519:4 ??? [90] 80.7% ------------------------------------------------------------------------- expand-capturing-lifts [73] 8.2% eval-prog [35] 8.2% loop [89] 21.6% syntax-e/no-taint [9] 26.2% for-loop [87] 35.9% [89] 1374(0.9%) 678(0.5%) loop (unknown source) gf [94] 26.2% loop [89] 21.6% expand-capturing-lifts [73] 8.2% for-loop [87] 8.2% ------------------------------------------------------------------------- ??? [88] 100.0% [90] 1260(0.9%) 956(0.7%) ??? ...lects/racket/contract/private/orc.rkt:83:14 ??? [96] 24.1% ------------------------------------------------------------------------- for-loop [87] 100.0% [91] 336(0.2%) 0(0.0%) [running body] ...e/experimental/contract.rkt":##f ??? [95] 100.0% ------------------------------------------------------------------------- for-loop [87] 100.0% [92] 336(0.2%) 0(0.0%) run-module-instance!125 (unknown source) for-loop [87] 100.0% ------------------------------------------------------------------------- for-loop [87] 100.0% [93] 286(0.2%) 0(0.0%) add-local-binding!37 (unknown source) binding-table-add [97] 100.0% ------------------------------------------------------------------------- loop [89] 100.0% [94] 360(0.2%) 0(0.0%) gf (unknown source) cache-or-reuse-set [99] 100.0% ------------------------------------------------------------------------- [running body] [91] 100.0% [95] 336(0.2%) 0(0.0%) ??? ...llects/racket/contract/combinator.rkt:270:9 ??? [98] 100.0% ------------------------------------------------------------------------- ??? [90] 100.0% [96] 304(0.2%) 304(0.2%) ??? ...ects/racket/contract/private/list.rkt:163:5 ------------------------------------------------------------------------- add-local-binding!37 [93] 100.0% [97] 286(0.2%) 286(0.2%) binding-table-add (unknown source) ------------------------------------------------------------------------- ??? [84] 32.6% ??? [79] 33.6% ??? [95] 33.8% [98] 994(0.7%) 994(0.7%) ??? ...ects/racket/contract/private/guts.rkt:746:8 ------------------------------------------------------------------------- gf [94] 100.0% [99] 360(0.2%) 360(0.2%) cache-or-reuse-set (unknown source) -------------------------------------------------------------------------