Profiling results ----------------- Total cpu time observed: 175850ms (out of 176044ms) Number of samples taken: 492 (once every 357ms) (Hiding functions with self<1.0% and local<2.0%: 10 of 193 hidden) ========================================================================== Caller Idx Total Self Name+src Local% ms(pct) ms(pct) Callee ========================================================================== ??? [30] 100.0% [1] 150936(85.8%) 0(0.0%) profile-thunk16 ...t/pkgs/profile-lib/main.rkt:9:0 run [8] 100.0% -------------------------------------------------------------------------- ??? [30] 100.0% [2] 118092(67.2%) 0(0.0%) run-improve50 ...ng-logging/src/mainloop.rkt:234:0 for-loop [9] 95.7% get-final-combination [11] 2.6% setup-alt-simplified [12] 1.4% loop [34] 0.3% -------------------------------------------------------------------------- table-ref [77] 100.0% [3] 9098(5.2%) 0(0.0%) loop ...mpling-logging/src/core/simplify.rkt:215:2 pass [10] 100.0% -------------------------------------------------------------------------- match-e [90] 100.0% [4] 1014(0.6%) 0(0.0%) variable? ...g-logging/src/syntax/syntax.rkt:660:0 ??? [127] 100.0% -------------------------------------------------------------------------- copying-mergesort [63] 100.0% [5] 362(0.2%) 0(0.0%) jloop ...t/collects/racket/private/sort.rkt:121:23 ??? [165] 100.0% -------------------------------------------------------------------------- loop [47] 100.0% [6] 358(0.2%) 0(0.0%) ??? ...ket/collects/racket/private/list.rkt:323:18 hash-ref! [57] 50.0% map [45] 50.0% -------------------------------------------------------------------------- f137 [75] 100.0% [7] 302(0.2%) 0(0.0%) taylor-invert ...logging/src/core/taylor.rkt:312:0 simplify [62] 100.0% -------------------------------------------------------------------------- profile-thunk16 [1] 100.0% [8] 150936(85.8%) 0(0.0%) run ...share/racket/pkgs/profile-lib/main.rkt:39:2 ??? [30] 100.0% -------------------------------------------------------------------------- run-improve50 [2] 100.0% [9] 113022(64.3%) 0(0.0%) for-loop ...mpling-logging/src/mainloop.rkt:249:10 run-iter! [13] 100.0% -------------------------------------------------------------------------- loop [3] 100.0% [10] 9098(5.2%) 0(0.0%) pass ...mpling-logging/src/core/simplify.rkt:205:2 for-loop [14] 100.0% -------------------------------------------------------------------------- run-improve50 [2] 100.0% [11] 3084(1.8%) 0(0.0%) get-final-combination ...ng/src/mainloop.rkt:264:0 split-table [15] 89.9% ??? [72] 10.1% -------------------------------------------------------------------------- run-improve50 [2] 100.0% [12] 1630(0.9%) 0(0.0%) setup-alt-simplified ...-logging/src/glue.rkt:49:0 simplify-alt [16] 100.0% -------------------------------------------------------------------------- for-loop [9] 100.0% [13] 113022(64.3%) 0(0.0%) run-iter! ...mpling-logging/src/mainloop.rkt:215:0 simplify! [17] 94.6% finalize-iter! [20] 3.1% gen-series! [21] 1.1% gen-rewrites! [23] 0.8% localize-error [24] 0.3% -------------------------------------------------------------------------- pass [10] 100.0% [14] 9098(5.2%) 0(0.0%) for-loop ...g-logging/src/core/simplify.rkt:208:29 loop [18] 47.5% argmin [19] 41.1% for-loop [22] 11.3% -------------------------------------------------------------------------- get-final-combination [11] 100.0% [15] 2772(1.6%) 0(0.0%) split-table ...sampling-logging/src/glue.rkt:162:0 f137 [75] 100.0% -------------------------------------------------------------------------- setup-alt-simplified [12] 100.0% [16] 1630(0.9%) 0(0.0%) simplify-alt ...sampling-logging/src/glue.rkt:76:0 table-ref [77] 100.0% -------------------------------------------------------------------------- run-iter! [13] 100.0% [17] 106964(60.8%) 0(0.0%) simplify! ...mpling-logging/src/mainloop.rkt:155:0 for-loop [25] 100.0% -------------------------------------------------------------------------- for-loop [14] 100.0% [18] 4326(2.5%) 0(0.0%) loop ...hare/racket/collects/racket/list.rkt:729:4 for-loop [26] 91.5% expression-cost [29] 8.5% -------------------------------------------------------------------------- for-loop [14] 100.0% [19] 3740(2.1%) 0(0.0%) argmin ...re/racket/collects/racket/list.rkt:743:0 for-loop [26] 90.5% expression-cost [29] 9.5% -------------------------------------------------------------------------- run-iter! [13] 100.0% [20] 3510(2.0%) 0(0.0%) finalize-iter! ...g-logging/src/mainloop.rkt:169:0 ??? [127] 100.0% -------------------------------------------------------------------------- run-iter! [13] 100.0% [21] 1274(0.7%) 0(0.0%) gen-series! ...ling-logging/src/mainloop.rkt:129:0 for-loop [27] 100.0% -------------------------------------------------------------------------- for-loop [14] 100.0% [22] 1032(0.6%) 1032(0.6%) for-loop ...g-logging/src/core/simplify.rkt:195:13 -------------------------------------------------------------------------- run-iter! [13] 100.0% [23] 916(0.5%) 0(0.0%) gen-rewrites! ...ng-logging/src/mainloop.rkt:142:0 for-loop [28] 100.0% -------------------------------------------------------------------------- run-iter! [13] 100.0% [24] 358(0.2%) 0(0.0%) localize-error ...gging/src/core/localize.rkt:47:0 hash-ref! [57] 100.0% -------------------------------------------------------------------------- simplify! [17] 100.0% [25] 106964(60.8%) 0(0.0%) for-loop ...ampling-logging/src/mainloop.rkt:159:6 ??? [30] 100.0% -------------------------------------------------------------------------- argmin [19] 46.1% loop [18] 53.9% [26] 7344(4.2%) 360(0.2%) for-loop ...ampling-logging/src/programs.rkt:199:2 table-ref [77] 58.8% ...gging/src/common.rkt:47:2 [131] 36.3% -------------------------------------------------------------------------- gen-series! [21] 100.0% [27] 1274(0.7%) 0(0.0%) for-loop ...ampling-logging/src/mainloop.rkt:135:7 taylor-alt [31] 100.0% -------------------------------------------------------------------------- gen-rewrites! [23] 100.0% [28] 916(0.5%) 0(0.0%) for-loop ...mpling-logging/src/mainloop.rkt:147:11 ??? [32] 100.0% -------------------------------------------------------------------------- argmin [19] 49.3% loop [18] 50.7% [29] 722(0.4%) 0(0.0%) expression-cost ...-logging/src/programs.rkt:198:0 compile [33] 100.0% -------------------------------------------------------------------------- for-loop [25] 20.6% run [8] 33.3% [30] 173244(98.5%) 0(0.0%) ??? ...lects/racket/private/more-scheme.rkt:261:28 profile-thunk16 [1] 33.3% table-ref [77] 32.0% run-improve50 [2] 24.0% loop [34] 10.8% -------------------------------------------------------------------------- for-loop [27] 100.0% [31] 1274(0.7%) 0(0.0%) taylor-alt .../sampling-logging/src/glue.rkt:134:0 for-loop [35] 100.0% -------------------------------------------------------------------------- for-loop [28] 100.0% [32] 916(0.5%) 0(0.0%) ??? ...e/sampling-logging/src/alternative.rkt:88:0 rewriter [36] 100.0% -------------------------------------------------------------------------- expression-cost [29] 100.0% [33] 722(0.4%) 0(0.0%) compile ...sampling-logging/src/programs.rkt:175:0 hash-ref! [57] 100.0% -------------------------------------------------------------------------- run-improve50 [2] 1.0% ??? [30] 99.0% [34] 35712(20.3%) 0(0.0%) loop ...rbie/sampling-logging/src/points.rkt:192:2 loop [37] 43.3% make-exacts* [41] 37.6% loop [42] 16.3% for-loop [38] 2.9% -------------------------------------------------------------------------- taylor-alt [31] 100.0% [35] 1274(0.7%) 0(0.0%) for-loop ...ie/sampling-logging/src/glue.rkt:139:6 ??? [72] 100.0% -------------------------------------------------------------------------- ??? [32] 30.5% matcher [44] 69.5% [36] 916(0.5%) 0(0.0%) rewriter ...ing-logging/src/core/matcher.rkt:131:2 for-loop [39] 69.5% *rules* [40] 22.1% f137 [75] 8.4% -------------------------------------------------------------------------- loop [34] 100.0% [37] 15450(8.8%) 0(0.0%) loop ...rbie/sampling-logging/src/points.rkt:151:2 loop [42] 39.6% make-exacts* [41] 38.5% eval-prog [54] 21.9% -------------------------------------------------------------------------- loop [34] 100.0% [38] 1020(0.6%) 0(0.0%) for-loop ...sampling-logging/src/points.rkt:204:24 for-loop [43] 100.0% -------------------------------------------------------------------------- rewriter [36] 100.0% [39] 916(0.5%) 0(0.0%) for-loop ...ng-logging/src/core/matcher.rkt:134:10 matcher [44] 100.0% -------------------------------------------------------------------------- rewriter [36] 100.0% [40] 608(0.3%) 0(0.0%) *rules* ...ling-logging/src/syntax/rules.rkt:512:0 for-loop [104] 100.0% -------------------------------------------------------------------------- loop [37] 30.7% loop [34] 69.3% [41] 19368(11.0%) 0(0.0%) make-exacts* ...pling-logging/src/points.rkt:138:0 loop [47] 50.9% map [45] 47.3% eval-prog [54] 1.7% -------------------------------------------------------------------------- loop [34] 48.8% loop [37] 51.2% [42] 11938(6.8%) 0(0.0%) loop ...rbie/sampling-logging/src/points.rkt:141:4 map [45] 100.0% -------------------------------------------------------------------------- for-loop [38] 100.0% [43] 1020(0.6%) 0(0.0%) for-loop ...sampling-logging/src/points.rkt:205:26 ??? [72] 100.0% -------------------------------------------------------------------------- for-loop [46] 22.2% matcher [44] 27.8% for-loop [39] 50.0% [44] 916(0.5%) 0(0.0%) matcher ...ling-logging/src/core/matcher.rkt:167:2 rewriter [36] 50.0% matcher [44] 27.8% for-loop [46] 22.2% -------------------------------------------------------------------------- ??? [6] 1.6% f137 [75] 2.9% make-exacts* [41] 41.5% loop [42] 54.0% [45] 22102(12.6%) 0(0.0%) map ...acket/collects/racket/private/map.rkt:20:13 loop [47] 95.5% f137 [75] 2.9% ??? [72] 1.6% -------------------------------------------------------------------------- matcher [44] 100.0% [46] 916(0.5%) 0(0.0%) for-loop ...ng-logging/src/core/matcher.rkt:183:21 matcher [44] 100.0% -------------------------------------------------------------------------- make-exacts* [41] 0.1% parse-loop12 [66] 0.2% map [45] 0.7% match-e [90] 0.8% for-loop [92] 1.4% f137 [75] 3.0% ??? [60] 5.1% loop! [96] 7.0% loop [47] 81.1% [47] 59116(33.6%) 3732(2.1%) loop ...cket/collects/racket/private/map.rkt:25:19 loop [47] 81.1% loop! [96] 6.8% hash-ref! [57] 5.1% option-on-expr [48] 3.0% ??? [165] 0.8% for-loop [49] 0.6% foldl [102] 0.2% ??? [6] 0.2% ??? [72] 0.0% -------------------------------------------------------------------------- f137 [75] 36.0% loop [47] 64.0% [48] 2772(1.6%) 0(0.0%) option-on-expr ...gging/src/core/regimes.rkt:103:0 sort-context-on-expr [50] 61.0% pick-errors [51] 25.9% errors [154] 13.1% -------------------------------------------------------------------------- loop [47] 100.0% [49] 996(0.6%) 0(0.0%) for-loop ...ng-logging/src/core/simplify.rkt:173:2 eval-const-expr [52] 66.5% compose [53] 33.5% -------------------------------------------------------------------------- option-on-expr [48] 100.0% [50] 1692(1.0%) 0(0.0%) sort-context-on-expr ...gging/src/points.rkt:115:0 ??? [55] 80.4% eval-prog [54] 19.6% -------------------------------------------------------------------------- option-on-expr [48] 100.0% [51] 718(0.4%) 0(0.0%) pick-errors ...-logging/src/core/regimes.rkt:184:0 for-loop [56] 100.0% -------------------------------------------------------------------------- for-loop [49] 100.0% [52] 662(0.4%) 0(0.0%) eval-const-expr ...-logging/src/programs.rkt:166:0 ??? [180] 53.2% f137 [75] 46.8% -------------------------------------------------------------------------- for-loop [49] 100.0% [53] 334(0.2%) 334(0.2%) compose ...collects/racket/private/list.rkt:385:12 -------------------------------------------------------------------------- errors [154] 7.5% sort-context-on-expr [50] 7.6% make-exacts* [41] 7.7% loop [37] 77.2% [54] 4384(2.5%) 660(0.4%) eval-prog ...mpling-logging/src/programs.rkt:148:0 hash-ref! [57] 69.2% f137 [75] 15.7% -------------------------------------------------------------------------- sort-context-on-expr [50] 100.0% [55] 1360(0.8%) 0(0.0%) ??? ...cket/collects/racket/private/sort.rkt:403:3 generic-sort/key [58] 77.6% ??? [165] 22.4% -------------------------------------------------------------------------- pick-errors [51] 100.0% [56] 718(0.4%) 360(0.2%) for-loop ...ing-logging/src/core/regimes.rkt:186:2 ??? [59] 49.9% -------------------------------------------------------------------------- ??? [6] 3.5% localize-error [24] 3.5% compile [33] 4.1% loop [76] 4.2% ??? [64] 7.5% ??? [72] 7.5% ??? [60] 10.0% eval-prog [54] 19.9% loop [47] 39.8% [57] 5086(2.9%) 722(0.4%) hash-ref! ...racket/private/more-scheme.rkt:373:13 ??? [60] 49.8% bigfloat-hash [61] 19.9% ??? [64] 7.5% simplify [62] 7.5% parse-loop12 [66] 7.0% ??? [65] 4.2% -------------------------------------------------------------------------- ??? [55] 100.0% [58] 1056(0.6%) 0(0.0%) generic-sort/key .../racket/private/sort.rkt:185:2 copying-mergesort [63] 100.0% -------------------------------------------------------------------------- for-loop [56] 100.0% [59] 358(0.2%) 0(0.0%) ??? ...sampling-logging/src/core/regimes.rkt:177:2 ??? [165] 100.0% -------------------------------------------------------------------------- hash-ref! [57] 100.0% [60] 3756(2.1%) 0(0.0%) ??? ...bie/sampling-logging/src/programs.rkt:183:5 loop [47] 80.8% hash-ref! [57] 19.2% -------------------------------------------------------------------------- hash-ref! [57] 100.0% [61] 3034(1.7%) 0(0.0%) bigfloat-hash ...h/private/bigfloat/mpfr.rkt:165:0 sig+exp->bigfloat [67] 88.9% bfcanonicalize [69] 11.1% -------------------------------------------------------------------------- taylor-invert [7] 23.7% hash-ref! [57] 76.3% [62] 1274(0.7%) 0(0.0%) simplify ...pling-logging/src/core/reduce.rkt:16:0 f137 [75] 52.3% debug7 [70] 24.0% debug-print [71] 23.7% -------------------------------------------------------------------------- copying-mergesort [63] 46.8% generic-sort/key [58] 53.2% [63] 1056(0.6%) 0(0.0%) copying-mergesort ...racket/private/sort.rkt:130:8 copying-mergesort [63] 46.8% loop [68] 44.6% jloop [5] 8.6% -------------------------------------------------------------------------- hash-ref! [57] 100.0% [64] 972(0.6%) 0(0.0%) ??? .../sampling-logging/src/core/taylor.rkt:44:15 hash-ref! [57] 100.0% -------------------------------------------------------------------------- hash-ref! [57] 100.0% [65] 638(0.4%) 0(0.0%) ??? .../sampling-logging/src/core/taylor.rkt:67:15 ??? [72] 100.0% -------------------------------------------------------------------------- hash-ref! [57] 100.0% [66] 358(0.2%) 0(0.0%) parse-loop12 ...s/racket/match/compiler.rkt:418:15 loop [47] 100.0% -------------------------------------------------------------------------- bigfloat-hash [61] 100.0% [67] 2696(1.5%) 2696(1.5%) sig+exp->bigfloat ...ivate/bigfloat/mpfr.rkt:385:0 -------------------------------------------------------------------------- copying-mergesort [63] 100.0% [68] 694(0.4%) 0(0.0%) loop ...ket/collects/racket/private/sort.rkt:97:12 ??? [165] 51.9% ??? [72] 48.1% -------------------------------------------------------------------------- bigfloat-hash [61] 100.0% [69] 338(0.2%) 338(0.2%) bfcanonicalize .../private/bigfloat/mpfr.rkt:155:0 -------------------------------------------------------------------------- simplify [62] 100.0% [70] 306(0.2%) 306(0.2%) debug7 ...bie/sampling-logging/src/debug.rkt:102:0 -------------------------------------------------------------------------- simplify [62] 100.0% [71] 302(0.2%) 0(0.0%) debug-print ...ampling-logging/src/debug.rkt:107:0 for-loop [73] 100.0% -------------------------------------------------------------------------- loop [76] 1.9% ??? [65] 3.6% get-final-combination [11] 5.3% for-loop [161] 5.6% loop [68] 5.6% map [45] 6.0% ??? [165] 6.1% table-ref [77] 8.0% for-loop [35] 8.0% f137 [75] 11.6% for-loop [43] 17.2% loop [47] 21.1% [72] 5930(3.4%) 694(0.4%) ??? ...tract/private/arrow-higher-order.rkt:342:33 table-ref [77] 68.9% approximate9 [74] 8.0% ??? [172] 6.0% hash-ref! [57] 5.5% -------------------------------------------------------------------------- debug-print [71] 100.0% [73] 302(0.2%) 302(0.2%) for-loop ...e/sampling-logging/src/debug.rkt:113:2 -------------------------------------------------------------------------- ??? [72] 100.0% [74] 1274(0.7%) 0(0.0%) approximate9 ...g-logging/src/core/taylor.rkt:12:0 loop [76] 76.3% f137 [75] 23.7% -------------------------------------------------------------------------- for-loop [82] 1.1% approximate9 [74] 1.2% simplify [62] 4.4% map [45] 4.5% rewriter [36] 6.1% eval-const-expr [52] 6.1% eval-prog [54] 6.8% f137 [75] 13.7% split-table [15] 54.9% [75] 5048(2.9%) 334(0.2%) f137 .../collects/racket/match/compiler.rkt:507:40 loop [47] 35.1% option-on-expr [48] 19.8% f137 [75] 13.7% ??? [72] 6.8% ??? [79] 6.1% ??? [128] 6.1% map [45] 4.5% taylor-invert [7] 1.2% expression->type [78] 1.1% table-ref [77] 1.1% -------------------------------------------------------------------------- approximate9 [74] 100.0% [76] 972(0.6%) 0(0.0%) loop .../sampling-logging/src/core/taylor.rkt:86:4 hash-ref! [57] 65.6% ??? [72] 34.4% -------------------------------------------------------------------------- f137 [75] 0.1% simplify-alt [16] 0.6% for-loop [26] 1.1% get-sigs [123] 2.4% ??? [72] 3.2% table-ref [77] 9.6% for-loop [81] 37.1% ??? [30] 45.1% [77] 135522(77.1%) 4200(2.4%) table-ref .../racket/private/norm-define.rkt:53:83 iterate-egraph!13 [80] 43.5% for-loop [81] 37.1% table-ref [77] 9.6% loop [3] 2.8% ??? [140] 2.8% ??? [173] 0.9% ??? [72] 0.5% return/no-unsupplied [145] 0.3% mk-egraph [83] 0.1% ??? [141] 0.1% -------------------------------------------------------------------------- for-loop [82] 50.0% f137 [75] 50.0% [78] 332(0.2%) 0(0.0%) expression->type ...ogging/src/type-check.rkt:45:0 for-loop [82] 100.0% -------------------------------------------------------------------------- f137 [75] 100.0% [79] 310(0.2%) 0(0.0%) ??? ...tract/private/arrow-higher-order.rkt:336:46 ??? [160] 100.0% -------------------------------------------------------------------------- table-ref [77] 100.0% [80] 121212(68.9%) 0(0.0%) iterate-egraph!13 ...g/src/core/simplify.rkt:102:0 one-iter [84] 99.2% -------------------------------------------------------------------------- table-ref [77] 100.0% [81] 104348(59.3%) 0(0.0%) for-loop ...ng-logging/src/core/simplify.rkt:63:12 table-ref [77] 100.0% -------------------------------------------------------------------------- expression->type [78] 100.0% [82] 332(0.2%) 0(0.0%) for-loop ...mpling-logging/src/type-check.rkt:52:5 expression->type [78] 50.0% f137 [75] 50.0% -------------------------------------------------------------------------- table-ref [77] 100.0% [83] 330(0.2%) 0(0.0%) mk-egraph ...ing-logging/src/core/egraph.rkt:123:0 expr->enode [85] 100.0% -------------------------------------------------------------------------- iterate-egraph!13 [80] 100.0% [84] 120216(68.4%) 1020(0.6%) one-iter ...ng-logging/src/core/simplify.rkt:113:0 loop [86] 71.9% for-loop [87] 23.6% apply-match [88] 3.7% -------------------------------------------------------------------------- mk-egraph [83] 33.3% expr->enode [85] 66.7% [85] 330(0.2%) 0(0.0%) expr->enode ...g-logging/src/core/egraph.rkt:124:2 expr->enode [85] 66.7% mk-enode! [95] 33.3% -------------------------------------------------------------------------- one-iter [84] 100.0% [86] 86428(49.1%) 0(0.0%) loop ...cket/collects/racket/private/map.rkt:52:19 apply-match [88] 100.0% -------------------------------------------------------------------------- for-loop [87] 49.4% one-iter [84] 50.6% [87] 28332(16.1%) 6142(3.5%) for-loop ...g-logging/src/core/simplify.rkt:123:12 for-loop [87] 49.4% match-e [90] 38.6% ??? [109] 0.6% -------------------------------------------------------------------------- one-iter [84] 4.9% loop [86] 95.1% [88] 90864(51.7%) 0(0.0%) apply-match ...logging/src/core/simplify.rkt:130:2 for-loop [89] 88.1% match-e [90] 8.2% update-leader! [97] 3.0% -------------------------------------------------------------------------- apply-match [88] 100.0% [89] 80058(45.5%) 666(0.4%) for-loop ...g-logging/src/core/simplify.rkt:145:10 loop! [96] 28.6% mk-enode! [95] 24.5% merge-egraph-nodes! [91] 24.4% substitute-e [93] 18.5% list-member? [94] 3.1% -------------------------------------------------------------------------- apply-match [88] 15.7% for-loop [98] 23.2% for-loop [87] 61.1% [90] 29274(16.6%) 8606(4.9%) match-e ...mpling-logging/src/core/ematch.rkt:46:0 for-loop [92] 44.6% for-loop [98] 11.0% ??? [127] 8.1% loop [47] 3.4% list-cartesian-product [99] 2.8% variable? [4] 1.3% -------------------------------------------------------------------------- for-loop [103] 2.4% merge-egraph-nodes! [91] 10.0% for-loop [89] 87.6% [91] 19574(11.1%) 658(0.4%) merge-egraph-nodes! ...g/src/core/egraph.rkt:152:0 update-leader! [97] 53.5% loop! [96] 17.9% merge-egraph-nodes! [91] 10.0% enode-merge! [101] 8.5% for-loop [105] 3.5% for-loop [103] 2.4% for-loop [104] 1.7% -------------------------------------------------------------------------- match-e [90] 100.0% [92] 16676(9.5%) 5430(3.1%) for-loop ...ling-logging/src/core/ematch.rkt:59:11 for-loop [98] 44.5% list-cartesian-product [99] 15.6% loop [47] 9.4% foldl [102] 1.1% -------------------------------------------------------------------------- substitute-e [93] 10.0% for-loop [89] 90.0% [93] 14828(8.4%) 726(0.4%) substitute-e ...g-logging/src/core/ematch.rkt:71:0 mk-enode! [95] 83.8% substitute-e [93] 10.0% ??? [127] 4.1% -------------------------------------------------------------------------- for-loop [89] 100.0% [94] 2478(1.4%) 0(0.0%) list-member? ...llects/racket/private/set.rkt:24:0 loop [100] 100.0% -------------------------------------------------------------------------- expr->enode [85] 1.0% substitute-e [93] 38.4% for-loop [89] 60.6% [95] 32368(18.4%) 690(0.4%) mk-enode! ...ing-logging/src/core/egraph.rkt:101:0 new-enode [106] 96.8% hash-has-key? [134] 1.1% -------------------------------------------------------------------------- merge-egraph-nodes! [91] 13.1% loop [47] 32.9% for-loop [89] 54.0% [96] 28282(16.1%) 5952(3.4%) loop! ...sampling-logging/src/core/enode.rkt:192:2 custom-set-union [117] 38.4% loop [47] 37.8% set [119] 10.8% update-en-expr [144] 3.0% -------------------------------------------------------------------------- apply-match [88] 19.8% merge-egraph-nodes! [91] 80.2% [97] 13548(7.7%) 1058(0.6%) update-leader! ...ogging/src/core/egraph.rkt:217:0 for-loop [107] 81.8% custom-set-union! [111] 8.0% make-sequence [113] 2.5% -------------------------------------------------------------------------- match-e [90] 42.1% for-loop [92] 57.9% [98] 13192(7.5%) 1052(0.6%) for-loop ...ling-logging/src/core/ematch.rkt:65:37 match-e [90] 89.3% ??? [109] 5.3% -------------------------------------------------------------------------- match-e [90] 16.5% list-cartesian-product [99] 28.6% for-loop [92] 55.0% [99] 4096(2.3%) 2704(1.5%) list-cartesian-product ...src/core/ematch.rkt:20:0 for-loop [108] 30.0% list-cartesian-product [99] 28.6% -------------------------------------------------------------------------- list-member? [94] 100.0% [100] 2478(1.4%) 2478(1.4%) loop (unknown source) -------------------------------------------------------------------------- merge-egraph-nodes! [91] 100.0% [101] 1660(0.9%) 0(0.0%) enode-merge! ...g-logging/src/core/enode.rkt:129:0 adopt-enode! [110] 80.0% custom-set-intersect! [114] 20.0% -------------------------------------------------------------------------- for-loop [92] 34.5% loop [47] 65.5% [102] 1038(0.6%) 0(0.0%) foldl ...et/collects/racket/private/list.rkt:229:4 merge2 [112] 100.0% -------------------------------------------------------------------------- merge-egraph-nodes! [91] 100.0% [103] 940(0.5%) 0(0.0%) for-loop ...ing-logging/src/core/egraph.rkt:200:10 merge-egraph-nodes! [91] 100.0% -------------------------------------------------------------------------- merge-egraph-nodes! [91] 34.8% *rules* [40] 65.2% [104] 932(0.5%) 0(0.0%) for-loop ...e/sampling-logging/src/common.rkt:99:9 ormap [115] 35.6% update-en-expr [144] 34.8% flag-set? [121] 29.6% -------------------------------------------------------------------------- merge-egraph-nodes! [91] 100.0% [105] 692(0.4%) 358(0.2%) for-loop ...ling-logging/src/core/egraph.rkt:232:6 update-en-expr [144] 48.3% -------------------------------------------------------------------------- mk-enode! [95] 100.0% [106] 31318(17.8%) 0(0.0%) new-enode ...pling-logging/src/core/enode.rkt:97:0 type-of-enode-expr [116] 96.6% set [119] 2.3% -------------------------------------------------------------------------- update-leader! [97] 100.0% [107] 11078(6.3%) 356(0.2%) for-loop ...ling-logging/src/core/egraph.rkt:222:6 for-loop [118] 96.8% -------------------------------------------------------------------------- list-cartesian-product [99] 100.0% [108] 1392(0.8%) 1392(0.8%) for-loop ...pling-logging/src/core/ematch.rkt:24:8 -------------------------------------------------------------------------- for-loop [87] 24.9% for-loop [98] 75.1% [109] 1390(0.8%) 684(0.4%) ??? ...e/sampling-logging/src/core/ematch.rkt:50:5 for-loop [120] 50.8% -------------------------------------------------------------------------- enode-merge! [101] 100.0% [110] 1328(0.8%) 0(0.0%) adopt-enode! ...g-logging/src/core/enode.rkt:105:0 custom-set-union [117] 100.0% -------------------------------------------------------------------------- update-leader! [97] 100.0% [111] 1078(0.6%) 718(0.4%) custom-set-union! ...t/private/set-types.rkt:245:0 for-loop [122] 33.4% -------------------------------------------------------------------------- foldl [102] 100.0% [112] 1038(0.6%) 1038(0.6%) merge2 ...ampling-logging/src/core/ematch.rkt:31:0 -------------------------------------------------------------------------- update-leader! [97] 100.0% [113] 334(0.2%) 334(0.2%) make-sequence ...ects/racket/private/for.rkt:509:2 -------------------------------------------------------------------------- enode-merge! [101] 100.0% [114] 332(0.2%) 332(0.2%) custom-set-intersect! ...ivate/set-types.rkt:269:0 -------------------------------------------------------------------------- for-loop [104] 100.0% [115] 332(0.2%) 0(0.0%) ormap ...et/collects/racket/private/map.rkt:105:13 flag-set? [121] 100.0% -------------------------------------------------------------------------- new-enode [106] 100.0% [116] 30260(17.2%) 692(0.4%) type-of-enode-expr ...ging/src/core/enode.rkt:68:0 get-sigs [123] 97.7% -------------------------------------------------------------------------- adopt-enode! [110] 9.4% loop! [96] 90.6% [117] 14066(8.0%) 3670(2.1%) custom-set-union ...et/private/set-types.rkt:168:0 for-loop [125] 59.6% for-loop [126] 14.3% -------------------------------------------------------------------------- for-loop [107] 100.0% [118] 10722(6.1%) 326(0.2%) for-loop ...ling-logging/src/core/egraph.rkt:223:8 hash-update! [124] 97.0% -------------------------------------------------------------------------- new-enode [106] 10.0% loop! [96] 90.0% [119] 7246(4.1%) 7246(4.1%) set ...collects/racket/private/set-types.rkt:981:0 -------------------------------------------------------------------------- ??? [109] 100.0% [120] 706(0.4%) 360(0.2%) for-loop ...pling-logging/src/core/ematch.rkt:51:7 ??? [127] 49.0% -------------------------------------------------------------------------- for-loop [104] 45.4% ormap [115] 54.6% [121] 608(0.3%) 0(0.0%) flag-set? .../sampling-logging/src/config.rkt:34:0 ??? [173] 54.6% return/no-unsupplied [145] 45.4% -------------------------------------------------------------------------- custom-set-union! [111] 100.0% [122] 360(0.2%) 360(0.2%) for-loop ...cts/racket/private/set-types.rkt:253:4 -------------------------------------------------------------------------- type-of-enode-expr [116] 100.0% [123] 29568(16.8%) 0(0.0%) get-sigs ...ampling-logging/src/type-check.rkt:5:0 ??? [128] 47.3% table-ref [77] 33.2% ??? [127] 12.8% ...gging/src/common.rkt:47:2 [131] 6.7% -------------------------------------------------------------------------- for-loop [118] 100.0% [124] 10396(5.9%) 0(0.0%) hash-update! ...ket/private/more-scheme.rkt:362:13 ??? [129] 100.0% -------------------------------------------------------------------------- custom-set-union [117] 100.0% [125] 8378(4.8%) 1318(0.7%) for-loop ...cts/racket/private/set-types.rkt:174:3 for-loop [130] 84.3% -------------------------------------------------------------------------- custom-set-union [117] 100.0% [126] 2018(1.1%) 2018(1.1%) for-loop ...cts/racket/private/set-types.rkt:152:2 -------------------------------------------------------------------------- ??? [160] 2.0% for-loop [120] 2.3% variable? [4] 6.6% substitute-e [93] 11.0% finalize-iter! [20] 23.0% get-sigs [123] 24.8% match-e [90] 30.3% [127] 15250(8.7%) 5642(3.2%) ??? ...contract/private/arrow-val-first.rkt:357:18 hash-has-key? [134] 40.0% for-loop [136] 20.9% atab-add-altns [138] 2.1% -------------------------------------------------------------------------- f137 [75] 2.2% get-sigs [123] 97.8% [128] 14290(8.1%) 332(0.2%) ??? ...ts/racket/contract/private/arr-i.rkt:804:10 for-loop [133] 48.2% ??? [135] 45.0% get/build-late-neg-projection [162] 2.3% ??? [139] 2.2% -------------------------------------------------------------------------- hash-update! [124] 100.0% [129] 10396(5.9%) 1324(0.8%) ??? ...sampling-logging/src/core/egraph.rkt:225:24 for-loop [132] 87.3% -------------------------------------------------------------------------- for-loop [125] 100.0% [130] 7060(4.0%) 7060(4.0%) for-loop ...cts/racket/private/set-types.rkt:178:5 -------------------------------------------------------------------------- get-sigs [123] 42.7% for-loop [26] 57.3% [131] 4660(2.6%) 1296(0.7%) ...gging/src/common.rkt:47:2 ...e/arr-i.rkt:906:19 ??? [156] 37.6% ??? [137] 34.5% -------------------------------------------------------------------------- ??? [129] 100.0% [132] 9072(5.2%) 8738(5.0%) for-loop ...ing-logging/src/core/egraph.rkt:226:26 update-en-expr [144] 3.7% -------------------------------------------------------------------------- for-loop [149] 12.3% ??? [128] 87.7% [133] 7854(4.5%) 1320(0.8%) for-loop ...racket/contract/private/hash.rkt:239:6 ??? [141] 83.2% -------------------------------------------------------------------------- mk-enode! [95] 5.6% ??? [127] 94.4% [134] 6458(3.7%) 2382(1.4%) hash-has-key? ...et/private/more-scheme.rkt:368:13 ??? [140] 63.1% -------------------------------------------------------------------------- ??? [128] 100.0% [135] 6430(3.7%) 356(0.2%) ??? ...ects/racket/contract/private/hash.rkt:217:4 ??? [142] 94.5% -------------------------------------------------------------------------- ??? [127] 100.0% [136] 3186(1.8%) 0(0.0%) for-loop ...ng-logging/src/core/alt-table.rkt:51:2 atab-add-altn [143] 100.0% -------------------------------------------------------------------------- ...gging/src/common.rkt:47:2 [131] 100.0% [137] 1610(0.9%) 326(0.2%) ??? ...s/racket/contract/private/arr-i.rkt:1268:39 return/no-unsupplied [145] 59.0% ??? [173] 20.7% -------------------------------------------------------------------------- ??? [127] 100.0% [138] 324(0.2%) 0(0.0%) atab-add-altns ...ging/src/core/alt-table.rkt:50:0 atab-add-altn [143] 100.0% -------------------------------------------------------------------------- ??? [128] 100.0% [139] 308(0.2%) 0(0.0%) ??? ...ects/racket/contract/private/hash.rkt:222:6 check-hash/c [146] 100.0% -------------------------------------------------------------------------- hash-has-key? [134] 28.0% table-ref [77] 72.0% [140] 14550(8.3%) 7332(4.2%) ??? ...ects/racket/contract/private/list.rkt:737:4 for-loop [149] 38.1% ??? [155] 11.5% -------------------------------------------------------------------------- table-ref [77] 3.5% ??? [156] 20.4% for-loop [133] 76.0% [141] 8592(4.9%) 688(0.4%) ??? ...cts/racket/contract/private/list.rkt:187:10 ??? [147] 72.2% for-loop [151] 15.5% ??? [156] 4.2% -------------------------------------------------------------------------- ??? [135] 100.0% [142] 6074(3.5%) 330(0.2%) ??? ...ects/racket/contract/private/list.rkt:169:2 ??? [148] 94.6% -------------------------------------------------------------------------- atab-add-altns [138] 9.2% for-loop [136] 90.8% [143] 3510(2.0%) 0(0.0%) atab-add-altn ...ging/src/core/alt-table.rkt:208:0 best-and-tied-at-points [150] 100.0% -------------------------------------------------------------------------- for-loop [104] 12.0% for-loop [132] 12.4% for-loop [105] 12.4% loop! [96] 63.2% [144] 2698(1.5%) 2698(1.5%) update-en-expr ...ogging/src/core/egraph.rkt:211:0 -------------------------------------------------------------------------- flag-set? [121] 16.9% table-ref [77] 25.0% ??? [137] 58.1% [145] 1634(0.9%) 1032(0.6%) return/no-unsupplied ...ct/private/arr-i.rkt:533:0 filter [152] 36.8% -------------------------------------------------------------------------- ??? [139] 100.0% [146] 308(0.2%) 308(0.2%) check-hash/c ...ket/contract/private/hash.rkt:83:0 -------------------------------------------------------------------------- ??? [141] 100.0% [147] 6206(3.5%) 0(0.0%) ??? ...ects/racket/contract/private/list.rkt:686:7 ??? [160] 94.7% ??? [158] 5.3% -------------------------------------------------------------------------- ??? [142] 100.0% [148] 5744(3.3%) 688(0.4%) ??? ...ects/racket/contract/private/list.rkt:678:5 for-loop [153] 88.0% -------------------------------------------------------------------------- ??? [140] 100.0% [149] 5538(3.1%) 3598(2.0%) for-loop ...acket/contract/private/list.rkt:743:12 for-loop [133] 17.4% ??? [155] 11.4% ??? [160] 6.1% -------------------------------------------------------------------------- atab-add-altn [143] 100.0% [150] 3510(2.0%) 0(0.0%) best-and-tied-at-points ...ore/alt-table.rkt:122:0 errors [154] 81.9% for-loop [157] 9.5% in-parallel [159] 8.7% -------------------------------------------------------------------------- ??? [141] 100.0% [151] 1334(0.8%) 628(0.4%) for-loop ...acket/contract/private/list.rkt:190:15 ??? [156] 52.9% -------------------------------------------------------------------------- return/no-unsupplied [145] 100.0% [152] 602(0.3%) 602(0.3%) filter ...t/collects/racket/private/list.rkt:256:2 -------------------------------------------------------------------------- ??? [148] 100.0% [153] 5056(2.9%) 1742(1.0%) for-loop ...racket/contract/private/list.rkt:680:9 get/build-late-neg-projection [162] 33.8% add-list-context [164] 31.8% -------------------------------------------------------------------------- option-on-expr [48] 11.2% best-and-tied-at-points [150] 88.8% [154] 3236(1.8%) 0(0.0%) errors ...ie/sampling-logging/src/points.rkt:229:0 for-loop [161] 89.9% eval-prog [54] 10.1% -------------------------------------------------------------------------- for-loop [149] 27.4% ??? [140] 72.6% [155] 2314(1.3%) 326(0.2%) ??? ...private/unconstrained-domain-arrow.rkt:74:4 make-keyword-procedure [163] 85.9% -------------------------------------------------------------------------- ??? [141] 10.4% for-loop [151] 20.1% ...gging/src/common.rkt:47:2 [131] 69.5% [156] 1754(1.0%) 712(0.4%) ??? ...ects/racket/contract/private/list.rkt:342:4 ??? [141] 69.5% ??? [160] 10.2% -------------------------------------------------------------------------- best-and-tied-at-points [150] 100.0% [157] 332(0.2%) 332(0.2%) for-loop ...-logging/src/core/alt-table.rkt:124:16 -------------------------------------------------------------------------- ??? [147] 100.0% [158] 326(0.2%) 326(0.2%) ??? ...ects/racket/contract/private/prop.rkt:493:4 -------------------------------------------------------------------------- best-and-tied-at-points [150] 100.0% [159] 304(0.2%) 304(0.2%) in-parallel ...lects/racket/private/for.rkt:1141:2 -------------------------------------------------------------------------- ??? [79] 4.5% for-loop [149] 4.9% ??? [156] 5.2% ??? [147] 85.4% [160] 6888(3.9%) 6220(3.5%) ??? ...ects/racket/contract/private/guts.rkt:644:8 contract? [168] 5.2% ??? [127] 4.5% -------------------------------------------------------------------------- errors [154] 100.0% [161] 2908(1.7%) 302(0.2%) for-loop .../sampling-logging/src/points.rkt:232:4 ??? [165] 44.4% ulp-difference [167] 22.8% ??? [72] 11.3% ??? [170] 11.1% -------------------------------------------------------------------------- ??? [169] 8.1% ??? [128] 8.1% for-loop [153] 83.7% [162] 2040(1.2%) 332(0.2%) get/build-late-neg-projection ...te/guts.rkt:691:0 ??? [166] 75.6% ??? [169] 8.1% -------------------------------------------------------------------------- ??? [155] 100.0% [163] 1988(1.1%) 1988(1.1%) make-keyword-procedure ...ket/private/kw.rkt:260:4 -------------------------------------------------------------------------- for-loop [153] 100.0% [164] 1606(0.9%) 1606(0.9%) add-list-context ...ontract/private/list.rkt:752:0 -------------------------------------------------------------------------- ??? [55] 1.0% ??? [59] 1.1% loop [68] 1.1% jloop [5] 1.1% for-loop [161] 4.1% loop [47] 91.5% [165] 31578(18.0%) 662(0.4%) ??? ...bie/sampling-logging/src/programs.rkt:154:4 ??? [171] 58.8% ??? [172] 37.0% ??? [72] 1.1% -------------------------------------------------------------------------- get/build-late-neg-projection [162]100.0% [166] 1708(1.0%) 684(0.4%) ??? ...cts/racket/contract/private/prop.rkt:314:12 build-compound-type-name [174] 60.0% -------------------------------------------------------------------------- for-loop [161] 100.0% [167] 662(0.4%) 300(0.2%) ulp-difference ...pling-logging/src/float.rkt:19:0 ??? [173] 54.7% -------------------------------------------------------------------------- ??? [160] 100.0% [168] 358(0.2%) 358(0.2%) contract? ...acket/contract/private/guts.rkt:109:0 -------------------------------------------------------------------------- get/build-late-neg-projection [162]100.0% [169] 332(0.2%) 0(0.0%) ??? ...ects/racket/contract/private/hash.rkt:211:2 get/build-late-neg-projection [162]100.0% -------------------------------------------------------------------------- for-loop [161] 100.0% [170] 324(0.2%) 324(0.2%) ??? ...ket/collects/racket/private/for.rkt:1151:14 -------------------------------------------------------------------------- ??? [165] 100.0% [171] 18580(10.6%) 5104(2.9%) ??? ...acket/collects/racket/private/kw.rkt:444:14 ??? [180] 46.6% bf* [176] 20.0% ??? [178] 4.0% -------------------------------------------------------------------------- ??? [72] 2.9% ??? [165] 97.1% [172] 12044(6.8%) 1108(0.6%) ??? ...contract/private/../../private/kw.rkt:761:9 real->bigfloat [175] 90.8% -------------------------------------------------------------------------- flag-set? [121] 13.7% ??? [137] 13.8% ulp-difference [167] 14.9% table-ref [77] 57.6% [173] 2422(1.4%) 1024(0.6%) ??? ...racket/collects/racket/private/kw.rkt:761:9 ??? [177] 57.7% -------------------------------------------------------------------------- ??? [166] 100.0% [174] 1024(0.6%) 692(0.4%) build-compound-type-name ...private/guts.rkt:448:0 contract-struct-name [179] 32.4% -------------------------------------------------------------------------- ??? [172] 100.0% [175] 10936(6.2%) 9568(5.4%) real->bigfloat .../private/bigfloat/mpfr.rkt:451:0 ??? [183] 12.5% -------------------------------------------------------------------------- ??? [171] 100.0% [176] 3716(2.1%) 0(0.0%) bf* ...ath/private/bigfloat/bigfloat-mpfr.rkt:95:0 ??? [180] 100.0% -------------------------------------------------------------------------- ??? [173] 100.0% [177] 1398(0.8%) 1398(0.8%) ??? ...s/racket/contract/private/arr-i.rkt:1233:27 -------------------------------------------------------------------------- ??? [171] 100.0% [178] 734(0.4%) 734(0.4%) ??? ...rivate/unconstrained-domain-arrow.rkt:40:13 -------------------------------------------------------------------------- build-compound-type-name [174] 100.0% [179] 332(0.2%) 332(0.2%) contract-struct-name ...ract/private/prop.rkt:89:0 -------------------------------------------------------------------------- eval-const-expr [52] 2.8% bf* [176] 29.2% ??? [171] 68.0% [180] 12732(7.2%) 3180(1.8%) ??? ...-racket/utils/simple-result-arrow.rkt:39:12 bflog [181] 39.3% bfadd [182] 35.7% -------------------------------------------------------------------------- ??? [180] 100.0% [181] 5004(2.8%) 2040(1.2%) bflog ...-lib/math/private/bigfloat/mpfr.rkt:616:4 ??? [183] 59.2% -------------------------------------------------------------------------- ??? [180] 100.0% [182] 4548(2.6%) 2724(1.5%) bfadd ...-lib/math/private/bigfloat/mpfr.rkt:819:4 ??? [183] 40.1% -------------------------------------------------------------------------- real->bigfloat [175] 22.2% bfadd [182] 29.6% bflog [181] 48.1% [183] 6156(3.5%) 6156(3.5%) ??? .../share/racket/collects/ffi/unsafe.rkt:861:4 --------------------------------------------------------------------------