builder: mozilla-central_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-072 starttime: 1487807956.81 results: success (0) revision: 32dcdde1fc64fc39a9065dc4218265dbc727673f ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-02-22 15:59:16.813665) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-02-22 15:59:16.814122) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-22 15:59:16.814404) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-22 15:59:16.830465) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-22 15:59:16.830718) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-02-22 15:59:17-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 211M=0s 2017-02-22 15:59:17 (211 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.112492 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-22 15:59:16.956299) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-22 15:59:16.956599) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019932 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-22 15:59:17.006009) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-02-22 15:59:17.006374) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 32dcdde1fc64fc39a9065dc4218265dbc727673f --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev 32dcdde1fc64fc39a9065dc4218265dbc727673f --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-02-22 15:59:17,407 truncating revision to first 12 chars 2017-02-22 15:59:17,407 Setting DEBUG logging. 2017-02-22 15:59:17,407 attempt 1/10 2017-02-22 15:59:17,407 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/32dcdde1fc64?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-02-22 15:59:18,597 unpacking tar archive at: mozilla-central-32dcdde1fc64/testing/mozharness/ program finished with exit code 0 elapsedTime=1.471047 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-02-22 15:59:18.490272) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-22 15:59:18.490596) ========= script_repo_revision: 32dcdde1fc64fc39a9065dc4218265dbc727673f ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-22 15:59:18.490954) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-22 15:59:18.491243) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-22 15:59:18.499146) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 53 secs) (at 2017-02-22 15:59:18.499482) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 15:59:18 INFO - MultiFileLogger online at 20170222 15:59:18 in /builds/slave/test 15:59:18 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 15:59:18 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 15:59:18 INFO - {'append_to_log': False, 15:59:18 INFO - 'base_work_dir': '/builds/slave/test', 15:59:18 INFO - 'blob_upload_branch': 'Firefox', 15:59:18 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 15:59:18 INFO - 'branch': 'Firefox', 15:59:18 INFO - 'buildbot_json_path': 'buildprops.json', 15:59:18 INFO - 'config_files': ('talos/linux_config.py',), 15:59:18 INFO - 'default_actions': ('clobber', 15:59:18 INFO - 'read-buildbot-config', 15:59:18 INFO - 'download-and-extract', 15:59:18 INFO - 'populate-webroot', 15:59:18 INFO - 'create-virtualenv', 15:59:18 INFO - 'install', 15:59:18 INFO - 'run-tests'), 15:59:18 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 15:59:18 INFO - 'download_minidump_stackwalk': True, 15:59:18 INFO - 'download_symbols': 'ondemand', 15:59:18 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 15:59:18 INFO - 'tooltool.py': '/tools/tooltool.py', 15:59:18 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 15:59:18 INFO - '/tools/misc-python/virtualenv.py')}, 15:59:18 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 15:59:18 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 15:59:18 INFO - 'gecko_profile': False, 15:59:18 INFO - 'gecko_profile_interval': 0, 15:59:18 INFO - 'installer_path': 'installer.exe', 15:59:18 INFO - 'log_level': 'info', 15:59:18 INFO - 'log_name': 'talos', 15:59:18 INFO - 'log_to_console': True, 15:59:18 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 15:59:18 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 15:59:18 INFO - 'opt_config_files': (), 15:59:18 INFO - 'pip_index': False, 15:59:18 INFO - 'suite': 'dromaeojs', 15:59:18 INFO - 'system_bits': '32', 15:59:18 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 15:59:18 INFO - 'title': 'talos-linux64-ix-072', 15:59:18 INFO - 'tooltool_cache': '/builds/tooltool_cache', 15:59:18 INFO - 'use_talos_json': True, 15:59:18 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 15:59:18 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 15:59:18 INFO - 'work_dir': 'build'} 15:59:18 INFO - [mozharness: 2017-02-22 23:59:18.999576Z] Running clobber step. 15:59:18 INFO - Running pre-action listener: _resource_record_pre_action 15:59:18 INFO - Running main action method: clobber 15:59:18 INFO - rmtree: /builds/slave/test/build 15:59:19 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 15:59:19 INFO - Running post-action listener: _resource_record_post_action 15:59:19 INFO - [mozharness: 2017-02-22 23:59:19.928209Z] Finished clobber step (success) 15:59:19 INFO - [mozharness: 2017-02-22 23:59:19.928310Z] Running read-buildbot-config step. 15:59:19 INFO - Running pre-action listener: _resource_record_pre_action 15:59:19 INFO - Running main action method: read_buildbot_config 15:59:19 INFO - Using buildbot properties: 15:59:19 INFO - { 15:59:19 INFO - "project": "", 15:59:19 INFO - "product": "firefox", 15:59:19 INFO - "who": "kwierso@gmail.com", 15:59:19 INFO - "installer_path": "public/build/target.tar.bz2", 15:59:19 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 15:59:19 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 15:59:19 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs", 15:59:19 INFO - "stage_platform": "linux64-pgo", 15:59:19 INFO - "basedir": "/builds/slave/test", 15:59:19 INFO - "buildnumber": 51, 15:59:19 INFO - "platform": "ubuntu64_hw", 15:59:19 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 15:59:19 INFO - "slavebuilddir": "test", 15:59:19 INFO - "taskId": "S8BRI-9XRKaJazrLPMwiHw", 15:59:19 INFO - "branch": "mozilla-central", 15:59:19 INFO - "script_repo_revision": "production", 15:59:19 INFO - "revision": "32dcdde1fc64fc39a9065dc4218265dbc727673f", 15:59:19 INFO - "slavename": "talos-linux64-ix-072", 15:59:19 INFO - "repo_path": "mozilla-central" 15:59:19 INFO - } 15:59:19 INFO - Finding installer, test and symbols from parent task. 15:59:19 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/S8BRI-9XRKaJazrLPMwiHw'}, attempt #1 15:59:20 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/S8BRI-9XRKaJazrLPMwiHw'}, attempt #1 15:59:20 INFO - Task dependencies: a8I4NPFaQGWZJQtez1bQeg 15:59:20 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg'}, attempt #1 15:59:21 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.tar.bz2 15:59:21 INFO - Set test_url: https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/test_packages.json 15:59:21 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.crashreporter-symbols.zip 15:59:21 INFO - Running post-action listener: _resource_record_post_action 15:59:21 INFO - [mozharness: 2017-02-22 23:59:21.367710Z] Finished read-buildbot-config step (success) 15:59:21 INFO - [mozharness: 2017-02-22 23:59:21.367927Z] Running download-and-extract step. 15:59:21 INFO - Running pre-action listener: _resource_record_pre_action 15:59:21 INFO - Running main action method: download_and_extract 15:59:21 INFO - mkdir: /builds/slave/test/build/tests 15:59:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:59:21 INFO - trying https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.test_packages.json 15:59:21 INFO - Downloading https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 15:59:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 15:59:21 INFO - Downloaded 896 bytes. 15:59:21 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 15:59:21 INFO - Using the following test package requirements: 15:59:21 INFO - {u'common': [u'target.common.tests.zip'], 15:59:21 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 15:59:21 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 15:59:21 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 15:59:21 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 15:59:21 INFO - u'mozbase': [u'target.common.tests.zip'], 15:59:21 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 15:59:21 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 15:59:21 INFO - u'web-platform': [u'target.common.tests.zip', 15:59:21 INFO - u'target.web-platform.tests.zip'], 15:59:21 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 15:59:21 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 15:59:21 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.common.tests.zip 15:59:21 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.common.tests.zip'}, attempt #1 15:59:21 INFO - Fetch https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.common.tests.zip into memory 15:59:23 INFO - Expected file size: 59335029 15:59:23 INFO - Obtained file size: 59335029 15:59:32 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 15:59:32 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.common.tests.zip 15:59:32 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.common.tests.zip'}, attempt #1 15:59:32 INFO - Fetch https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.common.tests.zip into memory 15:59:34 INFO - Expected file size: 59335029 15:59:34 INFO - Obtained file size: 59335029 15:59:44 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.talos.tests.zip 15:59:44 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.talos.tests.zip'}, attempt #1 15:59:44 INFO - Fetch https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.talos.tests.zip into memory 15:59:45 INFO - Expected file size: 14404319 15:59:45 INFO - Obtained file size: 14404319 15:59:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:59:45 INFO - trying https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.tar.bz2 15:59:45 INFO - Downloading https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 15:59:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 15:59:46 INFO - Downloaded 66931295 bytes. 15:59:46 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.tar.bz2 15:59:46 INFO - mkdir: /builds/slave/test/properties 15:59:46 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 15:59:46 INFO - Writing to file /builds/slave/test/properties/build_url 15:59:46 INFO - Contents: 15:59:46 INFO - build_url:https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.tar.bz2 15:59:46 INFO - Running post-action listener: _resource_record_post_action 15:59:46 INFO - Running post-action listener: set_extra_try_arguments 15:59:46 INFO - [mozharness: 2017-02-22 23:59:46.848407Z] Finished download-and-extract step (success) 15:59:46 INFO - [mozharness: 2017-02-22 23:59:46.848504Z] Running populate-webroot step. 15:59:46 INFO - Running pre-action listener: _resource_record_pre_action 15:59:46 INFO - Running main action method: populate_webroot 15:59:46 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 15:59:46 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 15:59:46 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 15:59:46 INFO - '--tppagecycles', 15:59:46 INFO - '7'], 15:59:46 INFO - 'tests': ['tsvgm']}}, 15:59:46 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 15:59:46 INFO - 'tests': ['tresize', 'tcanvasmark']}, 15:59:46 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 15:59:46 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 15:59:46 INFO - 'tests': ['dromaeo_css', 'kraken']}, 15:59:46 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 15:59:46 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 15:59:46 INFO - 'talos_options': ['--disable-e10s'], 15:59:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:59:46 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 15:59:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:59:46 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 15:59:46 INFO - 'talos_options': ['--disable-e10s'], 15:59:46 INFO - 'tests': ['damp', 'tps']}, 15:59:46 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 15:59:46 INFO - 'tests': ['damp', 'tps']}, 15:59:46 INFO - 'g3': {'talos_options': ['--disable-e10s'], 15:59:46 INFO - 'tests': ['dromaeo_dom']}, 15:59:46 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 15:59:46 INFO - 'g4': {'talos_options': ['--disable-e10s'], 15:59:46 INFO - 'tests': ['basic_compositor_video']}, 15:59:46 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 15:59:46 INFO - 'other': {'talos_options': ['--disable-e10s'], 15:59:46 INFO - 'tests': ['a11yr', 15:59:46 INFO - 'ts_paint', 15:59:46 INFO - 'tpaint', 15:59:46 INFO - 'sessionrestore', 15:59:46 INFO - 'sessionrestore_no_auto_restore', 15:59:46 INFO - 'tabpaint']}, 15:59:46 INFO - 'other-e10s': {'tests': ['a11yr', 15:59:46 INFO - 'ts_paint', 15:59:46 INFO - 'tpaint', 15:59:46 INFO - 'sessionrestore', 15:59:46 INFO - 'sessionrestore_no_auto_restore', 15:59:46 INFO - 'tabpaint']}, 15:59:46 INFO - 'other-e10s_l64': {'tests': ['a11yr', 15:59:46 INFO - 'ts_paint', 15:59:46 INFO - 'tpaint', 15:59:46 INFO - 'sessionrestore', 15:59:46 INFO - 'sessionrestore_no_auto_restore', 15:59:46 INFO - 'tabpaint']}, 15:59:46 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 15:59:46 INFO - 'ts_paint', 15:59:46 INFO - 'tpaint', 15:59:46 INFO - 'sessionrestore', 15:59:46 INFO - 'sessionrestore_no_auto_restore', 15:59:46 INFO - 'tabpaint']}, 15:59:46 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 15:59:46 INFO - 'tests': ['a11yr', 15:59:46 INFO - 'ts_paint', 15:59:46 INFO - 'tpaint', 15:59:46 INFO - 'sessionrestore', 15:59:46 INFO - 'sessionrestore_no_auto_restore', 15:59:46 INFO - 'tabpaint']}, 15:59:46 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 15:59:46 INFO - 'tests': ['a11yr', 15:59:46 INFO - 'ts_paint', 15:59:46 INFO - 'tpaint', 15:59:46 INFO - 'sessionrestore', 15:59:46 INFO - 'sessionrestore_no_auto_restore', 15:59:46 INFO - 'tabpaint']}, 15:59:46 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 15:59:46 INFO - 'tests': ['tsvgx', 15:59:46 INFO - 'tsvgr_opacity', 15:59:46 INFO - 'tart', 15:59:46 INFO - 'tscrollx', 15:59:46 INFO - 'cart', 15:59:46 INFO - 'tsvg_static']}, 15:59:46 INFO - 'svgr-e10s': {'tests': ['tsvgx', 15:59:46 INFO - 'tsvgr_opacity', 15:59:46 INFO - 'tart', 15:59:46 INFO - 'tscrollx', 15:59:46 INFO - 'cart', 15:59:46 INFO - 'tsvg_static']}, 15:59:46 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 15:59:46 INFO - 'talos_options': ['--disable-e10s'], 15:59:46 INFO - 'tests': ['tp5o']}, 15:59:46 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 15:59:46 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 15:59:46 INFO - 'talos_options': ['--disable-e10s', 15:59:46 INFO - '--xperf_path', 15:59:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:59:46 INFO - 'tests': ['tp5n']}, 15:59:46 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 15:59:46 INFO - 'talos_options': ['--xperf_path', 15:59:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:59:46 INFO - 'tests': ['tp5n']}}, 15:59:46 INFO - 'talos.zip': {'path': '', 15:59:46 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 15:59:46 INFO - Running post-action listener: _resource_record_post_action 15:59:46 INFO - [mozharness: 2017-02-22 23:59:46.861522Z] Finished populate-webroot step (success) 15:59:46 INFO - [mozharness: 2017-02-22 23:59:46.861614Z] Running create-virtualenv step. 15:59:46 INFO - Running pre-action listener: _resource_record_pre_action 15:59:46 INFO - Running main action method: create_virtualenv 15:59:46 INFO - Creating virtualenv /builds/slave/test/build/venv 15:59:46 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 15:59:46 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 15:59:46 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 15:59:46 INFO - Using real prefix '/usr' 15:59:46 INFO - New python executable in /builds/slave/test/build/venv/bin/python 15:59:47 INFO - Installing distribute.............................................................................................................................................................................................done. 15:59:49 INFO - Installing pip.................done. 15:59:49 INFO - Return code: 0 15:59:49 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 15:59:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 15:59:49 INFO - Reading from file tmpfile_stdout 15:59:49 INFO - Output received: 15:59:49 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 15:59:49 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 15:59:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:59:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:59:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:59:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:59:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x245f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x249ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26fd310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fa400>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fb3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26fb840>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 15:59:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 15:59:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 15:59:49 INFO - Using env: {'DISPLAY': ':0', 15:59:49 INFO - 'HOME': '/home/cltbld', 15:59:49 INFO - 'LANG': 'en_US.UTF-8', 15:59:49 INFO - 'LANGUAGE': 'en_US:en', 15:59:49 INFO - 'LOGNAME': 'cltbld', 15:59:49 INFO - 'MAIL': '/var/mail/cltbld', 15:59:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:59:49 INFO - 'MOZ_NO_REMOTE': '1', 15:59:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:59:49 INFO - 'NO_EM_RESTART': '1', 15:59:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:59:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:59:49 INFO - 'PWD': '/builds/slave/test', 15:59:49 INFO - 'SHELL': '/bin/bash', 15:59:49 INFO - 'SHLVL': '1', 15:59:49 INFO - 'TERM': 'linux', 15:59:49 INFO - 'TMOUT': '86400', 15:59:49 INFO - 'USER': 'cltbld', 15:59:49 INFO - 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 15:59:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:59:49 INFO - '_': '/tools/buildbot/bin/python'} 15:59:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:59:49 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 15:59:49 INFO - Cleaning up... 15:59:49 INFO - Return code: 0 15:59:49 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 15:59:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:59:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:59:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:59:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:59:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x245f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x249ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26fd310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fa400>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fb3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26fb840>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 15:59:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 15:59:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 15:59:49 INFO - Using env: {'DISPLAY': ':0', 15:59:49 INFO - 'HOME': '/home/cltbld', 15:59:49 INFO - 'LANG': 'en_US.UTF-8', 15:59:49 INFO - 'LANGUAGE': 'en_US:en', 15:59:49 INFO - 'LOGNAME': 'cltbld', 15:59:49 INFO - 'MAIL': '/var/mail/cltbld', 15:59:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:59:49 INFO - 'MOZ_NO_REMOTE': '1', 15:59:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:59:49 INFO - 'NO_EM_RESTART': '1', 15:59:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:59:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:59:49 INFO - 'PWD': '/builds/slave/test', 15:59:49 INFO - 'SHELL': '/bin/bash', 15:59:49 INFO - 'SHLVL': '1', 15:59:49 INFO - 'TERM': 'linux', 15:59:49 INFO - 'TMOUT': '86400', 15:59:49 INFO - 'USER': 'cltbld', 15:59:49 INFO - 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 15:59:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:59:49 INFO - '_': '/tools/buildbot/bin/python'} 15:59:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:59:50 INFO - Downloading/unpacking psutil>=3.1.1 15:59:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:59:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:59:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:59:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:59:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:59:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:59:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 15:59:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:59:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:59:52 INFO - Installing collected packages: psutil 15:59:52 INFO - Running setup.py install for psutil 15:59:52 INFO - building 'psutil._psutil_linux' extension 15:59:52 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 15:59:52 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 15:59:52 INFO - building 'psutil._psutil_posix' extension 15:59:52 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 15:59:52 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 15:59:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:59:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:59:52 INFO - Successfully installed psutil 15:59:52 INFO - Cleaning up... 15:59:52 INFO - Return code: 0 15:59:52 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 15:59:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:59:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:59:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:59:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:59:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:52 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x245f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x249ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26fd310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fa400>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fb3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26fb840>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 15:59:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 15:59:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 15:59:52 INFO - Using env: {'DISPLAY': ':0', 15:59:52 INFO - 'HOME': '/home/cltbld', 15:59:52 INFO - 'LANG': 'en_US.UTF-8', 15:59:52 INFO - 'LANGUAGE': 'en_US:en', 15:59:52 INFO - 'LOGNAME': 'cltbld', 15:59:52 INFO - 'MAIL': '/var/mail/cltbld', 15:59:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:59:52 INFO - 'MOZ_NO_REMOTE': '1', 15:59:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:59:52 INFO - 'NO_EM_RESTART': '1', 15:59:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:59:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:59:52 INFO - 'PWD': '/builds/slave/test', 15:59:52 INFO - 'SHELL': '/bin/bash', 15:59:52 INFO - 'SHLVL': '1', 15:59:52 INFO - 'TERM': 'linux', 15:59:52 INFO - 'TMOUT': '86400', 15:59:52 INFO - 'USER': 'cltbld', 15:59:52 INFO - 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 15:59:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:59:52 INFO - '_': '/tools/buildbot/bin/python'} 15:59:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:59:53 INFO - Downloading/unpacking mozsystemmonitor==0.3 15:59:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:59:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:59:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:59:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:59:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:59:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:59:55 INFO - Downloading mozsystemmonitor-0.3.tar.gz 15:59:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 15:59:55 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 15:59:55 INFO - Installing collected packages: mozsystemmonitor 15:59:55 INFO - Running setup.py install for mozsystemmonitor 15:59:55 INFO - Successfully installed mozsystemmonitor 15:59:55 INFO - Cleaning up... 15:59:55 INFO - Return code: 0 15:59:55 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 15:59:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:59:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:59:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:59:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:59:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:55 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x245f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x249ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26fd310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fa400>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fb3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26fb840>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 15:59:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 15:59:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 15:59:55 INFO - Using env: {'DISPLAY': ':0', 15:59:55 INFO - 'HOME': '/home/cltbld', 15:59:55 INFO - 'LANG': 'en_US.UTF-8', 15:59:55 INFO - 'LANGUAGE': 'en_US:en', 15:59:55 INFO - 'LOGNAME': 'cltbld', 15:59:55 INFO - 'MAIL': '/var/mail/cltbld', 15:59:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:59:55 INFO - 'MOZ_NO_REMOTE': '1', 15:59:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:59:55 INFO - 'NO_EM_RESTART': '1', 15:59:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:59:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:59:55 INFO - 'PWD': '/builds/slave/test', 15:59:55 INFO - 'SHELL': '/bin/bash', 15:59:55 INFO - 'SHLVL': '1', 15:59:55 INFO - 'TERM': 'linux', 15:59:55 INFO - 'TMOUT': '86400', 15:59:55 INFO - 'USER': 'cltbld', 15:59:55 INFO - 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 15:59:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:59:55 INFO - '_': '/tools/buildbot/bin/python'} 15:59:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:59:55 INFO - Downloading/unpacking jsonschema==2.5.1 15:59:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:59:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:59:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:59:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:59:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:59:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:59:57 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 15:59:57 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 15:59:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:59:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:59:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:59:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:59:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:59:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:59:57 INFO - Downloading functools32-3.2.3-2.tar.gz 15:59:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 15:59:57 INFO - warning: no files found matching '*.txt' 15:59:57 INFO - no previously-included directories found matching 'build' 15:59:57 INFO - no previously-included directories found matching 'dist' 15:59:57 INFO - no previously-included directories found matching '.git*' 15:59:57 INFO - Installing collected packages: jsonschema, functools32 15:59:57 INFO - Running setup.py install for functools32 15:59:57 INFO - warning: no files found matching '*.txt' 15:59:57 INFO - no previously-included directories found matching 'build' 15:59:57 INFO - no previously-included directories found matching 'dist' 15:59:57 INFO - no previously-included directories found matching '.git*' 15:59:57 INFO - Successfully installed jsonschema functools32 15:59:57 INFO - Cleaning up... 15:59:57 INFO - Return code: 0 15:59:57 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 15:59:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:59:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:59:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:59:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:59:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x245f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x249ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26fd310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fa400>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fb3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26fb840>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 15:59:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 15:59:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 15:59:58 INFO - Using env: {'DISPLAY': ':0', 15:59:58 INFO - 'HOME': '/home/cltbld', 15:59:58 INFO - 'LANG': 'en_US.UTF-8', 15:59:58 INFO - 'LANGUAGE': 'en_US:en', 15:59:58 INFO - 'LOGNAME': 'cltbld', 15:59:58 INFO - 'MAIL': '/var/mail/cltbld', 15:59:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:59:58 INFO - 'MOZ_NO_REMOTE': '1', 15:59:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:59:58 INFO - 'NO_EM_RESTART': '1', 15:59:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:59:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:59:58 INFO - 'PWD': '/builds/slave/test', 15:59:58 INFO - 'SHELL': '/bin/bash', 15:59:58 INFO - 'SHLVL': '1', 15:59:58 INFO - 'TERM': 'linux', 15:59:58 INFO - 'TMOUT': '86400', 15:59:58 INFO - 'USER': 'cltbld', 15:59:58 INFO - 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 15:59:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:59:58 INFO - '_': '/tools/buildbot/bin/python'} 15:59:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:59:58 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 15:59:58 INFO - Cleaning up... 15:59:58 INFO - Return code: 0 15:59:58 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 15:59:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:59:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:59:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:59:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:59:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x245f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x249ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26fd310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fa400>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fb3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26fb840>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 15:59:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 15:59:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 15:59:58 INFO - Using env: {'DISPLAY': ':0', 15:59:58 INFO - 'HOME': '/home/cltbld', 15:59:58 INFO - 'LANG': 'en_US.UTF-8', 15:59:58 INFO - 'LANGUAGE': 'en_US:en', 15:59:58 INFO - 'LOGNAME': 'cltbld', 15:59:58 INFO - 'MAIL': '/var/mail/cltbld', 15:59:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:59:58 INFO - 'MOZ_NO_REMOTE': '1', 15:59:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:59:58 INFO - 'NO_EM_RESTART': '1', 15:59:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:59:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:59:58 INFO - 'PWD': '/builds/slave/test', 15:59:58 INFO - 'SHELL': '/bin/bash', 15:59:58 INFO - 'SHLVL': '1', 15:59:58 INFO - 'TERM': 'linux', 15:59:58 INFO - 'TMOUT': '86400', 15:59:58 INFO - 'USER': 'cltbld', 15:59:58 INFO - 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 15:59:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:59:58 INFO - '_': '/tools/buildbot/bin/python'} 15:59:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:59:58 INFO - Downloading/unpacking blobuploader==1.2.4 15:59:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:59:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:59:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:59:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:59:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:59:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:00:00 INFO - Downloading blobuploader-1.2.4.tar.gz 16:00:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 16:00:00 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:00:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:00:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:00:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:00:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:00:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:00:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:00:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 16:00:00 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:00:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:00:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:00:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:00:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:00:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:00:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:00:01 INFO - Downloading docopt-0.6.1.tar.gz 16:00:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 16:00:01 INFO - Installing collected packages: blobuploader, requests, docopt 16:00:01 INFO - Running setup.py install for blobuploader 16:00:01 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 16:00:01 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 16:00:01 INFO - Running setup.py install for requests 16:00:01 INFO - Running setup.py install for docopt 16:00:01 INFO - Successfully installed blobuploader requests docopt 16:00:01 INFO - Cleaning up... 16:00:01 INFO - Return code: 0 16:00:01 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:00:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:00:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:00:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:00:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:00:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:00:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:00:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x245f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x249ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26fd310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fa400>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fb3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26fb840>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:00:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 16:00:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:00:01 INFO - Using env: {'DISPLAY': ':0', 16:00:01 INFO - 'HOME': '/home/cltbld', 16:00:01 INFO - 'LANG': 'en_US.UTF-8', 16:00:01 INFO - 'LANGUAGE': 'en_US:en', 16:00:01 INFO - 'LOGNAME': 'cltbld', 16:00:01 INFO - 'MAIL': '/var/mail/cltbld', 16:00:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:00:01 INFO - 'MOZ_NO_REMOTE': '1', 16:00:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:00:01 INFO - 'NO_EM_RESTART': '1', 16:00:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:00:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:00:01 INFO - 'PWD': '/builds/slave/test', 16:00:01 INFO - 'SHELL': '/bin/bash', 16:00:01 INFO - 'SHLVL': '1', 16:00:01 INFO - 'TERM': 'linux', 16:00:01 INFO - 'TMOUT': '86400', 16:00:01 INFO - 'USER': 'cltbld', 16:00:01 INFO - 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 16:00:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:00:01 INFO - '_': '/tools/buildbot/bin/python'} 16:00:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:00:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:00:02 INFO - Running setup.py (path:/tmp/pip-LGqywl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:00:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:00:02 INFO - Running setup.py (path:/tmp/pip-513aB0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:00:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:00:02 INFO - Running setup.py (path:/tmp/pip-f2U6Ul-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:00:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:00:02 INFO - Running setup.py (path:/tmp/pip-9GNgqt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:00:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:00:02 INFO - Running setup.py (path:/tmp/pip-5aaJ6T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:00:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:00:02 INFO - Running setup.py (path:/tmp/pip-Oid3Qa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:00:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:00:02 INFO - Running setup.py (path:/tmp/pip-74m9W1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:00:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:00:02 INFO - Running setup.py (path:/tmp/pip-n3Epj1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:00:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:00:02 INFO - Running setup.py (path:/tmp/pip-Hg8p7B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:00:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:00:02 INFO - Running setup.py (path:/tmp/pip-ikWF4G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:00:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:00:02 INFO - Running setup.py (path:/tmp/pip-S2gRt0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:00:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:00:02 INFO - Running setup.py (path:/tmp/pip-DYFATu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:00:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:00:02 INFO - Running setup.py (path:/tmp/pip-t2EJVM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:00:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:00:03 INFO - Running setup.py (path:/tmp/pip-MGYyiL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:00:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:00:03 INFO - Running setup.py (path:/tmp/pip-KGPhng-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:00:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:00:03 INFO - Running setup.py (path:/tmp/pip-JFrp6n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:00:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:00:03 INFO - Running setup.py (path:/tmp/pip-6zvvTa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:00:03 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:00:03 INFO - Running setup.py install for manifestparser 16:00:03 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 16:00:03 INFO - Running setup.py install for mozcrash 16:00:03 INFO - Running setup.py install for mozdebug 16:00:03 INFO - Running setup.py install for mozdevice 16:00:03 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 16:00:03 INFO - Installing dm script to /builds/slave/test/build/venv/bin 16:00:03 INFO - Running setup.py install for mozfile 16:00:03 INFO - Running setup.py install for mozhttpd 16:00:03 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 16:00:03 INFO - Running setup.py install for mozinfo 16:00:03 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 16:00:03 INFO - Running setup.py install for mozInstall 16:00:04 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 16:00:04 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 16:00:04 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 16:00:04 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 16:00:04 INFO - Running setup.py install for mozleak 16:00:04 INFO - Running setup.py install for mozlog 16:00:04 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 16:00:04 INFO - Running setup.py install for moznetwork 16:00:04 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 16:00:04 INFO - Running setup.py install for mozprocess 16:00:04 INFO - Running setup.py install for mozprofile 16:00:04 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 16:00:04 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 16:00:04 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 16:00:04 INFO - Running setup.py install for mozrunner 16:00:04 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 16:00:04 INFO - Running setup.py install for mozscreenshot 16:00:04 INFO - Running setup.py install for moztest 16:00:04 INFO - Running setup.py install for mozversion 16:00:05 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 16:00:05 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:00:05 INFO - Cleaning up... 16:00:05 INFO - Return code: 0 16:00:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:00:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:00:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:00:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:00:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:00:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:00:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:00:05 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x245f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x249ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26fd310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fa400>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fb3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26fb840>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:00:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 16:00:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:00:05 INFO - Using env: {'DISPLAY': ':0', 16:00:05 INFO - 'HOME': '/home/cltbld', 16:00:05 INFO - 'LANG': 'en_US.UTF-8', 16:00:05 INFO - 'LANGUAGE': 'en_US:en', 16:00:05 INFO - 'LOGNAME': 'cltbld', 16:00:05 INFO - 'MAIL': '/var/mail/cltbld', 16:00:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:00:05 INFO - 'MOZ_NO_REMOTE': '1', 16:00:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:00:05 INFO - 'NO_EM_RESTART': '1', 16:00:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:00:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:00:05 INFO - 'PWD': '/builds/slave/test', 16:00:05 INFO - 'SHELL': '/bin/bash', 16:00:05 INFO - 'SHLVL': '1', 16:00:05 INFO - 'TERM': 'linux', 16:00:05 INFO - 'TMOUT': '86400', 16:00:05 INFO - 'USER': 'cltbld', 16:00:05 INFO - 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 16:00:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:00:05 INFO - '_': '/tools/buildbot/bin/python'} 16:00:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:00:05 INFO - Running setup.py (path:/tmp/pip-6xJDuf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:00:05 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 16:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:00:05 INFO - Running setup.py (path:/tmp/pip-oxhvOP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:00:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 16:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:00:05 INFO - Running setup.py (path:/tmp/pip-8WFQp4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:00:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 16:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:00:05 INFO - Running setup.py (path:/tmp/pip-X0gJ0P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:00:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:00:05 INFO - Running setup.py (path:/tmp/pip-CuHb_o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:00:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 16:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:00:05 INFO - Running setup.py (path:/tmp/pip-9ge3vt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:00:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 16:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:00:05 INFO - Running setup.py (path:/tmp/pip-Vxcp17-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:00:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 16:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:00:05 INFO - Running setup.py (path:/tmp/pip-ky8uQT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:00:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 16:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:00:05 INFO - Running setup.py (path:/tmp/pip-eRX49N-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:00:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 16:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:00:05 INFO - Running setup.py (path:/tmp/pip-qnNITF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:00:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:00:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:00:06 INFO - Running setup.py (path:/tmp/pip-RSdCXY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:00:06 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 16:00:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:00:06 INFO - Running setup.py (path:/tmp/pip-_mMuQF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:00:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 16:00:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:00:06 INFO - Running setup.py (path:/tmp/pip-K1wsvN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:00:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 16:00:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:00:06 INFO - Running setup.py (path:/tmp/pip-6o1ifw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:00:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 16:00:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:00:06 INFO - Running setup.py (path:/tmp/pip-2znvKp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:00:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 16:00:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:00:06 INFO - Running setup.py (path:/tmp/pip-ge3rSf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:00:06 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 16:00:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:00:06 INFO - Running setup.py (path:/tmp/pip-QKhUz1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:00:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 16:00:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 16:00:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 16:00:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 16:00:06 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:00:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:00:06 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:00:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:00:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:00:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:00:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:00:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:00:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:00:08 INFO - Downloading blessings-1.6.tar.gz 16:00:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 16:00:08 INFO - Installing collected packages: blessings 16:00:08 INFO - Running setup.py install for blessings 16:00:08 INFO - Successfully installed blessings 16:00:08 INFO - Cleaning up... 16:00:08 INFO - Return code: 0 16:00:08 INFO - Done creating virtualenv /builds/slave/test/build/venv. 16:00:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:00:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:00:09 INFO - Reading from file tmpfile_stdout 16:00:09 INFO - Current package versions: 16:00:09 INFO - argparse == 1.2.1 16:00:09 INFO - blessings == 1.6 16:00:09 INFO - blobuploader == 1.2.4 16:00:09 INFO - docopt == 0.6.1 16:00:09 INFO - functools32 == 3.2.3-2 16:00:09 INFO - jsonschema == 2.5.1 16:00:09 INFO - manifestparser == 1.1 16:00:09 INFO - mozInstall == 1.12 16:00:09 INFO - mozcrash == 1.0 16:00:09 INFO - mozdebug == 0.1 16:00:09 INFO - mozdevice == 0.49 16:00:09 INFO - mozfile == 1.2 16:00:09 INFO - mozhttpd == 0.7 16:00:09 INFO - mozinfo == 0.9 16:00:09 INFO - mozleak == 0.1 16:00:09 INFO - mozlog == 3.4 16:00:09 INFO - moznetwork == 0.27 16:00:09 INFO - mozprocess == 0.25 16:00:09 INFO - mozprofile == 0.28 16:00:09 INFO - mozrunner == 6.13 16:00:09 INFO - mozscreenshot == 0.1 16:00:09 INFO - mozsystemmonitor == 0.3 16:00:09 INFO - moztest == 0.8 16:00:09 INFO - mozversion == 1.4 16:00:09 INFO - psutil == 3.1.1 16:00:09 INFO - requests == 1.2.3 16:00:09 INFO - wsgiref == 0.1.2 16:00:09 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:00:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:00:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:00:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:00:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:00:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:00:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:00:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x245f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x249ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26fd310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fa400>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fb3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26fb840>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:00:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 16:00:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:00:09 INFO - Using env: {'DISPLAY': ':0', 16:00:09 INFO - 'HOME': '/home/cltbld', 16:00:09 INFO - 'LANG': 'en_US.UTF-8', 16:00:09 INFO - 'LANGUAGE': 'en_US:en', 16:00:09 INFO - 'LOGNAME': 'cltbld', 16:00:09 INFO - 'MAIL': '/var/mail/cltbld', 16:00:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:00:09 INFO - 'MOZ_NO_REMOTE': '1', 16:00:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:00:09 INFO - 'NO_EM_RESTART': '1', 16:00:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:00:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:00:09 INFO - 'PWD': '/builds/slave/test', 16:00:09 INFO - 'SHELL': '/bin/bash', 16:00:09 INFO - 'SHLVL': '1', 16:00:09 INFO - 'TERM': 'linux', 16:00:09 INFO - 'TMOUT': '86400', 16:00:09 INFO - 'USER': 'cltbld', 16:00:09 INFO - 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 16:00:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:00:09 INFO - '_': '/tools/buildbot/bin/python'} 16:00:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:00:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 16:00:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 16:00:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 16:00:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 16:00:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 16:00:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 16:00:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 16:00:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 16:00:09 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 16:00:09 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 16:00:09 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 16:00:09 INFO - Cleaning up... 16:00:09 INFO - Return code: 0 16:00:09 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 16:00:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:00:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:00:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:00:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:00:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:00:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:00:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x245f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x249ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26fd310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fa400>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fb3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26fb840>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:00:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 16:00:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 16:00:09 INFO - Using env: {'DISPLAY': ':0', 16:00:09 INFO - 'HOME': '/home/cltbld', 16:00:09 INFO - 'LANG': 'en_US.UTF-8', 16:00:09 INFO - 'LANGUAGE': 'en_US:en', 16:00:09 INFO - 'LOGNAME': 'cltbld', 16:00:09 INFO - 'MAIL': '/var/mail/cltbld', 16:00:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:00:09 INFO - 'MOZ_NO_REMOTE': '1', 16:00:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:00:09 INFO - 'NO_EM_RESTART': '1', 16:00:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:00:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:00:09 INFO - 'PWD': '/builds/slave/test', 16:00:09 INFO - 'SHELL': '/bin/bash', 16:00:09 INFO - 'SHLVL': '1', 16:00:09 INFO - 'TERM': 'linux', 16:00:09 INFO - 'TMOUT': '86400', 16:00:09 INFO - 'USER': 'cltbld', 16:00:09 INFO - 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 16:00:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:00:09 INFO - '_': '/tools/buildbot/bin/python'} 16:00:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:00:09 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 16:00:09 INFO - Cleaning up... 16:00:09 INFO - Return code: 0 16:00:09 INFO - Running post-action listener: _resource_record_post_action 16:00:09 INFO - Running post-action listener: _start_resource_monitoring 16:00:09 INFO - Starting resource monitoring. 16:00:09 INFO - [mozharness: 2017-02-23 00:00:09.500596Z] Finished create-virtualenv step (success) 16:00:09 INFO - [mozharness: 2017-02-23 00:00:09.501065Z] Running install step. 16:00:09 INFO - Running pre-action listener: _resource_record_pre_action 16:00:09 INFO - Running main action method: install 16:00:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:00:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:00:09 INFO - Reading from file tmpfile_stdout 16:00:09 INFO - Detecting whether we're running mozinstall >=1.0... 16:00:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 16:00:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 16:00:09 INFO - Reading from file tmpfile_stdout 16:00:09 INFO - Output received: 16:00:09 INFO - Usage: mozinstall [options] installer 16:00:09 INFO - Options: 16:00:09 INFO - -h, --help show this help message and exit 16:00:09 INFO - -d DEST, --destination=DEST 16:00:09 INFO - Directory to install application into. [default: 16:00:09 INFO - "/builds/slave/test"] 16:00:09 INFO - --app=APP Application being installed. [default: firefox] 16:00:09 INFO - mkdir: /builds/slave/test/build/application 16:00:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 16:00:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 16:00:26 INFO - Reading from file tmpfile_stdout 16:00:26 INFO - Output received: 16:00:26 INFO - /builds/slave/test/build/application/firefox/firefox 16:00:26 INFO - Running post-action listener: _resource_record_post_action 16:00:26 INFO - [mozharness: 2017-02-23 00:00:26.510720Z] Finished install step (success) 16:00:26 INFO - [mozharness: 2017-02-23 00:00:26.510994Z] Running run-tests step. 16:00:26 INFO - Running pre-action listener: _resource_record_pre_action 16:00:26 INFO - Running main action method: run_tests 16:00:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 16:00:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 16:00:26 INFO - Python 2.7.3 16:00:26 INFO - Return code: 0 16:00:26 INFO - grabbing minidump binary from tooltool 16:00:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:00:26 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fa400>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26fb3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26fb840>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 16:00:26 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 16:00:26 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 16:00:26 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 16:00:26 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:00:26 INFO - Return code: 0 16:00:26 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 16:00:26 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 16:00:26 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 16:00:26 INFO - ENV: RUST_BACKTRACE is now 1 16:00:26 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 16:00:26 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 16:00:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-072', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 16:00:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-072 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 16:00:26 INFO - Using env: {'DISPLAY': ':0', 16:00:26 INFO - 'HOME': '/home/cltbld', 16:00:26 INFO - 'LANG': 'en_US.UTF-8', 16:00:26 INFO - 'LANGUAGE': 'en_US:en', 16:00:26 INFO - 'LOGNAME': 'cltbld', 16:00:26 INFO - 'MAIL': '/var/mail/cltbld', 16:00:26 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:00:26 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 16:00:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:00:26 INFO - 'MOZ_NO_REMOTE': '1', 16:00:26 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:00:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:00:26 INFO - 'NO_EM_RESTART': '1', 16:00:26 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:00:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:00:26 INFO - 'PWD': '/builds/slave/test', 16:00:26 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:00:26 INFO - 'RUST_BACKTRACE': '1', 16:00:26 INFO - 'SHELL': '/bin/bash', 16:00:26 INFO - 'SHLVL': '1', 16:00:26 INFO - 'TERM': 'linux', 16:00:26 INFO - 'TMOUT': '86400', 16:00:26 INFO - 'USER': 'cltbld', 16:00:26 INFO - 'XDG_SESSION_COOKIE': '199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874', 16:00:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:00:26 INFO - '_': '/tools/buildbot/bin/python'} 16:00:26 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-072', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 16:00:26 INFO - mozversion application_buildid: 20170222230118 16:00:26 INFO - mozversion application_changeset: 32dcdde1fc64fc39a9065dc4218265dbc727673f 16:00:26 INFO - mozversion application_display_name: Nightly 16:00:26 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:00:26 INFO - mozversion application_name: Firefox 16:00:26 INFO - mozversion application_remotingname: firefox 16:00:26 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 16:00:26 INFO - mozversion application_vendor: Mozilla 16:00:26 INFO - mozversion application_version: 54.0a1 16:00:26 INFO - mozversion platform_buildid: 20170222230118 16:00:26 INFO - mozversion platform_changeset: 32dcdde1fc64fc39a9065dc4218265dbc727673f 16:00:26 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 16:00:26 INFO - mozversion platform_version: 54.0a1 16:00:26 INFO - using testdate: 1487808026 16:00:26 INFO - actual date: 1487808026 16:00:26 INFO - starting webserver on 'localhost:52093' 16:00:26 INFO - SUITE-START | Running 2 tests 16:00:26 INFO - TEST-START | dromaeo_css 16:00:26 INFO - operating with platform_type : linux_ 16:00:26 INFO - Initialising browser for dromaeo_css test... 16:00:26 INFO - TEST-INFO | started process 22834 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp8WSx_1/profile http://localhost:52093/getInfo.html) 16:00:30 INFO - PROCESS | 22834 | __metrics Screen width/height:1600/1200 16:00:30 INFO - PROCESS | 22834 | colorDepth:24 16:00:30 INFO - PROCESS | 22834 | Browser inner width/height: 1024/697 16:00:30 INFO - PROCESS | 22834 | __metrics 16:00:31 INFO - PROCESS | 22834 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 16:00:31 INFO - PROCESS | 22834 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:00:32 INFO - TEST-INFO | 22834: exit 0 16:00:32 INFO - Browser initialized. 16:00:32 INFO - Running cycle 1/1 for dromaeo_css test... 16:00:32 INFO - TEST-INFO | started process 22927 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp8WSx_1/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:00:44 INFO - PROCESS | 22927 | RSS: Main: 143101952 16:00:44 INFO - PROCESS | 22927 | 16:03:46 INFO - PROCESS | 22927 | Cycle 1(1): loaded http://localhost:52093/tests/dromaeo/cssquery-dojo.html (next: http://localhost:52093/tests/dromaeo/cssquery-ext.html) 16:03:47 INFO - PROCESS | 22927 | RSS: Main: 260915200 16:03:47 INFO - PROCESS | 22927 | 16:05:34 INFO - PROCESS | 22927 | ************************* 16:05:34 INFO - PROCESS | 22927 | A coding exception was thrown and uncaught in a Task. 16:05:34 INFO - PROCESS | 22927 | 16:05:34 ERROR - PROCESS | 22927 | Full message: TypeError: NetworkError when attempting to fetch resource. 16:05:34 INFO - PROCESS | 22927 | Full stack: 16:05:34 INFO - PROCESS | 22927 | ************************* 16:06:50 INFO - PROCESS | 22927 | Cycle 1(1): loaded http://localhost:52093/tests/dromaeo/cssquery-ext.html (next: http://localhost:52093/tests/dromaeo/cssquery-jquery.html) 16:06:51 INFO - PROCESS | 22927 | RSS: Main: 240054272 16:06:51 INFO - PROCESS | 22927 | 16:09:52 INFO - PROCESS | 22927 | Cycle 1(1): loaded http://localhost:52093/tests/dromaeo/cssquery-jquery.html (next: http://localhost:52093/tests/dromaeo/cssquery-mootools.html) 16:09:53 INFO - PROCESS | 22927 | RSS: Main: 234348544 16:09:53 INFO - PROCESS | 22927 | 16:12:55 INFO - PROCESS | 22927 | Cycle 1(1): loaded http://localhost:52093/tests/dromaeo/cssquery-mootools.html (next: http://localhost:52093/tests/dromaeo/cssquery-prototype.html) 16:12:56 INFO - PROCESS | 22927 | RSS: Main: 190275584 16:12:56 INFO - PROCESS | 22927 | 16:15:59 INFO - PROCESS | 22927 | Cycle 1(1): loaded http://localhost:52093/tests/dromaeo/cssquery-prototype.html (next: http://localhost:52093/tests/dromaeo/cssquery-yui.html) 16:15:59 INFO - PROCESS | 22927 | RSS: Main: 187944960 16:15:59 INFO - PROCESS | 22927 | 16:19:02 INFO - PROCESS | 22927 | Cycle 1(1): loaded http://localhost:52093/tests/dromaeo/cssquery-yui.html (next: http://localhost:52093/tests/dromaeo/cssquery-dojo.html) 16:19:02 INFO - PROCESS | 22927 | RSS: Main: 279150592 16:19:02 INFO - PROCESS | 22927 | 16:19:02 INFO - PROCESS | 22927 | __start_tp_report 16:19:02 INFO - PROCESS | 22927 | _x_x_mozilla_page_load 16:19:02 INFO - PROCESS | 22927 | _x_x_mozilla_page_load_details 16:19:02 INFO - PROCESS | 22927 | |i|pagename|runs| 16:19:02 INFO - PROCESS | 22927 | |0;dojo.html;3110.65782763896;3136.9686303136964;3150.1022208670524;3172.6034245719284;3202.0393881835444;5131.307273518083;5185.066687996164;5218.8695282617955;5272.578193744496;5287.365516138064;5245.4754524547525;5245.501677340656;5258.44786297439;5300.072487314714;5302.2311764794085;4686.08621318843;4722.38608980832;4748.311494833247;4812.87967800806;4823.710577365369;4825.565699087081;4837.395325584302;4874.951250487486;4893.584045356131;4893.926591101136;4702.036082603076;4745.881352966187;4754.477007529169;4766.952330476685;4768.332433459318;4781.737004464753;4791.688540244908;4811.08589368019;4859.708417494926;4874.439439464471;4733.148033353995;4759.452662943771;4762.261849413312;4790.880227994293;4832.589229915461;5243.082460569385;5248;5258.684478931238;5267.1309233976735;5314.468553144655;5443.319585051869;5476.397596264408;5479.808206712786;5541.224228607998;5544.556435485192;5521.917171242435;5571.665700057969;5576.1356989666665;5579.972100139514;5627.240322556443;5257.815976440845;5270.393904700932;5308.362996440414;5308.495692909168;5310.575153987672;5708.80019199326;5765.423457654201;5766.135079737989;5766.567507436959;5807.82576522705;5305.946940530623;5311.389190243094;5339.225812257201;5527.917081243784;5531.917021244684;5489.64317319373;5494.340679118452;5497.038018346773;5497.312835895513;5497.697626630574;5443.673379597158;5534.640248383923;5576.052071147915;5618.719064046782;5645.491905728504;5580.693061881636;5609.214709940612;5610.775568977195;5616.073347897551;5652.63257888236;4367.279398899146;4370.956290437119;4377.671674624416;4382.824687012548;4412.933805992912;3825.139343647657;3839.520059992501;3865.033741564609;3927.4501569780255;3945.5265368156006;5331.093714068617;5354.41101478837;5357.303550538483;5367.704776237344;5373.247745315659;5620.1288800236025;5629.859253518613;5634.549236061105;5636.2391077204875;5645.181448689917;5236.6857988520815;5277.182036784305;5291.074062039128;5296.602754793406;5337.8131765388025;4731.077439899186;4739.95260047402;4770.451398089264;4803.519648035169;4812.975935120302;5799.449052340021;5835.095560188178;5841.795537156179;5843.503302219359;5848.707564621752;5540.252065971043;5553.222548843246;5559.749811258423;5566.526845218202;5569.749361278833;5643.548516118783;5679.432056794288;5711.228984087095;5766.192733017297;5769.451902069297;5377.139657654757;5415.945840541702;5455.236266922713;5457.290552228185;5584.776608935759;5645.802396916089;5654.236678048575;5665.716714164358;5690.430956904442;5709.058005429058;5493.395726470005;5499.285092937893;5502.0371434997915;5502.257195278587;5512.228288039598;5324.1747529133045;5341.893162136813;5448.56411487088;5498.340199175965;5526.972365138148;5382.67703937765;5390.05674007055;5406.864828379322;5455.590830687794;5460.890782184413;5508.9724551376985;5513.283273174462;5516.917246241229;5520.779168833202;5551.417101204315;5406.2701535292235;5412.269343638716;5417.106177480671;5420.295361602966;5421.7560209791445 16:19:02 INFO - PROCESS | 22927 | |1;ext.html;550.196712799313;590.8581940334319;597.6832278892186;599.5323647554906;606.6026752477129;29377.412451750977;31618;31774.04677859665;40060.19879602406;42028.36957445641;45617;45922;45962.54037459625;45996.77001614996;46080.76959615197;9096.317776166781;9281.35030547862;9281.907180928172;9283.767905802342;9285.675001374953;7545.886811697829;7683.116441609202;9096.408733432305;9212.309076819265;10675.78648427031;10308.94845525775;10726;10728.892711072867;10733.785324293509;10950.233483656148;11039.889601103967;11074.501647425885;11116.555337786478;11132.443377831158;11132.666020019413;10380.169586433067;10397.272190946636;10412.739681507946;10416.375017498975;10419.21855860806;42567.148657027;42792.57207427917;42922.785386073185;42944.35583466251;42967.14065718668;3710.424884142962;3768.773873567567;3862.420636904487;3863.2273545290773;3919.7844118573466;27088.458230835273;28460.715392846014;29230.41539169226;29255.853720731473;29352.41295174106;4171.33258678613;4264.275073237557;4291.6137547620865;4319.43847299849;4474.485434175079;307005;307964;309077;310177.99999999773;310336;52752;52785;52848.47151528436;53052;53115.734421328416;47968.760156198994;48014.03971920542;48202.517974819806;54674;56268;14067.43730250799;14906.925465372604;14926.4775732851;14927;14931.70136597262;11347.432628368713;11456.369899655432;11459.369734664673;11473.254238474472;11478.081753459703;15301.158436285888;17258.741118883227;17263.82736172622;17269.13654317304;17364.913175434296;5563.972180139073;6889.965550172317;7041.5775053496955;7090;7251.202367739545;839.9664013439394;849.9320054395633;868.1882439918696;881.8324518341494;909.4088842252456;30353.544696829566;31460.842695786374;31487;31669;32078;960.3805545423303;1075.8493810866485;1078.4068762180768;1080.287010573018;1082.1288862465633;16073.758893616605;16733.748993765104;16841.326346945985;16851.578710532336;16854.747178792328;453709;475925;483800;485120;694449;55494;55842.72078639662;55968.44031559714;56077.719611401684;56141.43858561362;1349.7368013237324;1377.1461693749939;1386.7711827548544;1386.9653258668613;1390.7635701930697;27776.8611156951;28504.714952851034;29319.85340073286;29351.412971740017;29442;46056.53943460523;46704.29943550917;46769;46774.766126169154;46798;400930;404451;404468;405245;405820.79627212905;25840.095596654028;26350.341241469116;26404.3398915021;26704.19887403381;26745.33136671599;37250.44124338083;39905.800470997456;40978.79510602428;43023.784881076645;43300.783496083575;35442.468362975094;36780.632193677724;36896.44655330118;37090.072748180435;37715.245695085396;36119.45820812743;36529.93099181208;36573.634263657026;36957;37042.814785926974;36572.26855462822;37015.81492092522;37448.438273425374;37470.625293746714;37854.81072594619;30231.848840755654;33031.17422064468;33053.33893322168;33085.66914330922;33110.337793244486;24651.630225546272;24696.629550556398;24854.37864053413;25131.371715707253;25281.49437011286 16:19:02 INFO - PROCESS | 22927 | |2;jquery.html;412.09133859839056;417.157342168819;420.606732704921;426.39026192544657;431.40466156703764;12560.623181304552;12871.485140594365;18218.362357317495;19902.900485497572;19934.601307973833;20792.48018799531;21681.132754689792;21718.13127474903;21924.23265185719;21990.450238744;6336.904946425819;6694.096296999892;6707.061011458375;6707.329267073278;6712.865742685143;5890.087036509348;6499.38255865692;6553;6647.93352066478;6675.198976122872;6681.8997715034075;6682.463033502298;6684.966575167117;6694;6704.664766761643;6543.738250469975;6672.466202703797;6724.966375168142;6734.46124310054;6752.22349429812;6320.71556779946;6515.446187074104;6609.93390066098;6616.20605527335;6627.271000189975;26384.340391490176;26661.200163994916;26765.330866728487;27018.864905675346;27115.457690846073;3246.3182731626152;3342.715869151125;3388.1190890368434;3428.2629234714655;3429.6741809528053;15865.52403427899;16436.589085272844;16532.917335413367;16670.33318667252;17212.483625491255;2060.8763474191596;2121.4166104321434;2127.7446706395176;2128.010475129057;2132.9466763330884;102068.48965755198;102223.48888255586;104998;105251;105441.94558054475;19529.316473923343;19581.804181958;19738.30915917936;21394.251201207884;21604.43526818089;37032.259354812755;37190.256194875954;37352.81323593419;37498.8125059373;37520.24959500849;9606.903930960741;9916.603335866628;10093.091621754078;10145.797084058426;10377.636782712569;7990.480618759762;8113.837723245502;8314.085450600429;8324.25081742646;8347.081820999685;9849.753756156153;10268.43523606194;10388.42863642507;10389.428581428094;10504.369737815603;3701.574318953355;3852.8073596320633;3946.960530394717;3985.8206380712936;3994.7802870842384;845.6152450635069;865.4763867859854;876.8509353409936;886.7275459715329;897.8922529296526;18589.95346806752;19311.130999105073;19438.514037148903;19494.415167544998;19578.314758983368;865.865790802414;873.4715497124275;878.2052242720348;879.5382424227332;899.5052721003422;9982.700518984297;10698.411587362614;10860.511276992554;10977.341359518454;11010.284331518586;573594;587365.9475539351;592647;597040.0147999319;601184;97613;99137.50431247798;99492.5025374883;100638.49680751696;103119.48440257901;1024.9692509224735;1055.5619417941623;1083.371644446235;1095.2552264460244;1096.6984079378235;17142.742858856876;17556.561085972953;18098;18129.818701812812;18159.36442224516;42075.15849682928;42528;43627.781861090494;43719.344209837516;44240.721425684125;57688;58500;58762.41237587741;59031.40968590259;60281;8178.713745018896;8525.616347264264;8576.099509551408;8746.38775285724;8756.299496040428;11707.473163707824;12667.746645066863;12718.491260349483;12764.361781911053;12836.55072072473;9207.079292070739;10628.681139565826;10754.193435492212;10792.514336854703;10879.564817407216;11161.888381116085;11261.943690281496;11333.449973755838;11381;11825.290482571074;10918.344899306067;10927.617533386612;11198.664040078811;11202;11583.536658533565;8143;8220.424570280024;8286.958565207135;8315.085340612406;8418.915810841812;9642.276829237975;11021.669349919515;11080.952737996793;11383.146264030396;11455.427228638702 16:19:02 INFO - PROCESS | 22927 | |3;mootools.html;1285.5243559882833;1414.610981979956;1437.4034775568139;1448.2975756757965;1455.046944251515;6885.896711549331;8188.754337369881;8387.874181887277;8409.789755256106;8441.62012709428;8280.91719082809;8331.875021874677;8357.832843343145;8360.372972027091;8364.372672049605;1801.936932207373;2069.286096296775;2083.8853863037525;2103.621348157331;2104.8631838930496;1821.8997955112463;1852.9073546322697;2054.3734161080865;2097.5490269592033;2109.8101170894615;2087.7494700635943;2097.391756390645;2102.0435701755664;2102.29573093014;2104.5790841831617;1967.2229469359522;1979.7129416234566;1987.3839109875912;1994.0428594274683;1997.5605366819277;2028.2495476673726;2030.147338117994;2066.2354928676336;2066.8139867412006;2071.989640051805;8336.583170841433;8341.331733653293;8388.8741668875;8401.201885820898;8412.663493460253;4910.90178196434;5006.549410553068;5029.874253143701;5030.01914626648;5030.968651426449;3060.4032213718333;3122.172624254574;3129.624445066584;3176.4600017996995;3195.2970346523725;1365.7814749640108;1369.431685850371;1396.2250950722346;1424.978625320621;1440.5966329427777;11309.604163854226;11345.773084538263;11369.943150284278;11384.601538946097;11387.145964052646;4333.090051089243;4394.516603173648;4401.933970990438;4412.448443944507;4430.712003719748;9733.124018838338;9735.951320243496;9742.07450292221;9745.610175592898;9754.609815607297;5072.9746351268;5078.847634570969;5079.822206222764;5081.974590127025;5085.3134826797905;4430.490493593278;4587.449506059227;4602.3786788783755;4654.325122857167;4675.22858728306;3249.447593909041;3370.915727106793;3375.729941604666;3434.9313013740084;3483.1640406302304;1138.9658310250707;1143.5940241214416;1144.1533265383723;1147.73602071524;1170.3796987596588;843.2242337049929;845.7335939179262;854.2952064546773;872.7381785464462;874.7987962768472;5289.100852855024;5427.43011983744;5486.259354987025;5506.669599824023;5512.090505066619;987.2348929579633;990.6186118344489;997.1723469520281;1001.4592120254981;1020.4132623741378;3546.8226588670464;3726.2733766915735;3735.831887565066;3748.962510374916;3750.2312026035142;9662.502312141629;9768.51157442125;9849.359791613522;9891.653792117242;9944.25418093646;9816.852747208797;9828.950855245677;9831.410115393099;9835.360701554377;9840.11438970496;7580.3556697681315;7582.165961744204;7654.124739438873;7733.41999350051;7733.883991740128;5218.530332270114;5248.501392367719;5250.763715632882;5288.550473209666;5439.156930675752;9030.729078127666;9031.367804253901;9051.773705657148;9054.411463254868;9144.771380715536;8682.479051256945;9030.05184455649;9110.863337049817;9126.726198214064;9295.209907157967;7133.286671332825;7237.457190710613;7255.818604534928;7278.053852999076;7285.271472852673;6662.766803161866;6869.416099631588;7408.555486670817;7787.532748035136;7858.960705196438;6836.48726345536;6999.8250043747275;7074.327938845801;7087.751928682472;7263;7086.185088714864;7110.893336599852;7130.572165670076;7137.214906360193;7163.4269258460245;6362.586431881913;6403.263624683221;6416.7754128605275;6435.967820160869;6487.286398496256;4539.977300113478;4613.284940834176;4751.429828420612;4768.1417344878255;4822.565969062801;4702.059588082466;4769.689970151929;4772.522747725338;4796.832110876103;4947.82682606107 16:19:02 INFO - PROCESS | 22927 | |4;prototype.html;393.6895012947797;394.7394719485139;408.23152137559265;412.865818608952;417.29060596985124;5298.390685071218;5298.96670149321;5304.162273183847;5304.2043693446;5311.840644780658;5065.4934506549325;5187.950759450015;5206.167013277876;5240.318758561391;5279.630425870181;4095.9180816383655;4100.220958017967;4102.692298077656;4121;4141.047559061402;4139.6895232857505;4145.129522800215;4147.626713595776;4150.9584904151025;4157.792110394484;3936.566977632458;4077.1845630873795;4126.66986641068;4132.586741325874;4144.834206631731;4086.6934979876332;4104.240715467618;4115.612944492187;4117.279476091702;4128.380742888561;3652.2695460907657;3656.6708996190205;3663.816809159558;3697.5193224880595;3703.185299234164;4921.827736029221;5145.790739176291;5150.9742451287875;5155.896882062338;5190.532852043334;4867.318575399447;4869.245266983623;4877.122118018755;4884.19410797218;4884.535969082932;5503.367112782042;5523.6685798852195;5526.198701188346;5531.502164805147;5558.666480011212;4139.565345638694;4241.703080784347;4241.724287921306;4250.128723611652;4262;5528.5024347808485;5568.303962004709;5646.22144024631;5720.798632287225;5763.9135412968835;4286.721363111388;4340.175366680321;4341.131773645284;4345.34819777036;4363.498197707241;4429.977850110793;4446.42196514451;4461.219286624828;4465.307877279027;4470.150671372428;4630.236011058138;4654.325122857167;4908.656394052382;4918.9508104919205;4974.7263900485095;5521;5539.196816461671;5539.833804985857;5554.250176226158;5573.359063707644;1493.820741511004;1497.655539225984;1498.1535432480614;1510.7129645367345;1515.8559936805987;1016.3343010328247;1071.405370019631;1089.9128069754559;1105.1214284643568;1111.4498323330004;5152.742362881841;5155.561777248976;5169.767360468788;5172.663776854492;5192.27308176848;5464.836054918359;5467.480589344006;5475;5479.5342395896;5496.890062198733;4843.321934929113;5055;5067.1639179535705;5161.845144645667;5173.327467429285;2876.5397536394075;2878.956815647767;2880.884764609434;2905.825650460979;2915.4460652475964;5678.835838653066;5724.398938111522;5727.968965586151;5744.281964754406;5760.942390576124;5444.6932736143835;5745.569082318842;5749.655020698771;5765.483055336242;5779.612892905757;5823.340348000799;5833.7374818133285;5837.620554663933;5857.502112320501;5865.706714664249;5464.644798088111;5482.80810171642;5604.915926261027;5610.943890561042;5666.886662266649;5572.247746554163;5605.468554810606;5611.607187496836;5635.915461268002;5652.576056795839;5669.433056694297;5775.787084712258;5787.768489260551;5790.334111577223;5928.67392293428;3849.5188101487315;4056.371262454324;4101.938470922998;4110.23960567296;4123.649489793281;5570.693611851387;5649.237352957298;5666.716664166693;5676.460736230051;5693.231413759255;5409.972950135224;5455.181722741462;5497.697626630574;5500.834974950758;5535.5848311376;5482.4101010706445;5483.259759932517;5503.972480137573;5507.614466987433;5527.50252477279;5235.110031294613;5483.945160548344;5503.587230957614;5527.2538207341495;5530.751116199861;5539.695316757456;5546.639468434539;5612.726845627528;5614.943850561605;5626.774929002794;5391;5425.376081750649;5425.918611220914;5450.637340664834;5465.781368745205 16:19:02 INFO - PROCESS | 22927 | |5;yui.html;717.5336031579473;767.3209209849285;819.2626636027576;836.3058661311112;843.9789005274863;15431.07413555186;16322.75515867263;16323.510294691163;16341.5914602135;16342.428015019477;14097;14175.858241417583;14186.21975791331;14205.360758765855;14245.572632821031;776.5263189454442;779.5790273252437;796.2236819101388;799.3645052183499;800.2957397490201;802.9156938521459;803.8311954489535;804.891339669143;804.9154838741906;805.5287656720825;842.5071333270014;842.5450256861318;843.3211264931728;843.3211264931728;843.439112989861;830.0288662265165;831.2809419851815;832.2094010689868;837.4598384042289;838.0237023867187;610.6549799363346;613.8772245550907;614.7233744814852;615.7998650438625;617.1575799034331;14677.70644587113;14710.19093949843;14772.187529685863;15489;16120.435784747477;14735.115893046452;14795.112293262438;15092.773608395883;15285.541433757006;15325.080495170214;12074.27554346742;12209.206401583957;12218.266903985701;12328.226149116466;12485.93757031209;3609.4766258892314;3692;3784.7161462890394;3862.942055869164;3863;74452;75717.62141189314;75912;77092.61453692752;79082.60458697728;10992.505337259843;11005.17461190414;11182.496787644575;11282.43587820622;11565.653030409101;21052.26317078895;21257.255996040065;21345.35963921085;21360.572788544454;21390.358289251348;7462.10454745434;7488.101427828696;7616.428767842434;7694.153643099255;7785.532868027936;4422.535633758409;4476.26141686618;4512.187806194916;4529.139463501924;4601.470830854428;3703.092742278159;3765.7175711821724;3776.8300426480873;3780.7542509736777;3782.678472329828;631.3181763695198;631.7283568065776;637.2862394118524;645.686841881687;654.6268626882631;573.1889376532243;582.9446202610745;597.4369952902001;644.1915396177767;696.6481926627021;9283.164515193665;9301.255899528021;10032.548535315927;10111.544980475895;10114.645987390406;565.7821738630657;576.6453631016894;587.9147523609053;655.1842955520408;727.1063455197342;4897.4857639948;5086.618503612244;5114.232865070269;5154.123798954187;5171.250168725589;59755.701221494484;60792;61868.381316187166;67282;73629.6318518404;47298.29052564214;56010.71994640001;59100.70449647724;61548.38451615426;62201.37798621956;56468;56839.43160568424;56912.43087569154;56945.86108277894;57360.11678598595;10062.446565438971;10362.585496580052;10523.210759193244;10551.419671918118;10580.682579522627;38089.809550952064;38116.23767524689;39509.2098158041;39999.600003999585;40459.79770101131;45467.77266113781;48121.518784811706;48263;48638.5136148634;48876.5112348872;12454.937725311316;12561.246325220516;12566.685832854251;12667.239965602093;12978.870211297766;13850.515231966832;14051.751719724794;14566.4901728439;14687.706245875237;15136.621584460036;12353.752924941271;13022.674433139247;13283.335833208494;13364.933175334061;13617.455301787817;12379.62861114168;12821.294828784507;12902.67743306425;13073.411696473871;13327.054157888215;12827.743445130858;13588.25264610456;13717;13860.930695346458;13994.930025349808;9948.253880959102;10477.528511217166;10609.151267898395;10696.136564250017;10758.781408411578;10181.690950441285;10307.690769276935;10358.119559837498;10418.843717344398;10422.583096676048 16:19:02 INFO - PROCESS | 22927 | __end_tp_report 16:19:02 INFO - PROCESS | 22927 | __start_cc_report 16:19:02 INFO - PROCESS | 22927 | _x_x_mozilla_cycle_collect,1236 16:19:02 INFO - PROCESS | 22927 | __end_cc_report 16:19:02 INFO - PROCESS | 22927 | __startTimestamp1487809142889__endTimestamp 16:19:02 INFO - PROCESS | 22927 | 16:19:02 INFO - PROCESS | 22927 | ------- Summary: start ------- 16:19:02 INFO - PROCESS | 22927 | Number of tests: 6 16:19:02 INFO - PROCESS | 22927 | 16:19:02 INFO - PROCESS | 22927 | [#0] dojo.html Cycles:165 Average:5209.67 Median:5390.06 stddev:560.47 (10.4%) stddev-sans-first:537.45 16:19:02 INFO - PROCESS | 22927 | Values: 3110.7 3137.0 3150.1 3172.6 3202.0 5131.3 5185.1 5218.9 5272.6 5287.4 5245.5 5245.5 5258.4 5300.1 5302.2 4686.1 4722.4 4748.3 4812.9 4823.7 4825.6 4837.4 4875.0 4893.6 4893.9 4702.0 4745.9 4754.5 4767.0 4768.3 4781.7 4791.7 4811.1 4859.7 4874.4 4733.1 4759.5 4762.3 4790.9 4832.6 5243.1 5248.0 5258.7 5267.1 5314.5 5443.3 5476.4 5479.8 5541.2 5544.6 5521.9 5571.7 5576.1 5580.0 5627.2 5257.8 5270.4 5308.4 5308.5 5310.6 5708.8 5765.4 5766.1 5766.6 5807.8 5305.9 5311.4 5339.2 5527.9 5531.9 5489.6 5494.3 5497.0 5497.3 5497.7 5443.7 5534.6 5576.1 5618.7 5645.5 5580.7 5609.2 5610.8 5616.1 5652.6 4367.3 4371.0 4377.7 4382.8 4412.9 3825.1 3839.5 3865.0 3927.5 3945.5 5331.1 5354.4 5357.3 5367.7 5373.2 5620.1 5629.9 5634.5 5636.2 5645.2 5236.7 5277.2 5291.1 5296.6 5337.8 4731.1 4740.0 4770.5 4803.5 4813.0 5799.4 5835.1 5841.8 5843.5 5848.7 5540.3 5553.2 5559.7 5566.5 5569.7 5643.5 5679.4 5711.2 5766.2 5769.5 5377.1 5415.9 5455.2 5457.3 5584.8 5645.8 5654.2 5665.7 5690.4 5709.1 5493.4 5499.3 5502.0 5502.3 5512.2 5324.2 5341.9 5448.6 5498.3 5527.0 5382.7 5390.1 5406.9 5455.6 5460.9 5509.0 5513.3 5516.9 5520.8 5551.4 5406.3 5412.3 5417.1 5420.3 5421.8 16:19:02 INFO - PROCESS | 22927 | 16:19:02 INFO - PROCESS | 22927 | [#1] ext.html Cycles:180 Average:55975.18 Median:36986.41 stddev:112239.97 (303.5%) stddev-sans-first:112477.69 16:19:02 INFO - PROCESS | 22927 | Values: 550.2 590.9 597.7 599.5 606.6 29377.4 31618.0 31774.0 40060.2 42028.4 45617.0 45922.0 45962.5 45996.8 46080.8 9096.3 9281.4 9281.9 9283.8 9285.7 7545.9 7683.1 9096.4 9212.3 10675.8 10308.9 10726.0 10728.9 10733.8 10950.2 11039.9 11074.5 11116.6 11132.4 11132.7 10380.2 10397.3 10412.7 10416.4 10419.2 42567.1 42792.6 42922.8 42944.4 42967.1 3710.4 3768.8 3862.4 3863.2 3919.8 27088.5 28460.7 29230.4 29255.9 29352.4 4171.3 4264.3 4291.6 4319.4 4474.5 307005.0 307964.0 309077.0 310178.0 310336.0 52752.0 52785.0 52848.5 53052.0 53115.7 47968.8 48014.0 48202.5 54674.0 56268.0 14067.4 14906.9 14926.5 14927.0 14931.7 11347.4 11456.4 11459.4 11473.3 11478.1 15301.2 17258.7 17263.8 17269.1 17364.9 5564.0 6890.0 7041.6 7090.0 7251.2 840.0 849.9 868.2 881.8 909.4 30353.5 31460.8 31487.0 31669.0 32078.0 960.4 1075.8 1078.4 1080.3 1082.1 16073.8 16733.7 16841.3 16851.6 16854.7 453709.0 475925.0 483800.0 485120.0 694449.0 55494.0 55842.7 55968.4 56077.7 56141.4 1349.7 1377.1 1386.8 1387.0 1390.8 27776.9 28504.7 29319.9 29351.4 29442.0 46056.5 46704.3 46769.0 46774.8 46798.0 400930.0 404451.0 404468.0 405245.0 405820.8 25840.1 26350.3 26404.3 26704.2 26745.3 37250.4 39905.8 40978.8 43023.8 43300.8 35442.5 36780.6 36896.4 37090.1 37715.2 36119.5 36529.9 36573.6 36957.0 37042.8 36572.3 37015.8 37448.4 37470.6 37854.8 30231.8 33031.2 33053.3 33085.7 33110.3 24651.6 24696.6 24854.4 25131.4 25281.5 16:19:02 INFO - PROCESS | 22927 | 16:19:02 INFO - PROCESS | 22927 | [#2] jquery.html Cycles:180 Average:34195.77 Median:3565.62 stddev:97217.31 (2726.5%) stddev-sans-first:97456.94 16:19:02 INFO - PROCESS | 22927 | Values: 412.1 417.2 420.6 426.4 431.4 12560.6 12871.5 18218.4 19902.9 19934.6 20792.5 21681.1 21718.1 21924.2 21990.5 6336.9 6694.1 6707.1 6707.3 6712.9 5890.1 6499.4 6553.0 6647.9 6675.2 6681.9 6682.5 6685.0 6694.0 6704.7 6543.7 6672.5 6725.0 6734.5 6752.2 6320.7 6515.4 6609.9 6616.2 6627.3 26384.3 26661.2 26765.3 27018.9 27115.5 3246.3 3342.7 3388.1 3428.3 3429.7 15865.5 16436.6 16532.9 16670.3 17212.5 2060.9 2121.4 2127.7 2128.0 2132.9 102068.5 102223.5 104998.0 105251.0 105441.9 19529.3 19581.8 19738.3 21394.3 21604.4 37032.3 37190.3 37352.8 37498.8 37520.2 9606.9 9916.6 10093.1 10145.8 10377.6 7990.5 8113.8 8314.1 8324.3 8347.1 9849.8 10268.4 10388.4 10389.4 10504.4 3701.6 3852.8 3947.0 3985.8 3994.8 845.6 865.5 876.9 886.7 897.9 18590.0 19311.1 19438.5 19494.4 19578.3 865.9 873.5 878.2 879.5 899.5 9982.7 10698.4 10860.5 10977.3 11010.3 573594.0 587365.9 592647.0 597040.0 601184.0 97613.0 99137.5 99492.5 100638.5 103119.5 1025.0 1055.6 1083.4 1095.3 1096.7 17142.7 17556.6 18098.0 18129.8 18159.4 42075.2 42528.0 43627.8 43719.3 44240.7 57688.0 58500.0 58762.4 59031.4 60281.0 8178.7 8525.6 8576.1 8746.4 8756.3 11707.5 12667.7 12718.5 12764.4 12836.6 9207.1 10628.7 10754.2 10792.5 10879.6 11161.9 11261.9 11333.4 11381.0 11825.3 10918.3 10927.6 11198.7 11202.0 11583.5 8143.0 8220.4 8287.0 8315.1 8418.9 9642.3 11021.7 11081.0 11383.1 11455.4 16:19:02 INFO - PROCESS | 22927 | 16:19:02 INFO - PROCESS | 22927 | [#3] mootools.html Cycles:180 Average:5331.80 Median:5083.64 stddev:3017.62 (59.4%) stddev-sans-first:3010.77 16:19:02 INFO - PROCESS | 22927 | Values: 1285.5 1414.6 1437.4 1448.3 1455.0 6885.9 8188.8 8387.9 8409.8 8441.6 8280.9 8331.9 8357.8 8360.4 8364.4 1801.9 2069.3 2083.9 2103.6 2104.9 1821.9 1852.9 2054.4 2097.5 2109.8 2087.7 2097.4 2102.0 2102.3 2104.6 1967.2 1979.7 1987.4 1994.0 1997.6 2028.2 2030.1 2066.2 2066.8 2072.0 8336.6 8341.3 8388.9 8401.2 8412.7 4910.9 5006.5 5029.9 5030.0 5031.0 3060.4 3122.2 3129.6 3176.5 3195.3 1365.8 1369.4 1396.2 1425.0 1440.6 11309.6 11345.8 11369.9 11384.6 11387.1 4333.1 4394.5 4401.9 4412.4 4430.7 9733.1 9736.0 9742.1 9745.6 9754.6 5073.0 5078.8 5079.8 5082.0 5085.3 4430.5 4587.4 4602.4 4654.3 4675.2 3249.4 3370.9 3375.7 3434.9 3483.2 1139.0 1143.6 1144.2 1147.7 1170.4 843.2 845.7 854.3 872.7 874.8 5289.1 5427.4 5486.3 5506.7 5512.1 987.2 990.6 997.2 1001.5 1020.4 3546.8 3726.3 3735.8 3749.0 3750.2 9662.5 9768.5 9849.4 9891.7 9944.3 9816.9 9829.0 9831.4 9835.4 9840.1 7580.4 7582.2 7654.1 7733.4 7733.9 5218.5 5248.5 5250.8 5288.6 5439.2 9030.7 9031.4 9051.8 9054.4 9144.8 8682.5 9030.1 9110.9 9126.7 9295.2 7133.3 7237.5 7255.8 7278.1 7285.3 6662.8 6869.4 7408.6 7787.5 7859.0 6836.5 6999.8 7074.3 7087.8 7263.0 7086.2 7110.9 7130.6 7137.2 7163.4 6362.6 6403.3 6416.8 6436.0 6487.3 4540.0 4613.3 4751.4 4768.1 4822.6 4702.1 4769.7 4772.5 4796.8 4947.8 16:19:02 INFO - PROCESS | 22927 | 16:19:02 INFO - PROCESS | 22927 | [#4] prototype.html Cycles:180 Average:4670.92 Median:5191.40 stddev:1323.14 (25.5%) stddev-sans-first:1287.31 16:19:02 INFO - PROCESS | 22927 | Values: 393.7 394.7 408.2 412.9 417.3 5298.4 5299.0 5304.2 5304.2 5311.8 5065.5 5188.0 5206.2 5240.3 5279.6 4095.9 4100.2 4102.7 4121.0 4141.0 4139.7 4145.1 4147.6 4151.0 4157.8 3936.6 4077.2 4126.7 4132.6 4144.8 4086.7 4104.2 4115.6 4117.3 4128.4 3652.3 3656.7 3663.8 3697.5 3703.2 4921.8 5145.8 5151.0 5155.9 5190.5 4867.3 4869.2 4877.1 4884.2 4884.5 5503.4 5523.7 5526.2 5531.5 5558.7 4139.6 4241.7 4241.7 4250.1 4262.0 5528.5 5568.3 5646.2 5720.8 5763.9 4286.7 4340.2 4341.1 4345.3 4363.5 4430.0 4446.4 4461.2 4465.3 4470.2 4630.2 4654.3 4908.7 4919.0 4974.7 5521.0 5539.2 5539.8 5554.3 5573.4 1493.8 1497.7 1498.2 1510.7 1515.9 1016.3 1071.4 1089.9 1105.1 1111.4 5152.7 5155.6 5169.8 5172.7 5192.3 5464.8 5467.5 5475.0 5479.5 5496.9 4843.3 5055.0 5067.2 5161.8 5173.3 2876.5 2879.0 2880.9 2905.8 2915.4 5678.8 5724.4 5728.0 5744.3 5760.9 5444.7 5745.6 5749.7 5765.5 5779.6 5823.3 5833.7 5837.6 5857.5 5865.7 5464.6 5482.8 5604.9 5610.9 5666.9 5572.2 5605.5 5611.6 5635.9 5652.6 5669.4 5775.8 5787.8 5790.3 5928.7 3849.5 4056.4 4101.9 4110.2 4123.6 5570.7 5649.2 5666.7 5676.5 5693.2 5410.0 5455.2 5497.7 5500.8 5535.6 5482.4 5483.3 5504.0 5507.6 5527.5 5235.1 5483.9 5503.6 5527.3 5530.8 5539.7 5546.6 5612.7 5614.9 5626.8 5391.0 5425.4 5425.9 5450.6 5465.8 16:19:02 INFO - PROCESS | 22927 | 16:19:02 INFO - PROCESS | 22927 | [#5] yui.html Cycles:180 Average:16296.95 Median:40229.70 stddev:19754.61 (49.1%) stddev-sans-first:19775.38 16:19:02 INFO - PROCESS | 22927 | Values: 717.5 767.3 819.3 836.3 844.0 15431.1 16322.8 16323.5 16341.6 16342.4 14097.0 14175.9 14186.2 14205.4 14245.6 776.5 779.6 796.2 799.4 800.3 802.9 803.8 804.9 804.9 805.5 842.5 842.5 843.3 843.3 843.4 830.0 831.3 832.2 837.5 838.0 610.7 613.9 614.7 615.8 617.2 14677.7 14710.2 14772.2 15489.0 16120.4 14735.1 14795.1 15092.8 15285.5 15325.1 12074.3 12209.2 12218.3 12328.2 12485.9 3609.5 3692.0 3784.7 3862.9 3863.0 74452.0 75717.6 75912.0 77092.6 79082.6 10992.5 11005.2 11182.5 11282.4 11565.7 21052.3 21257.3 21345.4 21360.6 21390.4 7462.1 7488.1 7616.4 7694.2 7785.5 4422.5 4476.3 4512.2 4529.1 4601.5 3703.1 3765.7 3776.8 3780.8 3782.7 631.3 631.7 637.3 645.7 654.6 573.2 582.9 597.4 644.2 696.6 9283.2 9301.3 10032.5 10111.5 10114.6 565.8 576.6 587.9 655.2 727.1 4897.5 5086.6 5114.2 5154.1 5171.3 59755.7 60792.0 61868.4 67282.0 73629.6 47298.3 56010.7 59100.7 61548.4 62201.4 56468.0 56839.4 56912.4 56945.9 57360.1 10062.4 10362.6 10523.2 10551.4 10580.7 38089.8 38116.2 39509.2 39999.6 40459.8 45467.8 48121.5 48263.0 48638.5 48876.5 12454.9 12561.2 12566.7 12667.2 12978.9 13850.5 14051.8 14566.5 14687.7 15136.6 12353.8 13022.7 13283.3 13364.9 13617.5 12379.6 12821.3 12902.7 13073.4 13327.1 12827.7 13588.3 13717.0 13860.9 13994.9 9948.3 10477.5 10609.2 10696.1 10758.8 10181.7 10307.7 10358.1 10418.8 10422.6 16:19:02 INFO - PROCESS | 22927 | -------- Summary: end -------- 16:19:02 INFO - PROCESS | 22927 | 16:19:03 INFO - TEST-INFO | 22927: exit 0 16:19:03 INFO - TEST-OK | dromaeo_css | took 1116974ms 16:19:03 INFO - TEST-START | kraken 16:19:03 INFO - operating with platform_type : linux_ 16:19:03 INFO - Initialising browser for kraken test... 16:19:03 INFO - TEST-INFO | started process 23257 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpt1OgJr/profile http://localhost:52093/getInfo.html) 16:19:07 INFO - PROCESS | 23257 | __metrics Screen width/height:1600/1200 16:19:07 INFO - PROCESS | 23257 | colorDepth:24 16:19:07 INFO - PROCESS | 23257 | Browser inner width/height: 1024/697 16:19:07 INFO - PROCESS | 23257 | __metrics 16:19:08 INFO - PROCESS | 23257 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 16:19:08 INFO - PROCESS | 23257 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:19:09 INFO - TEST-INFO | 23257: exit 0 16:19:09 INFO - Browser initialized. 16:19:09 INFO - Running cycle 1/1 for kraken test... 16:19:09 INFO - TEST-INFO | started process 23353 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpt1OgJr/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:19:21 INFO - PROCESS | 23353 | RSS: Main: 142307328 16:19:21 INFO - PROCESS | 23353 | 16:19:24 INFO - PROCESS | 23353 | Cycle 1(1): loaded http://localhost:52093/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:52093/tests/kraken/driver.html?testName=audio-beat-detection) 16:19:25 INFO - PROCESS | 23353 | RSS: Main: 198152192 16:19:25 INFO - PROCESS | 23353 | 16:19:27 INFO - PROCESS | 23353 | Cycle 1(1): loaded http://localhost:52093/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:52093/tests/kraken/driver.html?testName=audio-dft) 16:19:28 INFO - PROCESS | 23353 | RSS: Main: 177397760 16:19:28 INFO - PROCESS | 23353 | 16:19:31 INFO - PROCESS | 23353 | Cycle 1(1): loaded http://localhost:52093/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:52093/tests/kraken/driver.html?testName=audio-fft) 16:19:31 INFO - PROCESS | 23353 | RSS: Main: 259358720 16:19:31 INFO - PROCESS | 23353 | 16:19:34 INFO - PROCESS | 23353 | Cycle 1(1): loaded http://localhost:52093/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:52093/tests/kraken/driver.html?testName=audio-oscillator) 16:19:34 INFO - PROCESS | 23353 | RSS: Main: 171474944 16:19:34 INFO - PROCESS | 23353 | 16:19:36 INFO - PROCESS | 23353 | Cycle 1(1): loaded http://localhost:52093/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:52093/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:19:37 INFO - PROCESS | 23353 | RSS: Main: 175144960 16:19:37 INFO - PROCESS | 23353 | 16:19:40 INFO - PROCESS | 23353 | Cycle 1(1): loaded http://localhost:52093/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:52093/tests/kraken/driver.html?testName=imaging-darkroom) 16:19:40 INFO - PROCESS | 23353 | RSS: Main: 213999616 16:19:40 INFO - PROCESS | 23353 | 16:19:44 INFO - PROCESS | 23353 | Cycle 1(1): loaded http://localhost:52093/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:52093/tests/kraken/driver.html?testName=imaging-desaturate) 16:19:44 INFO - PROCESS | 23353 | RSS: Main: 213549056 16:19:44 INFO - PROCESS | 23353 | 16:19:47 INFO - PROCESS | 23353 | Cycle 1(1): loaded http://localhost:52093/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:52093/tests/kraken/driver.html?testName=json-parse-financial) 16:19:48 INFO - PROCESS | 23353 | RSS: Main: 212496384 16:19:48 INFO - PROCESS | 23353 | 16:19:49 INFO - PROCESS | 23353 | Cycle 1(1): loaded http://localhost:52093/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:52093/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:19:50 INFO - PROCESS | 23353 | RSS: Main: 174743552 16:19:50 INFO - PROCESS | 23353 | 16:19:52 INFO - PROCESS | 23353 | Cycle 1(1): loaded http://localhost:52093/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:52093/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:19:52 INFO - PROCESS | 23353 | RSS: Main: 183050240 16:19:52 INFO - PROCESS | 23353 | 16:19:54 INFO - PROCESS | 23353 | Cycle 1(1): loaded http://localhost:52093/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:52093/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:19:55 INFO - PROCESS | 23353 | RSS: Main: 190709760 16:19:55 INFO - PROCESS | 23353 | 16:19:58 INFO - PROCESS | 23353 | Cycle 1(1): loaded http://localhost:52093/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:52093/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:19:58 INFO - PROCESS | 23353 | RSS: Main: 199675904 16:19:58 INFO - PROCESS | 23353 | 16:20:01 INFO - PROCESS | 23353 | Cycle 1(1): loaded http://localhost:52093/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:52093/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:20:02 INFO - PROCESS | 23353 | RSS: Main: 196599808 16:20:02 INFO - PROCESS | 23353 | 16:20:03 INFO - PROCESS | 23353 | Cycle 1(1): loaded http://localhost:52093/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:52093/tests/kraken/driver.html?testName=ai-astar) 16:20:04 INFO - PROCESS | 23353 | RSS: Main: 248918016 16:20:04 INFO - PROCESS | 23353 | 16:20:04 INFO - PROCESS | 23353 | __start_tp_report 16:20:04 INFO - PROCESS | 23353 | _x_x_mozilla_page_load 16:20:04 INFO - PROCESS | 23353 | _x_x_mozilla_page_load_details 16:20:04 INFO - PROCESS | 23353 | |i|pagename|runs| 16:20:04 INFO - PROCESS | 23353 | |0;ai-astar;111;113;112;111;113;113;113;113;111;112 16:20:04 INFO - PROCESS | 23353 | |1;audio-beat-detection;142;119;120;171;122;120;125;119;144;119 16:20:04 INFO - PROCESS | 23353 | |2;audio-dft;162;163;162;160;161;163;163;169;161;161 16:20:04 INFO - PROCESS | 23353 | |3;audio-fft;75;76;76;109;78;76;76;75;94;76 16:20:04 INFO - PROCESS | 23353 | |4;audio-oscillator;83;83;109;83;82;82;95;84;84;109 16:20:04 INFO - PROCESS | 23353 | |5;imaging-gaussian-blur;114;113;113;113;113;113;113;112;113;113 16:20:04 INFO - PROCESS | 23353 | |6;imaging-darkroom;147;147;147;147;147;146;148;148;148;146 16:20:04 INFO - PROCESS | 23353 | |7;imaging-desaturate;96;96;96;96;96;96;96;96;96;96 16:20:04 INFO - PROCESS | 23353 | |8;json-parse-financial;55;53;53;54;55;66;54;55;53;55 16:20:04 INFO - PROCESS | 23353 | |9;json-stringify-tinderbox;64;65;63;64;63;64;64;64;64;64 16:20:04 INFO - PROCESS | 23353 | |10;stanford-crypto-aes;83;82;83;83;82;92;88;82;84;83 16:20:04 INFO - PROCESS | 23353 | |11;stanford-crypto-ccm;136;128;128;138;129;129;126;128;165;154 16:20:04 INFO - PROCESS | 23353 | |12;stanford-crypto-pbkdf2;180;175;174;177;178;171;176;178;174;176 16:20:04 INFO - PROCESS | 23353 | |13;stanford-crypto-sha256-iterative;67;64;64;67;63;64;62;63;62;63 16:20:04 INFO - PROCESS | 23353 | __end_tp_report 16:20:04 INFO - PROCESS | 23353 | __start_cc_report 16:20:04 INFO - PROCESS | 23353 | _x_x_mozilla_cycle_collect,1767 16:20:04 INFO - PROCESS | 23353 | __end_cc_report 16:20:04 INFO - PROCESS | 23353 | __startTimestamp1487809204240__endTimestamp 16:20:04 INFO - PROCESS | 23353 | 16:20:04 INFO - PROCESS | 23353 | ------- Summary: start ------- 16:20:04 INFO - PROCESS | 23353 | Number of tests: 14 16:20:04 INFO - PROCESS | 23353 | 16:20:04 INFO - PROCESS | 23353 | [#0] ai-astar Cycles:10 Average:112.20 Median:113.00 stddev:0.92 (0.8%) stddev-sans-first:0.87 16:20:04 INFO - PROCESS | 23353 | Values: 111.0 113.0 112.0 111.0 113.0 113.0 113.0 113.0 111.0 112.0 16:20:04 INFO - PROCESS | 23353 | 16:20:04 INFO - PROCESS | 23353 | [#1] audio-beat-detection Cycles:10 Average:130.10 Median:123.50 stddev:17.23 (14.0%) stddev-sans-first:17.73 16:20:04 INFO - PROCESS | 23353 | Values: 142.0 119.0 120.0 171.0 122.0 120.0 125.0 119.0 144.0 119.0 16:20:04 INFO - PROCESS | 23353 | 16:20:04 INFO - PROCESS | 23353 | [#2] audio-dft Cycles:10 Average:162.50 Median:162.50 stddev:2.51 (1.5%) stddev-sans-first:2.65 16:20:04 INFO - PROCESS | 23353 | Values: 162.0 163.0 162.0 160.0 161.0 163.0 163.0 169.0 161.0 161.0 16:20:04 INFO - PROCESS | 23353 | 16:20:04 INFO - PROCESS | 23353 | [#3] audio-fft Cycles:10 Average:81.10 Median:76.00 stddev:11.35 (14.9%) stddev-sans-first:11.82 16:20:04 INFO - PROCESS | 23353 | Values: 75.0 76.0 76.0 109.0 78.0 76.0 76.0 75.0 94.0 76.0 16:20:04 INFO - PROCESS | 23353 | 16:20:04 INFO - PROCESS | 23353 | [#4] audio-oscillator Cycles:10 Average:89.40 Median:83.00 stddev:11.01 (13.3%) stddev-sans-first:11.43 16:20:04 INFO - PROCESS | 23353 | Values: 83.0 83.0 109.0 83.0 82.0 82.0 95.0 84.0 84.0 109.0 16:20:04 INFO - PROCESS | 23353 | 16:20:04 INFO - PROCESS | 23353 | [#5] imaging-gaussian-blur Cycles:10 Average:113.00 Median:113.00 stddev:0.47 (0.4%) stddev-sans-first:0.33 16:20:04 INFO - PROCESS | 23353 | Values: 114.0 113.0 113.0 113.0 113.0 113.0 113.0 112.0 113.0 113.0 16:20:04 INFO - PROCESS | 23353 | 16:20:04 INFO - PROCESS | 23353 | [#6] imaging-darkroom Cycles:10 Average:147.10 Median:147.00 stddev:0.74 (0.5%) stddev-sans-first:0.78 16:20:04 INFO - PROCESS | 23353 | Values: 147.0 147.0 147.0 147.0 147.0 146.0 148.0 148.0 148.0 146.0 16:20:04 INFO - PROCESS | 23353 | 16:20:04 INFO - PROCESS | 23353 | [#7] imaging-desaturate Cycles:10 Average:96.00 Median:96.00 stddev:0.00 (0.0%) stddev-sans-first:0.00 16:20:04 INFO - PROCESS | 23353 | Values: 96.0 96.0 96.0 96.0 96.0 96.0 96.0 96.0 96.0 96.0 16:20:04 INFO - PROCESS | 23353 | 16:20:04 INFO - PROCESS | 23353 | [#8] json-parse-financial Cycles:10 Average:55.30 Median:55.00 stddev:3.86 (7.0%) stddev-sans-first:4.09 16:20:04 INFO - PROCESS | 23353 | Values: 55.0 53.0 53.0 54.0 55.0 66.0 54.0 55.0 53.0 55.0 16:20:04 INFO - PROCESS | 23353 | 16:20:04 INFO - PROCESS | 23353 | [#9] json-stringify-tinderbox Cycles:10 Average:63.90 Median:64.00 stddev:0.57 (0.9%) stddev-sans-first:0.60 16:20:04 INFO - PROCESS | 23353 | Values: 64.0 65.0 63.0 64.0 63.0 64.0 64.0 64.0 64.0 64.0 16:20:04 INFO - PROCESS | 23353 | 16:20:04 INFO - PROCESS | 23353 | [#10] stanford-crypto-aes Cycles:10 Average:84.20 Median:83.00 stddev:3.26 (3.9%) stddev-sans-first:3.43 16:20:04 INFO - PROCESS | 23353 | Values: 83.0 82.0 83.0 83.0 82.0 92.0 88.0 82.0 84.0 83.0 16:20:04 INFO - PROCESS | 23353 | 16:20:04 INFO - PROCESS | 23353 | [#11] stanford-crypto-ccm Cycles:10 Average:136.10 Median:132.50 stddev:13.16 (9.9%) stddev-sans-first:13.96 16:20:04 INFO - PROCESS | 23353 | Values: 136.0 128.0 128.0 138.0 129.0 129.0 126.0 128.0 165.0 154.0 16:20:04 INFO - PROCESS | 23353 | 16:20:04 INFO - PROCESS | 23353 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:175.90 Median:176.50 stddev:2.56 (1.4%) stddev-sans-first:2.24 16:20:04 INFO - PROCESS | 23353 | Values: 180.0 175.0 174.0 177.0 178.0 171.0 176.0 178.0 174.0 176.0 16:20:04 INFO - PROCESS | 23353 | 16:20:04 INFO - PROCESS | 23353 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.90 Median:64.00 stddev:1.79 (2.8%) stddev-sans-first:1.51 16:20:04 INFO - PROCESS | 23353 | Values: 67.0 64.0 64.0 67.0 63.0 64.0 62.0 63.0 62.0 63.0 16:20:04 INFO - PROCESS | 23353 | -------- Summary: end -------- 16:20:04 INFO - PROCESS | 23353 | 16:20:05 INFO - TEST-INFO | 23353: exit 0 16:20:05 INFO - TEST-OK | kraken | took 61555ms 16:20:05 INFO - SUITE-END | took 1178s 16:20:05 INFO - Completed test suite (00:19:38) 16:20:05 INFO - javascript benchmark 16:20:05 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": [], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7167.679326014773, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3110.65782763896, 3136.9686303136964, 3150.1022208670524, 3172.6034245719284, 3202.0393881835444, 5131.307273518083, 5185.066687996164, 5218.8695282617955, 5272.578193744496, 5287.365516138064, 5245.4754524547525, 5245.501677340656, 5258.44786297439, 5300.072487314714, 5302.2311764794085, 4686.08621318843, 4722.38608980832, 4748.311494833247, 4812.87967800806, 4823.710577365369, 4825.565699087081, 4837.395325584302, 4874.951250487486, 4893.584045356131, 4893.926591101136, 4702.036082603076, 4745.881352966187, 4754.477007529169, 4766.952330476685, 4768.332433459318, 4781.737004464753, 4791.688540244908, 4811.08589368019, 4859.708417494926, 4874.439439464471, 4733.148033353995, 4759.452662943771, 4762.261849413312, 4790.880227994293, 4832.589229915461, 5243.082460569385, 5248.0, 5258.684478931238, 5267.1309233976735, 5314.468553144655, 5443.319585051869, 5476.397596264408, 5479.808206712786, 5541.224228607998, 5544.556435485192, 5521.917171242435, 5571.665700057969, 5576.1356989666665, 5579.972100139514, 5627.240322556443, 5257.815976440845, 5270.393904700932, 5308.362996440414, 5308.495692909168, 5310.575153987672, 5708.80019199326, 5765.423457654201, 5766.135079737989, 5766.567507436959, 5807.82576522705, 5305.946940530623, 5311.389190243094, 5339.225812257201, 5527.917081243784, 5531.917021244684, 5489.64317319373, 5494.340679118452, 5497.038018346773, 5497.312835895513, 5497.697626630574, 5443.673379597158, 5534.640248383923, 5576.052071147915, 5618.719064046782, 5645.491905728504, 5580.693061881636, 5609.214709940612, 5610.775568977195, 5616.073347897551, 5652.63257888236, 4367.279398899146, 4370.956290437119, 4377.671674624416, 4382.824687012548, 4412.933805992912, 3825.139343647657, 3839.520059992501, 3865.033741564609, 3927.4501569780255, 3945.5265368156006, 5331.093714068617, 5354.41101478837, 5357.303550538483, 5367.704776237344, 5373.247745315659, 5620.1288800236025, 5629.859253518613, 5634.549236061105, 5636.2391077204875, 5645.181448689917, 5236.6857988520815, 5277.182036784305, 5291.074062039128, 5296.602754793406, 5337.8131765388025, 4731.077439899186, 4739.95260047402, 4770.451398089264, 4803.519648035169, 4812.975935120302, 5799.449052340021, 5835.095560188178, 5841.795537156179, 5843.503302219359, 5848.707564621752, 5540.252065971043, 5553.222548843246, 5559.749811258423, 5566.526845218202, 5569.749361278833, 5643.548516118783, 5679.432056794288, 5711.228984087095, 5766.192733017297, 5769.451902069297, 5377.139657654757, 5415.945840541702, 5455.236266922713, 5457.290552228185, 5584.776608935759, 5645.802396916089, 5654.236678048575, 5665.716714164358, 5690.430956904442, 5709.058005429058, 5493.395726470005, 5499.285092937893, 5502.0371434997915, 5502.257195278587, 5512.228288039598, 5324.1747529133045, 5341.893162136813, 5448.56411487088, 5498.340199175965, 5526.972365138148, 5382.67703937765, 5390.05674007055, 5406.864828379322, 5455.590830687794, 5460.890782184413, 5508.9724551376985, 5513.283273174462, 5516.917246241229, 5520.779168833202, 5551.417101204315, 5406.2701535292235, 5412.269343638716, 5417.106177480671, 5420.295361602966, 5421.7560209791445], "value": 5174.2278781566965, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [550.196712799313, 590.8581940334319, 597.6832278892186, 599.5323647554906, 606.6026752477129, 29377.412451750977, 31618.0, 31774.04677859665, 40060.19879602406, 42028.36957445641, 45617.0, 45922.0, 45962.54037459625, 45996.77001614996, 46080.76959615197, 9096.317776166781, 9281.35030547862, 9281.907180928172, 9283.767905802342, 9285.675001374953, 7545.886811697829, 7683.116441609202, 9096.408733432305, 9212.309076819265, 10675.78648427031, 10308.94845525775, 10726.0, 10728.892711072867, 10733.785324293509, 10950.233483656148, 11039.889601103967, 11074.501647425885, 11116.555337786478, 11132.443377831158, 11132.666020019413, 10380.169586433067, 10397.272190946636, 10412.739681507946, 10416.375017498975, 10419.21855860806, 42567.148657027, 42792.57207427917, 42922.785386073185, 42944.35583466251, 42967.14065718668, 3710.424884142962, 3768.773873567567, 3862.420636904487, 3863.2273545290773, 3919.7844118573466, 27088.458230835273, 28460.715392846014, 29230.41539169226, 29255.853720731473, 29352.41295174106, 4171.33258678613, 4264.275073237557, 4291.6137547620865, 4319.43847299849, 4474.485434175079, 307005.0, 307964.0, 309077.0, 310177.99999999773, 310336.0, 52752.0, 52785.0, 52848.47151528436, 53052.0, 53115.734421328416, 47968.760156198994, 48014.03971920542, 48202.517974819806, 54674.0, 56268.0, 14067.43730250799, 14906.925465372604, 14926.4775732851, 14927.0, 14931.70136597262, 11347.432628368713, 11456.369899655432, 11459.369734664673, 11473.254238474472, 11478.081753459703, 15301.158436285888, 17258.741118883227, 17263.82736172622, 17269.13654317304, 17364.913175434296, 5563.972180139073, 6889.965550172317, 7041.5775053496955, 7090.0, 7251.202367739545, 839.9664013439394, 849.9320054395633, 868.1882439918696, 881.8324518341494, 909.4088842252456, 30353.544696829566, 31460.842695786374, 31487.0, 31669.0, 32078.0, 960.3805545423303, 1075.8493810866485, 1078.4068762180768, 1080.287010573018, 1082.1288862465633, 16073.758893616605, 16733.748993765104, 16841.326346945985, 16851.578710532336, 16854.747178792328, 453709.0, 475925.0, 483800.0, 485120.0, 694449.0, 55494.0, 55842.72078639662, 55968.44031559714, 56077.719611401684, 56141.43858561362, 1349.7368013237324, 1377.1461693749939, 1386.7711827548544, 1386.9653258668613, 1390.7635701930697, 27776.8611156951, 28504.714952851034, 29319.85340073286, 29351.412971740017, 29442.0, 46056.53943460523, 46704.29943550917, 46769.0, 46774.766126169154, 46798.0, 400930.0, 404451.0, 404468.0, 405245.0, 405820.79627212905, 25840.095596654028, 26350.341241469116, 26404.3398915021, 26704.19887403381, 26745.33136671599, 37250.44124338083, 39905.800470997456, 40978.79510602428, 43023.784881076645, 43300.783496083575, 35442.468362975094, 36780.632193677724, 36896.44655330118, 37090.072748180435, 37715.245695085396, 36119.45820812743, 36529.93099181208, 36573.634263657026, 36957.0, 37042.814785926974, 36572.26855462822, 37015.81492092522, 37448.438273425374, 37470.625293746714, 37854.81072594619, 30231.848840755654, 33031.17422064468, 33053.33893322168, 33085.66914330922, 33110.337793244486, 24651.630225546272, 24696.629550556398, 24854.37864053413, 25131.371715707253, 25281.49437011286], "value": 19148.113379286828, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [412.09133859839056, 417.157342168819, 420.606732704921, 426.39026192544657, 431.40466156703764, 12560.623181304552, 12871.485140594365, 18218.362357317495, 19902.900485497572, 19934.601307973833, 20792.48018799531, 21681.132754689792, 21718.13127474903, 21924.23265185719, 21990.450238744, 6336.904946425819, 6694.096296999892, 6707.061011458375, 6707.329267073278, 6712.865742685143, 5890.087036509348, 6499.38255865692, 6553.0, 6647.93352066478, 6675.198976122872, 6681.8997715034075, 6682.463033502298, 6684.966575167117, 6694.0, 6704.664766761643, 6543.738250469975, 6672.466202703797, 6724.966375168142, 6734.46124310054, 6752.22349429812, 6320.71556779946, 6515.446187074104, 6609.93390066098, 6616.20605527335, 6627.271000189975, 26384.340391490176, 26661.200163994916, 26765.330866728487, 27018.864905675346, 27115.457690846073, 3246.3182731626152, 3342.715869151125, 3388.1190890368434, 3428.2629234714655, 3429.6741809528053, 15865.52403427899, 16436.589085272844, 16532.917335413367, 16670.33318667252, 17212.483625491255, 2060.8763474191596, 2121.4166104321434, 2127.7446706395176, 2128.010475129057, 2132.9466763330884, 102068.48965755198, 102223.48888255586, 104998.0, 105251.0, 105441.94558054475, 19529.316473923343, 19581.804181958, 19738.30915917936, 21394.251201207884, 21604.43526818089, 37032.259354812755, 37190.256194875954, 37352.81323593419, 37498.8125059373, 37520.24959500849, 9606.903930960741, 9916.603335866628, 10093.091621754078, 10145.797084058426, 10377.636782712569, 7990.480618759762, 8113.837723245502, 8314.085450600429, 8324.25081742646, 8347.081820999685, 9849.753756156153, 10268.43523606194, 10388.42863642507, 10389.428581428094, 10504.369737815603, 3701.574318953355, 3852.8073596320633, 3946.960530394717, 3985.8206380712936, 3994.7802870842384, 845.6152450635069, 865.4763867859854, 876.8509353409936, 886.7275459715329, 897.8922529296526, 18589.95346806752, 19311.130999105073, 19438.514037148903, 19494.415167544998, 19578.314758983368, 865.865790802414, 873.4715497124275, 878.2052242720348, 879.5382424227332, 899.5052721003422, 9982.700518984297, 10698.411587362614, 10860.511276992554, 10977.341359518454, 11010.284331518586, 573594.0, 587365.9475539351, 592647.0, 597040.0147999319, 601184.0, 97613.0, 99137.50431247798, 99492.5025374883, 100638.49680751696, 103119.48440257901, 1024.9692509224735, 1055.5619417941623, 1083.371644446235, 1095.2552264460244, 1096.6984079378235, 17142.742858856876, 17556.561085972953, 18098.0, 18129.818701812812, 18159.36442224516, 42075.15849682928, 42528.0, 43627.781861090494, 43719.344209837516, 44240.721425684125, 57688.0, 58500.0, 58762.41237587741, 59031.40968590259, 60281.0, 8178.713745018896, 8525.616347264264, 8576.099509551408, 8746.38775285724, 8756.299496040428, 11707.473163707824, 12667.746645066863, 12718.491260349483, 12764.361781911053, 12836.55072072473, 9207.079292070739, 10628.681139565826, 10754.193435492212, 10792.514336854703, 10879.564817407216, 11161.888381116085, 11261.943690281496, 11333.449973755838, 11381.0, 11825.290482571074, 10918.344899306067, 10927.617533386612, 11198.664040078811, 11202.0, 11583.536658533565, 8143.0, 8220.424570280024, 8286.958565207135, 8315.085340612406, 8418.915810841812, 9642.276829237975, 11021.669349919515, 11080.952737996793, 11383.146264030396, 11455.427228638702], "value": 10637.40992292468, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1285.5243559882833, 1414.610981979956, 1437.4034775568139, 1448.2975756757965, 1455.046944251515, 6885.896711549331, 8188.754337369881, 8387.874181887277, 8409.789755256106, 8441.62012709428, 8280.91719082809, 8331.875021874677, 8357.832843343145, 8360.372972027091, 8364.372672049605, 1801.936932207373, 2069.286096296775, 2083.8853863037525, 2103.621348157331, 2104.8631838930496, 1821.8997955112463, 1852.9073546322697, 2054.3734161080865, 2097.5490269592033, 2109.8101170894615, 2087.7494700635943, 2097.391756390645, 2102.0435701755664, 2102.29573093014, 2104.5790841831617, 1967.2229469359522, 1979.7129416234566, 1987.3839109875912, 1994.0428594274683, 1997.5605366819277, 2028.2495476673726, 2030.147338117994, 2066.2354928676336, 2066.8139867412006, 2071.989640051805, 8336.583170841433, 8341.331733653293, 8388.8741668875, 8401.201885820898, 8412.663493460253, 4910.90178196434, 5006.549410553068, 5029.874253143701, 5030.01914626648, 5030.968651426449, 3060.4032213718333, 3122.172624254574, 3129.624445066584, 3176.4600017996995, 3195.2970346523725, 1365.7814749640108, 1369.431685850371, 1396.2250950722346, 1424.978625320621, 1440.5966329427777, 11309.604163854226, 11345.773084538263, 11369.943150284278, 11384.601538946097, 11387.145964052646, 4333.090051089243, 4394.516603173648, 4401.933970990438, 4412.448443944507, 4430.712003719748, 9733.124018838338, 9735.951320243496, 9742.07450292221, 9745.610175592898, 9754.609815607297, 5072.9746351268, 5078.847634570969, 5079.822206222764, 5081.974590127025, 5085.3134826797905, 4430.490493593278, 4587.449506059227, 4602.3786788783755, 4654.325122857167, 4675.22858728306, 3249.447593909041, 3370.915727106793, 3375.729941604666, 3434.9313013740084, 3483.1640406302304, 1138.9658310250707, 1143.5940241214416, 1144.1533265383723, 1147.73602071524, 1170.3796987596588, 843.2242337049929, 845.7335939179262, 854.2952064546773, 872.7381785464462, 874.7987962768472, 5289.100852855024, 5427.43011983744, 5486.259354987025, 5506.669599824023, 5512.090505066619, 987.2348929579633, 990.6186118344489, 997.1723469520281, 1001.4592120254981, 1020.4132623741378, 3546.8226588670464, 3726.2733766915735, 3735.831887565066, 3748.962510374916, 3750.2312026035142, 9662.502312141629, 9768.51157442125, 9849.359791613522, 9891.653792117242, 9944.25418093646, 9816.852747208797, 9828.950855245677, 9831.410115393099, 9835.360701554377, 9840.11438970496, 7580.3556697681315, 7582.165961744204, 7654.124739438873, 7733.41999350051, 7733.883991740128, 5218.530332270114, 5248.501392367719, 5250.763715632882, 5288.550473209666, 5439.156930675752, 9030.729078127666, 9031.367804253901, 9051.773705657148, 9054.411463254868, 9144.771380715536, 8682.479051256945, 9030.05184455649, 9110.863337049817, 9126.726198214064, 9295.209907157967, 7133.286671332825, 7237.457190710613, 7255.818604534928, 7278.053852999076, 7285.271472852673, 6662.766803161866, 6869.416099631588, 7408.555486670817, 7787.532748035136, 7858.960705196438, 6836.48726345536, 6999.8250043747275, 7074.327938845801, 7087.751928682472, 7263.0, 7086.185088714864, 7110.893336599852, 7130.572165670076, 7137.214906360193, 7163.4269258460245, 6362.586431881913, 6403.263624683221, 6416.7754128605275, 6435.967820160869, 6487.286398496256, 4539.977300113478, 4613.284940834176, 4751.429828420612, 4768.1417344878255, 4822.565969062801, 4702.059588082466, 4769.689970151929, 4772.522747725338, 4796.832110876103, 4947.82682606107], "value": 4286.103254374123, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [393.6895012947797, 394.7394719485139, 408.23152137559265, 412.865818608952, 417.29060596985124, 5298.390685071218, 5298.96670149321, 5304.162273183847, 5304.2043693446, 5311.840644780658, 5065.4934506549325, 5187.950759450015, 5206.167013277876, 5240.318758561391, 5279.630425870181, 4095.9180816383655, 4100.220958017967, 4102.692298077656, 4121.0, 4141.047559061402, 4139.6895232857505, 4145.129522800215, 4147.626713595776, 4150.9584904151025, 4157.792110394484, 3936.566977632458, 4077.1845630873795, 4126.66986641068, 4132.586741325874, 4144.834206631731, 4086.6934979876332, 4104.240715467618, 4115.612944492187, 4117.279476091702, 4128.380742888561, 3652.2695460907657, 3656.6708996190205, 3663.816809159558, 3697.5193224880595, 3703.185299234164, 4921.827736029221, 5145.790739176291, 5150.9742451287875, 5155.896882062338, 5190.532852043334, 4867.318575399447, 4869.245266983623, 4877.122118018755, 4884.19410797218, 4884.535969082932, 5503.367112782042, 5523.6685798852195, 5526.198701188346, 5531.502164805147, 5558.666480011212, 4139.565345638694, 4241.703080784347, 4241.724287921306, 4250.128723611652, 4262.0, 5528.5024347808485, 5568.303962004709, 5646.22144024631, 5720.798632287225, 5763.9135412968835, 4286.721363111388, 4340.175366680321, 4341.131773645284, 4345.34819777036, 4363.498197707241, 4429.977850110793, 4446.42196514451, 4461.219286624828, 4465.307877279027, 4470.150671372428, 4630.236011058138, 4654.325122857167, 4908.656394052382, 4918.9508104919205, 4974.7263900485095, 5521.0, 5539.196816461671, 5539.833804985857, 5554.250176226158, 5573.359063707644, 1493.820741511004, 1497.655539225984, 1498.1535432480614, 1510.7129645367345, 1515.8559936805987, 1016.3343010328247, 1071.405370019631, 1089.9128069754559, 1105.1214284643568, 1111.4498323330004, 5152.742362881841, 5155.561777248976, 5169.767360468788, 5172.663776854492, 5192.27308176848, 5464.836054918359, 5467.480589344006, 5475.0, 5479.5342395896, 5496.890062198733, 4843.321934929113, 5055.0, 5067.1639179535705, 5161.845144645667, 5173.327467429285, 2876.5397536394075, 2878.956815647767, 2880.884764609434, 2905.825650460979, 2915.4460652475964, 5678.835838653066, 5724.398938111522, 5727.968965586151, 5744.281964754406, 5760.942390576124, 5444.6932736143835, 5745.569082318842, 5749.655020698771, 5765.483055336242, 5779.612892905757, 5823.340348000799, 5833.7374818133285, 5837.620554663933, 5857.502112320501, 5865.706714664249, 5464.644798088111, 5482.80810171642, 5604.915926261027, 5610.943890561042, 5666.886662266649, 5572.247746554163, 5605.468554810606, 5611.607187496836, 5635.915461268002, 5652.576056795839, 5669.433056694297, 5775.787084712258, 5787.768489260551, 5790.334111577223, 5928.67392293428, 3849.5188101487315, 4056.371262454324, 4101.938470922998, 4110.23960567296, 4123.649489793281, 5570.693611851387, 5649.237352957298, 5666.716664166693, 5676.460736230051, 5693.231413759255, 5409.972950135224, 5455.181722741462, 5497.697626630574, 5500.834974950758, 5535.5848311376, 5482.4101010706445, 5483.259759932517, 5503.972480137573, 5507.614466987433, 5527.50252477279, 5235.110031294613, 5483.945160548344, 5503.587230957614, 5527.2538207341495, 5530.751116199861, 5539.695316757456, 5546.639468434539, 5612.726845627528, 5614.943850561605, 5626.774929002794, 5391.0, 5425.376081750649, 5425.918611220914, 5450.637340664834, 5465.781368745205], "value": 4277.750090178567, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [717.5336031579473, 767.3209209849285, 819.2626636027576, 836.3058661311112, 843.9789005274863, 15431.07413555186, 16322.75515867263, 16323.510294691163, 16341.5914602135, 16342.428015019477, 14097.0, 14175.858241417583, 14186.21975791331, 14205.360758765855, 14245.572632821031, 776.5263189454442, 779.5790273252437, 796.2236819101388, 799.3645052183499, 800.2957397490201, 802.9156938521459, 803.8311954489535, 804.891339669143, 804.9154838741906, 805.5287656720825, 842.5071333270014, 842.5450256861318, 843.3211264931728, 843.3211264931728, 843.439112989861, 830.0288662265165, 831.2809419851815, 832.2094010689868, 837.4598384042289, 838.0237023867187, 610.6549799363346, 613.8772245550907, 614.7233744814852, 615.7998650438625, 617.1575799034331, 14677.70644587113, 14710.19093949843, 14772.187529685863, 15489.0, 16120.435784747477, 14735.115893046452, 14795.112293262438, 15092.773608395883, 15285.541433757006, 15325.080495170214, 12074.27554346742, 12209.206401583957, 12218.266903985701, 12328.226149116466, 12485.93757031209, 3609.4766258892314, 3692.0, 3784.7161462890394, 3862.942055869164, 3863.0, 74452.0, 75717.62141189314, 75912.0, 77092.61453692752, 79082.60458697728, 10992.505337259843, 11005.17461190414, 11182.496787644575, 11282.43587820622, 11565.653030409101, 21052.26317078895, 21257.255996040065, 21345.35963921085, 21360.572788544454, 21390.358289251348, 7462.10454745434, 7488.101427828696, 7616.428767842434, 7694.153643099255, 7785.532868027936, 4422.535633758409, 4476.26141686618, 4512.187806194916, 4529.139463501924, 4601.470830854428, 3703.092742278159, 3765.7175711821724, 3776.8300426480873, 3780.7542509736777, 3782.678472329828, 631.3181763695198, 631.7283568065776, 637.2862394118524, 645.686841881687, 654.6268626882631, 573.1889376532243, 582.9446202610745, 597.4369952902001, 644.1915396177767, 696.6481926627021, 9283.164515193665, 9301.255899528021, 10032.548535315927, 10111.544980475895, 10114.645987390406, 565.7821738630657, 576.6453631016894, 587.9147523609053, 655.1842955520408, 727.1063455197342, 4897.4857639948, 5086.618503612244, 5114.232865070269, 5154.123798954187, 5171.250168725589, 59755.701221494484, 60792.0, 61868.381316187166, 67282.0, 73629.6318518404, 47298.29052564214, 56010.71994640001, 59100.70449647724, 61548.38451615426, 62201.37798621956, 56468.0, 56839.43160568424, 56912.43087569154, 56945.86108277894, 57360.11678598595, 10062.446565438971, 10362.585496580052, 10523.210759193244, 10551.419671918118, 10580.682579522627, 38089.809550952064, 38116.23767524689, 39509.2098158041, 39999.600003999585, 40459.79770101131, 45467.77266113781, 48121.518784811706, 48263.0, 48638.5136148634, 48876.5112348872, 12454.937725311316, 12561.246325220516, 12566.685832854251, 12667.239965602093, 12978.870211297766, 13850.515231966832, 14051.751719724794, 14566.4901728439, 14687.706245875237, 15136.621584460036, 12353.752924941271, 13022.674433139247, 13283.335833208494, 13364.933175334061, 13617.455301787817, 12379.62861114168, 12821.294828784507, 12902.67743306425, 13073.411696473871, 13327.054157888215, 12827.743445130858, 13588.25264610456, 13717.0, 13860.930695346458, 13994.930025349808, 9948.253880959102, 10477.528511217166, 10609.151267898395, 10696.136564250017, 10758.781408411578, 10181.690950441285, 10307.690769276935, 10358.119559837498, 10418.843717344398, 10422.583096676048], "value": 7016.770933617723, "unit": "score"}]}, {"extraOptions": [], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1510.7, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [111.0, 113.0, 112.0, 111.0, 113.0, 113.0, 113.0, 113.0, 111.0, 112.0], "value": 112.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [142.0, 119.0, 120.0, 171.0, 122.0, 120.0, 125.0, 119.0, 144.0, 119.0], "value": 130.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 163.0, 162.0, 160.0, 161.0, 163.0, 163.0, 169.0, 161.0, 161.0], "value": 162.5, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 76.0, 76.0, 109.0, 78.0, 76.0, 76.0, 75.0, 94.0, 76.0], "value": 81.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 83.0, 109.0, 83.0, 82.0, 82.0, 95.0, 84.0, 84.0, 109.0], "value": 89.4, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 113.0, 113.0, 113.0, 113.0, 113.0, 113.0, 112.0, 113.0, 113.0], "value": 113.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 147.0, 147.0, 147.0, 146.0, 148.0, 148.0, 148.0, 146.0], "value": 147.1, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0], "value": 96.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 53.0, 53.0, 54.0, 55.0, 66.0, 54.0, 55.0, 53.0, 55.0], "value": 55.3, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 65.0, 63.0, 64.0, 63.0, 64.0, 64.0, 64.0, 64.0, 64.0], "value": 63.9, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 82.0, 83.0, 83.0, 82.0, 92.0, 88.0, 82.0, 84.0, 83.0], "value": 84.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [136.0, 128.0, 128.0, 138.0, 129.0, 129.0, 126.0, 128.0, 165.0, 154.0], "value": 136.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [180.0, 175.0, 174.0, 177.0, 178.0, 171.0, 176.0, 178.0, 174.0, 176.0], "value": 175.9, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 64.0, 64.0, 67.0, 63.0, 64.0, 62.0, 63.0, 62.0, 63.0], "value": 63.9, "unit": "score"}]}]} 16:20:05 INFO - Return code: 0 16:20:05 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 16:20:05 ERROR - # TBPL SUCCESS # 16:20:05 INFO - Running post-action listener: _resource_record_post_action 16:20:05 INFO - [mozharness: 2017-02-23 00:20:05.569527Z] Finished run-tests step (success) 16:20:05 INFO - Running post-run listener: _resource_record_post_run 16:20:05 INFO - Total resource usage - Wall time: 1196s; CPU: 13.0%; Read bytes: 0; Write bytes: 366288896; Read time: 0; Write time: 208740 16:20:05 INFO - TinderboxPrint: CPU usage
13.1% 16:20:05 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 16:20:05 INFO - TinderboxPrint: I/O write bytes / time
366,288,896 / 208,740 16:20:05 INFO - TinderboxPrint: CPU idle
8,295.7 (86.9%) 16:20:05 INFO - TinderboxPrint: CPU user
1,202.7 (12.6%) 16:20:05 INFO - TinderboxPrint: Swap in / out
0 / 0 16:20:05 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 113397760; Read time: 0; Write time: 92160 16:20:05 INFO - run-tests - Wall time: 1179s; CPU: 13.0%; Read bytes: 0; Write bytes: 252891136; Read time: 0; Write time: 116580 16:20:06 INFO - Running post-run listener: _upload_blobber_files 16:20:06 INFO - Blob upload gear active. 16:20:06 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 16:20:06 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 16:20:06 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 16:20:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 16:20:06 INFO - (blobuploader) - INFO - Open directory for files ... 16:20:06 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 16:20:06 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:20:06 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:20:09 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 16:20:09 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:20:09 INFO - (blobuploader) - INFO - Done attempting. 16:20:09 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 16:20:09 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:20:09 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:20:10 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 16:20:10 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:20:10 INFO - (blobuploader) - INFO - Done attempting. 16:20:10 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 16:20:10 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:20:10 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:20:11 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 16:20:11 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:20:11 INFO - (blobuploader) - INFO - Done attempting. 16:20:11 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 16:20:11 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:20:11 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:20:12 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 16:20:12 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:20:12 INFO - (blobuploader) - INFO - Done attempting. 16:20:12 INFO - (blobuploader) - INFO - Iteration through files over. 16:20:12 INFO - Return code: 0 16:20:12 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 16:20:12 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 16:20:12 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/a5794a145368074d9c49acc5c0f4817747e24340a91af8ba997be02fc3d48088232b371debbab14795f975a24f8023c2a2f5586771452b1ce1c2f199b59942ac", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/fc70b7789f569facfab6ec9187a30dfddf19e2c5eb04fc86fa5358f3bd775b3c6a337be6fedb6e68085cb5ec2dc98075c0c8424de924785e02672a23940914db", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7d84d3a83cca761dadf5b54eeeed803653ca89210f3418ecc754ab65824839899e7bc4589b3520ceabb3cd77d616f1ad790acc866ba0f0420dfd028e66cfc8df", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d721c6098cf43e19d966d62c4e05e2231b0a7bcc6ef9fbc4861b402a479a8ee57f8f756ea563b934a210acce19e406fbf28084cfa60c2c236e0caae0a2d4b7da"} 16:20:12 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 16:20:12 INFO - Writing to file /builds/slave/test/properties/blobber_files 16:20:12 INFO - Contents: 16:20:12 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/a5794a145368074d9c49acc5c0f4817747e24340a91af8ba997be02fc3d48088232b371debbab14795f975a24f8023c2a2f5586771452b1ce1c2f199b59942ac", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/fc70b7789f569facfab6ec9187a30dfddf19e2c5eb04fc86fa5358f3bd775b3c6a337be6fedb6e68085cb5ec2dc98075c0c8424de924785e02672a23940914db", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7d84d3a83cca761dadf5b54eeeed803653ca89210f3418ecc754ab65824839899e7bc4589b3520ceabb3cd77d616f1ad790acc866ba0f0420dfd028e66cfc8df", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d721c6098cf43e19d966d62c4e05e2231b0a7bcc6ef9fbc4861b402a479a8ee57f8f756ea563b934a210acce19e406fbf28084cfa60c2c236e0caae0a2d4b7da"} 16:20:12 INFO - Running post-run listener: copy_logs_to_upload_dir 16:20:12 INFO - Copying logs to upload dir... 16:20:12 INFO - mkdir: /builds/slave/test/build/upload/logs 16:20:12 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1253.308442 ========= master_lag: -0.00 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 53 secs) (at 2017-02-22 16:20:11.805365) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-22 16:20:11.808583) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/a5794a145368074d9c49acc5c0f4817747e24340a91af8ba997be02fc3d48088232b371debbab14795f975a24f8023c2a2f5586771452b1ce1c2f199b59942ac", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/fc70b7789f569facfab6ec9187a30dfddf19e2c5eb04fc86fa5358f3bd775b3c6a337be6fedb6e68085cb5ec2dc98075c0c8424de924785e02672a23940914db", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7d84d3a83cca761dadf5b54eeeed803653ca89210f3418ecc754ab65824839899e7bc4589b3520ceabb3cd77d616f1ad790acc866ba0f0420dfd028e66cfc8df", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d721c6098cf43e19d966d62c4e05e2231b0a7bcc6ef9fbc4861b402a479a8ee57f8f756ea563b934a210acce19e406fbf28084cfa60c2c236e0caae0a2d4b7da"} build_url:https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011322 build_url: 'https://queue.taskcluster.net/v1/task/a8I4NPFaQGWZJQtez1bQeg/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/a5794a145368074d9c49acc5c0f4817747e24340a91af8ba997be02fc3d48088232b371debbab14795f975a24f8023c2a2f5586771452b1ce1c2f199b59942ac", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/fc70b7789f569facfab6ec9187a30dfddf19e2c5eb04fc86fa5358f3bd775b3c6a337be6fedb6e68085cb5ec2dc98075c0c8424de924785e02672a23940914db", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7d84d3a83cca761dadf5b54eeeed803653ca89210f3418ecc754ab65824839899e7bc4589b3520ceabb3cd77d616f1ad790acc866ba0f0420dfd028e66cfc8df", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d721c6098cf43e19d966d62c4e05e2231b0a7bcc6ef9fbc4861b402a479a8ee57f8f756ea563b934a210acce19e406fbf28084cfa60c2c236e0caae0a2d4b7da"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-22 16:20:11.833723) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-22 16:20:11.834048) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=199fb4c72b90437b990b419b000001c5-1487807956.608605-2105406874 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004493 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-22 16:20:11.918173) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-22 16:20:11.918480) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-22 16:20:11.918765) ========= ========= Total master_lag: 0.15 =========