builder: mozilla-central_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-027 starttime: 1493422426.8 results: success (0) revision: 1c994cd72265c48bbdc9f6404df87c4eae488b34 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-04-28 16:33:46.800394) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-04-28 16:33:46.800847) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-04-28 16:33:46.801122) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-04-28 16:33:46.816083) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-04-28 16:33:46.816432) ========= 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=1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-04-28 16:33:46-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 43.2M=0s 2017-04-28 16:33:46 (43.2 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.123814 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-04-28 16:33:46.954697) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-04-28 16:33:46.955005) ========= 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=1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.023512 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-04-28 16:33:47.007290) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-04-28 16:33:47.007622) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 1c994cd72265c48bbdc9f6404df87c4eae488b34 --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 1c994cd72265c48bbdc9f6404df87c4eae488b34 --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=1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-04-28 16:33:47,092 truncating revision to first 12 chars 2017-04-28 16:33:47,092 Setting DEBUG logging. 2017-04-28 16:33:47,092 attempt 1/10 2017-04-28 16:33:47,093 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/1c994cd72265?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-04-28 16:33:47,477 unpacking tar archive at: mozilla-central-1c994cd72265/testing/mozharness/ program finished with exit code 0 elapsedTime=0.703249 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-04-28 16:33:47.730419) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-04-28 16:33:47.730747) ========= script_repo_revision: 1c994cd72265c48bbdc9f6404df87c4eae488b34 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-04-28 16:33:47.731160) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-04-28 16:33:47.731437) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-04-28 16:33:47.742625) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 52 secs) (at 2017-04-28 16:33:47.742952) ========= /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=1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 16:33:47 INFO - MultiFileLogger online at 20170428 16:33:47 in /builds/slave/test 16:33:47 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 16:33:47 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 16:33:47 INFO - {'append_to_log': False, 16:33:47 INFO - 'base_work_dir': '/builds/slave/test', 16:33:47 INFO - 'blob_upload_branch': 'Firefox', 16:33:47 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 16:33:47 INFO - 'branch': 'Firefox', 16:33:47 INFO - 'buildbot_json_path': 'buildprops.json', 16:33:47 INFO - 'config_files': ('talos/linux_config.py',), 16:33:47 INFO - 'default_actions': ('clobber', 16:33:47 INFO - 'read-buildbot-config', 16:33:47 INFO - 'download-and-extract', 16:33:47 INFO - 'populate-webroot', 16:33:47 INFO - 'create-virtualenv', 16:33:47 INFO - 'install', 16:33:47 INFO - 'run-tests'), 16:33:47 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 16:33:47 INFO - 'download_minidump_stackwalk': True, 16:33:47 INFO - 'download_symbols': 'ondemand', 16:33:47 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 16:33:47 INFO - 'tooltool.py': '/tools/tooltool.py', 16:33:47 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 16:33:47 INFO - '/tools/misc-python/virtualenv.py')}, 16:33:47 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 16:33:47 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 16:33:47 INFO - 'gecko_profile': False, 16:33:47 INFO - 'gecko_profile_interval': 0, 16:33:47 INFO - 'installer_path': 'installer.exe', 16:33:47 INFO - 'log_level': 'info', 16:33:47 INFO - 'log_name': 'talos', 16:33:47 INFO - 'log_to_console': True, 16:33:47 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 16:33:47 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 16:33:47 INFO - 'opt_config_files': (), 16:33:47 INFO - 'pip_index': False, 16:33:47 INFO - 'suite': 'dromaeojs', 16:33:47 INFO - 'system_bits': '32', 16:33:47 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 16:33:47 INFO - 'title': 'talos-linux64-ix-027', 16:33:47 INFO - 'tooltool_cache': '/builds/tooltool_cache', 16:33:47 INFO - 'use_talos_json': True, 16:33:47 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 16:33:47 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 16:33:47 INFO - 'work_dir': 'build'} 16:33:47 INFO - [mozharness: 2017-04-28 23:33:47.923869Z] Running clobber step. 16:33:47 INFO - Running pre-action listener: _resource_record_pre_action 16:33:47 INFO - Running main action method: clobber 16:33:47 INFO - rmtree: /builds/slave/test/build 16:33:47 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 16:33:48 INFO - Running post-action listener: _resource_record_post_action 16:33:48 INFO - [mozharness: 2017-04-28 23:33:48.852628Z] Finished clobber step (success) 16:33:48 INFO - [mozharness: 2017-04-28 23:33:48.852729Z] Running read-buildbot-config step. 16:33:48 INFO - Running pre-action listener: _resource_record_pre_action 16:33:48 INFO - Running main action method: read_buildbot_config 16:33:48 INFO - Using buildbot properties: 16:33:48 INFO - { 16:33:48 INFO - "project": "", 16:33:48 INFO - "product": "firefox", 16:33:48 INFO - "who": "kwierso@gmail.com", 16:33:48 INFO - "installer_path": "public/build/target.tar.bz2", 16:33:48 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 16:33:48 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 16:33:48 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs", 16:33:48 INFO - "stage_platform": "linux64-pgo", 16:33:48 INFO - "basedir": "/builds/slave/test", 16:33:48 INFO - "buildnumber": 151, 16:33:48 INFO - "platform": "ubuntu64_hw", 16:33:48 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 16:33:48 INFO - "slavebuilddir": "test", 16:33:48 INFO - "taskId": "Mw3vHOMBRDiI51k7WR9KAQ", 16:33:48 INFO - "branch": "mozilla-central", 16:33:48 INFO - "script_repo_revision": "production", 16:33:48 INFO - "revision": "1c994cd72265c48bbdc9f6404df87c4eae488b34", 16:33:48 INFO - "slavename": "talos-linux64-ix-027", 16:33:48 INFO - "repo_path": "mozilla-central" 16:33:48 INFO - } 16:33:48 INFO - Finding installer, test and symbols from parent task. 16:33:48 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Mw3vHOMBRDiI51k7WR9KAQ'}, attempt #1 16:33:49 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Mw3vHOMBRDiI51k7WR9KAQ'}, attempt #1 16:33:49 INFO - Task dependencies: DaZH08FRTw6H11wAXAindQ 16:33:49 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ'}, attempt #1 16:33:50 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.tar.bz2 16:33:50 INFO - Set test_url: https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/test_packages.json 16:33:50 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.crashreporter-symbols.zip 16:33:50 INFO - Running post-action listener: _resource_record_post_action 16:33:50 INFO - [mozharness: 2017-04-28 23:33:50.242066Z] Finished read-buildbot-config step (success) 16:33:50 INFO - [mozharness: 2017-04-28 23:33:50.242284Z] Running download-and-extract step. 16:33:50 INFO - Running pre-action listener: _resource_record_pre_action 16:33:50 INFO - Running main action method: download_and_extract 16:33:50 INFO - mkdir: /builds/slave/test/build/tests 16:33:50 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:33:50 INFO - trying https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.test_packages.json 16:33:50 INFO - Downloading https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 16:33:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 16:33:50 INFO - Downloaded 986 bytes. 16:33:50 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 16:33:50 INFO - Using the following test package requirements: 16:33:50 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 16:33:50 INFO - u'common': [u'target.common.tests.zip'], 16:33:50 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 16:33:50 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 16:33:50 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 16:33:50 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 16:33:50 INFO - u'mozbase': [u'target.common.tests.zip'], 16:33:50 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 16:33:50 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 16:33:50 INFO - u'web-platform': [u'target.common.tests.zip', 16:33:50 INFO - u'target.web-platform.tests.zip'], 16:33:50 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 16:33:50 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 16:33:50 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.common.tests.zip 16:33:50 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 16:33:50 INFO - Fetch https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.common.tests.zip into memory 16:33:51 INFO - Content-Length response header: 60552012 16:33:51 INFO - Bytes received: 60552012 16:34:01 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 16:34:01 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.common.tests.zip 16:34:01 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 16:34:01 INFO - Fetch https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.common.tests.zip into memory 16:34:02 INFO - Content-Length response header: 60552012 16:34:02 INFO - Bytes received: 60552012 16:34:13 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.talos.tests.zip 16:34:13 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.talos.tests.zip'}, attempt #1 16:34:13 INFO - Fetch https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.talos.tests.zip into memory 16:34:14 INFO - Content-Length response header: 14408809 16:34:14 INFO - Bytes received: 14408809 16:34:14 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:34:14 INFO - trying https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.tar.bz2 16:34:14 INFO - Downloading https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 16:34:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 16:34:15 INFO - Downloaded 64142004 bytes. 16:34:15 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.tar.bz2 16:34:15 INFO - mkdir: /builds/slave/test/properties 16:34:15 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 16:34:15 INFO - Writing to file /builds/slave/test/properties/build_url 16:34:15 INFO - Contents: 16:34:15 INFO - build_url:https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.tar.bz2 16:34:15 INFO - Running post-action listener: _resource_record_post_action 16:34:15 INFO - Running post-action listener: set_extra_try_arguments 16:34:15 INFO - [mozharness: 2017-04-28 23:34:15.860720Z] Finished download-and-extract step (success) 16:34:15 INFO - [mozharness: 2017-04-28 23:34:15.860815Z] Running populate-webroot step. 16:34:15 INFO - Running pre-action listener: _resource_record_pre_action 16:34:15 INFO - Running main action method: populate_webroot 16:34:15 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 16:34:15 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 16:34:15 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 16:34:15 INFO - '--tppagecycles', 16:34:15 INFO - '7'], 16:34:15 INFO - 'tests': ['tsvgm']}}, 16:34:15 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 16:34:15 INFO - 'tests': ['tresize', 'tcanvasmark']}, 16:34:15 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 16:34:15 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 16:34:15 INFO - 'tests': ['dromaeo_css', 'kraken']}, 16:34:15 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 16:34:15 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 16:34:15 INFO - 'talos_options': ['--disable-e10s'], 16:34:15 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:34:15 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 16:34:15 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:34:15 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 16:34:15 INFO - 'talos_options': ['--disable-e10s'], 16:34:15 INFO - 'tests': ['damp', 'tps']}, 16:34:15 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 16:34:15 INFO - 'tests': ['damp', 'tps']}, 16:34:15 INFO - 'g3': {'talos_options': ['--disable-e10s'], 16:34:15 INFO - 'tests': ['dromaeo_dom']}, 16:34:15 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 16:34:15 INFO - 'g4': {'talos_options': ['--disable-e10s'], 16:34:15 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 16:34:15 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 16:34:15 INFO - 'other': {'talos_options': ['--disable-e10s'], 16:34:15 INFO - 'tests': ['a11yr', 16:34:15 INFO - 'ts_paint', 16:34:15 INFO - 'tpaint', 16:34:15 INFO - 'sessionrestore', 16:34:15 INFO - 'sessionrestore_no_auto_restore', 16:34:15 INFO - 'tabpaint']}, 16:34:15 INFO - 'other-e10s': {'tests': ['a11yr', 16:34:15 INFO - 'ts_paint', 16:34:15 INFO - 'tpaint', 16:34:15 INFO - 'sessionrestore', 16:34:15 INFO - 'sessionrestore_no_auto_restore', 16:34:15 INFO - 'tabpaint']}, 16:34:15 INFO - 'other-e10s_l64': {'tests': ['a11yr', 16:34:15 INFO - 'ts_paint', 16:34:15 INFO - 'tpaint', 16:34:15 INFO - 'sessionrestore', 16:34:15 INFO - 'sessionrestore_no_auto_restore', 16:34:15 INFO - 'tabpaint']}, 16:34:15 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 16:34:15 INFO - 'ts_paint', 16:34:15 INFO - 'tpaint', 16:34:15 INFO - 'sessionrestore', 16:34:15 INFO - 'sessionrestore_no_auto_restore', 16:34:15 INFO - 'tabpaint']}, 16:34:15 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 16:34:15 INFO - 'tests': ['a11yr', 16:34:15 INFO - 'ts_paint', 16:34:15 INFO - 'tpaint', 16:34:15 INFO - 'sessionrestore', 16:34:15 INFO - 'sessionrestore_no_auto_restore', 16:34:15 INFO - 'tabpaint']}, 16:34:15 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 16:34:15 INFO - 'tests': ['a11yr', 16:34:15 INFO - 'ts_paint', 16:34:15 INFO - 'tpaint', 16:34:15 INFO - 'sessionrestore', 16:34:15 INFO - 'sessionrestore_no_auto_restore', 16:34:15 INFO - 'tabpaint']}, 16:34:15 INFO - 'perf-reftest': {'tests': ['bloom_basic', 'bloom_basic_ref']}, 16:34:15 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic', 16:34:15 INFO - 'bloom_basic_ref']}, 16:34:15 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 16:34:15 INFO - 'tests': ['tsvgx', 16:34:15 INFO - 'tsvgr_opacity', 16:34:15 INFO - 'tart', 16:34:15 INFO - 'tscrollx', 16:34:15 INFO - 'cart', 16:34:15 INFO - 'tsvg_static']}, 16:34:15 INFO - 'svgr-e10s': {'tests': ['tsvgx', 16:34:15 INFO - 'tsvgr_opacity', 16:34:15 INFO - 'tart', 16:34:15 INFO - 'tscrollx', 16:34:15 INFO - 'cart', 16:34:15 INFO - 'tsvg_static']}, 16:34:15 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 16:34:15 INFO - 'talos_options': ['--disable-e10s'], 16:34:15 INFO - 'tests': ['tp5o']}, 16:34:15 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 16:34:15 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 16:34:15 INFO - 'talos_options': ['--disable-e10s', 16:34:15 INFO - '--xperf_path', 16:34:15 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:34:15 INFO - 'tests': ['tp5n']}, 16:34:15 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 16:34:15 INFO - 'talos_options': ['--xperf_path', 16:34:15 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:34:15 INFO - 'tests': ['tp5n']}}, 16:34:15 INFO - 'talos.zip': {'path': '', 16:34:15 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 16:34:15 INFO - Running post-action listener: _resource_record_post_action 16:34:15 INFO - [mozharness: 2017-04-28 23:34:15.874463Z] Finished populate-webroot step (success) 16:34:15 INFO - [mozharness: 2017-04-28 23:34:15.874552Z] Running create-virtualenv step. 16:34:15 INFO - Running pre-action listener: _resource_record_pre_action 16:34:15 INFO - Running main action method: create_virtualenv 16:34:15 INFO - Creating virtualenv /builds/slave/test/build/venv 16:34:15 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 16:34:15 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 16:34:15 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 16:34:15 INFO - Using real prefix '/usr' 16:34:15 INFO - New python executable in /builds/slave/test/build/venv/bin/python 16:34:16 INFO - Installing distribute.............................................................................................................................................................................................done. 16:34:18 INFO - Installing pip.................done. 16:34:18 INFO - Return code: 0 16:34:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 16:34:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 16:34:18 INFO - Reading from file tmpfile_stdout 16:34:18 INFO - Output received: 16:34:18 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) 16:34:18 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 16:34:18 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:34:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:34:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:18 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:34:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:34:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:18 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 0xe101f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe4da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ae310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab400>, '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 0x10ac3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ac840>, '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': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', '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:34:18 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 16:34:18 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 16:34:18 INFO - Using env: {'DISPLAY': ':0', 16:34:18 INFO - 'HOME': '/home/cltbld', 16:34:18 INFO - 'LANG': 'en_US.UTF-8', 16:34:18 INFO - 'LANGUAGE': 'en_US:en', 16:34:18 INFO - 'LOGNAME': 'cltbld', 16:34:18 INFO - 'MAIL': '/var/mail/cltbld', 16:34:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:34:18 INFO - 'MOZ_NO_REMOTE': '1', 16:34:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:34:18 INFO - 'NO_EM_RESTART': '1', 16:34:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:34:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:34:18 INFO - 'PWD': '/builds/slave/test', 16:34:18 INFO - 'SHELL': '/bin/bash', 16:34:18 INFO - 'SHLVL': '1', 16:34:18 INFO - 'TERM': 'linux', 16:34:18 INFO - 'TMOUT': '86400', 16:34:18 INFO - 'USER': 'cltbld', 16:34:18 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', 16:34:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:34:18 INFO - '_': '/tools/buildbot/bin/python'} 16:34:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:34:18 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 16:34:18 INFO - Cleaning up... 16:34:18 INFO - Return code: 0 16:34:18 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 16:34:18 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:34:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:34:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:18 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:34:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:34:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:18 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 0xe101f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe4da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ae310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab400>, '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 0x10ac3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ac840>, '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': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', '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:34:18 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 16:34:18 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 16:34:18 INFO - Using env: {'DISPLAY': ':0', 16:34:18 INFO - 'HOME': '/home/cltbld', 16:34:18 INFO - 'LANG': 'en_US.UTF-8', 16:34:18 INFO - 'LANGUAGE': 'en_US:en', 16:34:18 INFO - 'LOGNAME': 'cltbld', 16:34:18 INFO - 'MAIL': '/var/mail/cltbld', 16:34:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:34:18 INFO - 'MOZ_NO_REMOTE': '1', 16:34:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:34:18 INFO - 'NO_EM_RESTART': '1', 16:34:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:34:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:34:18 INFO - 'PWD': '/builds/slave/test', 16:34:18 INFO - 'SHELL': '/bin/bash', 16:34:18 INFO - 'SHLVL': '1', 16:34:18 INFO - 'TERM': 'linux', 16:34:18 INFO - 'TMOUT': '86400', 16:34:18 INFO - 'USER': 'cltbld', 16:34:18 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', 16:34:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:34:18 INFO - '_': '/tools/buildbot/bin/python'} 16:34:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:34:19 INFO - Downloading/unpacking psutil>=3.1.1 16:34:19 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:34:19 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:34:19 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:34:19 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:34:19 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:34:19 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:34:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 16:34:21 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:34:21 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:34:21 INFO - Installing collected packages: psutil 16:34:21 INFO - Running setup.py install for psutil 16:34:21 INFO - building 'psutil._psutil_linux' extension 16:34:21 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 16:34:21 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 16:34:21 INFO - building 'psutil._psutil_posix' extension 16:34:21 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 16:34:21 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 16:34:21 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:34:21 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:34:21 INFO - Successfully installed psutil 16:34:21 INFO - Cleaning up... 16:34:21 INFO - Return code: 0 16:34:21 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 16:34: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')]} 16:34:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:34:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34: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')]} 16:34:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:34:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:21 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 0xe101f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe4da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ae310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab400>, '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 0x10ac3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ac840>, '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': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', '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:34:21 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 16:34:21 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 16:34:21 INFO - Using env: {'DISPLAY': ':0', 16:34:21 INFO - 'HOME': '/home/cltbld', 16:34:21 INFO - 'LANG': 'en_US.UTF-8', 16:34:21 INFO - 'LANGUAGE': 'en_US:en', 16:34:21 INFO - 'LOGNAME': 'cltbld', 16:34:21 INFO - 'MAIL': '/var/mail/cltbld', 16:34:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:34:21 INFO - 'MOZ_NO_REMOTE': '1', 16:34:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:34:21 INFO - 'NO_EM_RESTART': '1', 16:34:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:34:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:34:21 INFO - 'PWD': '/builds/slave/test', 16:34:21 INFO - 'SHELL': '/bin/bash', 16:34:21 INFO - 'SHLVL': '1', 16:34:21 INFO - 'TERM': 'linux', 16:34:21 INFO - 'TMOUT': '86400', 16:34:21 INFO - 'USER': 'cltbld', 16:34:21 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', 16:34:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:34:21 INFO - '_': '/tools/buildbot/bin/python'} 16:34:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:34:21 INFO - Downloading/unpacking mozsystemmonitor==0.3 16:34:21 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:34:21 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:34:21 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:34:21 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:34:21 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:34:21 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:34:23 INFO - Downloading mozsystemmonitor-0.3.tar.gz 16:34:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 16:34:24 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 16:34:24 INFO - Installing collected packages: mozsystemmonitor 16:34:24 INFO - Running setup.py install for mozsystemmonitor 16:34:24 INFO - Successfully installed mozsystemmonitor 16:34:24 INFO - Cleaning up... 16:34:24 INFO - Return code: 0 16:34:24 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 16:34:24 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:34:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:34:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:24 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:34:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:34:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:24 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 0xe101f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe4da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ae310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab400>, '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 0x10ac3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ac840>, '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': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', '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:34:24 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 16:34:24 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 16:34:24 INFO - Using env: {'DISPLAY': ':0', 16:34:24 INFO - 'HOME': '/home/cltbld', 16:34:24 INFO - 'LANG': 'en_US.UTF-8', 16:34:24 INFO - 'LANGUAGE': 'en_US:en', 16:34:24 INFO - 'LOGNAME': 'cltbld', 16:34:24 INFO - 'MAIL': '/var/mail/cltbld', 16:34:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:34:24 INFO - 'MOZ_NO_REMOTE': '1', 16:34:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:34:24 INFO - 'NO_EM_RESTART': '1', 16:34:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:34:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:34:24 INFO - 'PWD': '/builds/slave/test', 16:34:24 INFO - 'SHELL': '/bin/bash', 16:34:24 INFO - 'SHLVL': '1', 16:34:24 INFO - 'TERM': 'linux', 16:34:24 INFO - 'TMOUT': '86400', 16:34:24 INFO - 'USER': 'cltbld', 16:34:24 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', 16:34:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:34:24 INFO - '_': '/tools/buildbot/bin/python'} 16:34:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:34:24 INFO - Downloading/unpacking jsonschema==2.5.1 16:34:24 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:34:24 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:34:24 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:34:24 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:34:24 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:34:24 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:34:26 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 16:34:26 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 16:34:26 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:34:26 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:34:26 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:34:26 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:34:26 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:34:26 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:34:26 INFO - Downloading functools32-3.2.3-2.tar.gz 16:34:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 16:34:26 INFO - warning: no files found matching '*.txt' 16:34:26 INFO - no previously-included directories found matching 'build' 16:34:26 INFO - no previously-included directories found matching 'dist' 16:34:26 INFO - no previously-included directories found matching '.git*' 16:34:26 INFO - Installing collected packages: jsonschema, functools32 16:34:26 INFO - Running setup.py install for functools32 16:34:26 INFO - warning: no files found matching '*.txt' 16:34:26 INFO - no previously-included directories found matching 'build' 16:34:26 INFO - no previously-included directories found matching 'dist' 16:34:26 INFO - no previously-included directories found matching '.git*' 16:34:26 INFO - Successfully installed jsonschema functools32 16:34:26 INFO - Cleaning up... 16:34:26 INFO - Return code: 0 16:34:26 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 16:34: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:34:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:34:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34: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:34:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:34:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:26 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 0xe101f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe4da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ae310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab400>, '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 0x10ac3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ac840>, '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': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', '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:34:26 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 16:34:26 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 16:34:26 INFO - Using env: {'DISPLAY': ':0', 16:34:26 INFO - 'HOME': '/home/cltbld', 16:34:26 INFO - 'LANG': 'en_US.UTF-8', 16:34:26 INFO - 'LANGUAGE': 'en_US:en', 16:34:26 INFO - 'LOGNAME': 'cltbld', 16:34:26 INFO - 'MAIL': '/var/mail/cltbld', 16:34:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:34:26 INFO - 'MOZ_NO_REMOTE': '1', 16:34:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:34:26 INFO - 'NO_EM_RESTART': '1', 16:34:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:34:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:34:26 INFO - 'PWD': '/builds/slave/test', 16:34:26 INFO - 'SHELL': '/bin/bash', 16:34:26 INFO - 'SHLVL': '1', 16:34:26 INFO - 'TERM': 'linux', 16:34:26 INFO - 'TMOUT': '86400', 16:34:26 INFO - 'USER': 'cltbld', 16:34:26 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', 16:34:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:34:26 INFO - '_': '/tools/buildbot/bin/python'} 16:34:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:34:27 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 16:34:27 INFO - Cleaning up... 16:34:27 INFO - Return code: 0 16:34:27 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 16:34:27 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:34:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:34:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:27 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:34:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:34:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:27 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 0xe101f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe4da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ae310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab400>, '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 0x10ac3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ac840>, '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': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', '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:34:27 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 16:34:27 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 16:34:27 INFO - Using env: {'DISPLAY': ':0', 16:34:27 INFO - 'HOME': '/home/cltbld', 16:34:27 INFO - 'LANG': 'en_US.UTF-8', 16:34:27 INFO - 'LANGUAGE': 'en_US:en', 16:34:27 INFO - 'LOGNAME': 'cltbld', 16:34:27 INFO - 'MAIL': '/var/mail/cltbld', 16:34:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:34:27 INFO - 'MOZ_NO_REMOTE': '1', 16:34:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:34:27 INFO - 'NO_EM_RESTART': '1', 16:34:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:34:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:34:27 INFO - 'PWD': '/builds/slave/test', 16:34:27 INFO - 'SHELL': '/bin/bash', 16:34:27 INFO - 'SHLVL': '1', 16:34:27 INFO - 'TERM': 'linux', 16:34:27 INFO - 'TMOUT': '86400', 16:34:27 INFO - 'USER': 'cltbld', 16:34:27 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', 16:34:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:34:27 INFO - '_': '/tools/buildbot/bin/python'} 16:34:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:34:27 INFO - Downloading/unpacking blobuploader==1.2.4 16:34:27 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:34:27 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:34:27 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:34:27 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:34:27 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:34:27 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:34:29 INFO - Downloading blobuploader-1.2.4.tar.gz 16:34:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 16:34:29 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:34:29 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:34:29 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:34:29 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:34:29 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:34:29 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:34:29 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:34:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 16:34:29 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:34:29 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:34:29 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:34:29 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:34:29 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:34:29 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:34:29 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:34:30 INFO - Downloading docopt-0.6.1.tar.gz 16:34:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 16:34:30 INFO - Installing collected packages: blobuploader, requests, docopt 16:34:30 INFO - Running setup.py install for blobuploader 16:34:30 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 16:34:30 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 16:34:30 INFO - Running setup.py install for requests 16:34:30 INFO - Running setup.py install for docopt 16:34:30 INFO - Successfully installed blobuploader requests docopt 16:34:30 INFO - Cleaning up... 16:34:30 INFO - Return code: 0 16:34:30 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:34:30 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:34:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:34:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:30 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:34:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:34:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:30 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 0xe101f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe4da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ae310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab400>, '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 0x10ac3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ac840>, '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': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', '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:34:30 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:34:30 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:34:30 INFO - Using env: {'DISPLAY': ':0', 16:34:30 INFO - 'HOME': '/home/cltbld', 16:34:30 INFO - 'LANG': 'en_US.UTF-8', 16:34:30 INFO - 'LANGUAGE': 'en_US:en', 16:34:30 INFO - 'LOGNAME': 'cltbld', 16:34:30 INFO - 'MAIL': '/var/mail/cltbld', 16:34:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:34:30 INFO - 'MOZ_NO_REMOTE': '1', 16:34:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:34:30 INFO - 'NO_EM_RESTART': '1', 16:34:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:34:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:34:30 INFO - 'PWD': '/builds/slave/test', 16:34:30 INFO - 'SHELL': '/bin/bash', 16:34:30 INFO - 'SHLVL': '1', 16:34:30 INFO - 'TERM': 'linux', 16:34:30 INFO - 'TMOUT': '86400', 16:34:30 INFO - 'USER': 'cltbld', 16:34:30 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', 16:34:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:34:30 INFO - '_': '/tools/buildbot/bin/python'} 16:34:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:34:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:34:30 INFO - Running setup.py (path:/tmp/pip-z6JPvG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:34:31 INFO - Running setup.py (path:/tmp/pip-bDs_cG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:34:31 INFO - Running setup.py (path:/tmp/pip-oSFpo0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:34:31 INFO - Running setup.py (path:/tmp/pip-T4HKPF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:34:31 INFO - Running setup.py (path:/tmp/pip-8rZWOS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:34:31 INFO - Running setup.py (path:/tmp/pip-8nhA86-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:34:31 INFO - Running setup.py (path:/tmp/pip-AshWMV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:34:31 INFO - Running setup.py (path:/tmp/pip-5OOL6m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:34:31 INFO - Running setup.py (path:/tmp/pip-dNBul8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:34:31 INFO - Running setup.py (path:/tmp/pip-gLIlVn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:34:31 INFO - Running setup.py (path:/tmp/pip-M_QXHl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:34:31 INFO - Running setup.py (path:/tmp/pip-UOAH_c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:34:31 INFO - Running setup.py (path:/tmp/pip-KoqpQ4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:34:31 INFO - Running setup.py (path:/tmp/pip-yfl2rP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:34:31 INFO - Running setup.py (path:/tmp/pip-brkQHA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:34:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:34:32 INFO - Running setup.py (path:/tmp/pip-qyYnAU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:34:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:34:32 INFO - Running setup.py (path:/tmp/pip-dM6veU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:34:32 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:34:32 INFO - Running setup.py install for manifestparser 16:34:32 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 16:34:32 INFO - Running setup.py install for mozcrash 16:34:32 INFO - Running setup.py install for mozdebug 16:34:32 INFO - Running setup.py install for mozdevice 16:34:32 INFO - Installing dm script to /builds/slave/test/build/venv/bin 16:34:32 INFO - Running setup.py install for mozfile 16:34:32 INFO - Running setup.py install for mozhttpd 16:34:32 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 16:34:32 INFO - Running setup.py install for mozinfo 16:34:32 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 16:34:32 INFO - Running setup.py install for mozInstall 16:34:32 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 16:34:32 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 16:34:32 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 16:34:32 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 16:34:32 INFO - Running setup.py install for mozleak 16:34:33 INFO - Running setup.py install for mozlog 16:34:33 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 16:34:33 INFO - Running setup.py install for moznetwork 16:34:33 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 16:34:33 INFO - Running setup.py install for mozprocess 16:34:33 INFO - Running setup.py install for mozprofile 16:34:33 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 16:34:33 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 16:34:33 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 16:34:33 INFO - Running setup.py install for mozrunner 16:34:33 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 16:34:33 INFO - Running setup.py install for mozscreenshot 16:34:33 INFO - Running setup.py install for moztest 16:34:33 INFO - Running setup.py install for mozversion 16:34:33 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 16:34:33 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:34:33 INFO - Cleaning up... 16:34:33 INFO - Return code: 0 16:34:33 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:34:33 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:34:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:34:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:33 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:34:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:34:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:33 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 0xe101f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe4da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ae310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab400>, '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 0x10ac3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ac840>, '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': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', '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:34:33 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:34:33 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:34:33 INFO - Using env: {'DISPLAY': ':0', 16:34:33 INFO - 'HOME': '/home/cltbld', 16:34:33 INFO - 'LANG': 'en_US.UTF-8', 16:34:33 INFO - 'LANGUAGE': 'en_US:en', 16:34:33 INFO - 'LOGNAME': 'cltbld', 16:34:33 INFO - 'MAIL': '/var/mail/cltbld', 16:34:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:34:33 INFO - 'MOZ_NO_REMOTE': '1', 16:34:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:34:33 INFO - 'NO_EM_RESTART': '1', 16:34:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:34:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:34:33 INFO - 'PWD': '/builds/slave/test', 16:34:33 INFO - 'SHELL': '/bin/bash', 16:34:33 INFO - 'SHLVL': '1', 16:34:33 INFO - 'TERM': 'linux', 16:34:33 INFO - 'TMOUT': '86400', 16:34:33 INFO - 'USER': 'cltbld', 16:34:33 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', 16:34:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:34:33 INFO - '_': '/tools/buildbot/bin/python'} 16:34:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:34:34 INFO - Running setup.py (path:/tmp/pip-nyrKaR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:34:34 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:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:34:34 INFO - Running setup.py (path:/tmp/pip-52A0oo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:34:34 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:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:34:34 INFO - Running setup.py (path:/tmp/pip-_V9_nv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:34:34 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:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:34:34 INFO - Running setup.py (path:/tmp/pip-M2ZiYK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:34:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.50 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:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:34:34 INFO - Running setup.py (path:/tmp/pip-PF9o9x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:34:34 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:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:34:34 INFO - Running setup.py (path:/tmp/pip-zUoGpQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:34:34 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:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:34:34 INFO - Running setup.py (path:/tmp/pip-3W_sWS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:34:34 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:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:34:34 INFO - Running setup.py (path:/tmp/pip-m0eCPa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:34:34 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:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:34:34 INFO - Running setup.py (path:/tmp/pip-M5FmAr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:34:34 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:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:34:34 INFO - Running setup.py (path:/tmp/pip-30eqcS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:34:34 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:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:34:34 INFO - Running setup.py (path:/tmp/pip-nD8jOj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:34:34 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:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:34:35 INFO - Running setup.py (path:/tmp/pip-yhxgJE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:34:35 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:34:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:34:35 INFO - Running setup.py (path:/tmp/pip-2GGPTc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:34:35 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:34:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:34:35 INFO - Running setup.py (path:/tmp/pip-ihS9SB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:34:35 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:34:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:34:35 INFO - Running setup.py (path:/tmp/pip-tlui8D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:34:35 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:34:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:34:35 INFO - Running setup.py (path:/tmp/pip-nxzfZA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:34:35 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:34:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:34:35 INFO - Running setup.py (path:/tmp/pip-eodqHY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:34:35 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:34:35 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:34:35 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:34:35 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:34:35 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:34:35 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:34:35 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:34:35 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:34:35 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:34:35 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:34:35 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:34:35 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:34:35 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:34:37 INFO - Downloading blessings-1.6.tar.gz 16:34:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 16:34:37 INFO - Installing collected packages: blessings 16:34:37 INFO - Running setup.py install for blessings 16:34:37 INFO - Successfully installed blessings 16:34:37 INFO - Cleaning up... 16:34:37 INFO - Return code: 0 16:34:37 INFO - Done creating virtualenv /builds/slave/test/build/venv. 16:34:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:34:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:34:37 INFO - Reading from file tmpfile_stdout 16:34:37 INFO - Current package versions: 16:34:37 INFO - argparse == 1.2.1 16:34:37 INFO - blessings == 1.6 16:34:37 INFO - blobuploader == 1.2.4 16:34:37 INFO - docopt == 0.6.1 16:34:37 INFO - functools32 == 3.2.3-2 16:34:37 INFO - jsonschema == 2.5.1 16:34:37 INFO - manifestparser == 1.1 16:34:37 INFO - mozInstall == 1.12 16:34:37 INFO - mozcrash == 1.0 16:34:37 INFO - mozdebug == 0.1 16:34:37 INFO - mozdevice == 0.50 16:34:37 INFO - mozfile == 1.2 16:34:37 INFO - mozhttpd == 0.7 16:34:37 INFO - mozinfo == 0.9 16:34:37 INFO - mozleak == 0.1 16:34:37 INFO - mozlog == 3.4 16:34:37 INFO - moznetwork == 0.27 16:34:37 INFO - mozprocess == 0.25 16:34:37 INFO - mozprofile == 0.28 16:34:37 INFO - mozrunner == 6.13 16:34:37 INFO - mozscreenshot == 0.1 16:34:37 INFO - mozsystemmonitor == 0.3 16:34:37 INFO - moztest == 0.8 16:34:37 INFO - mozversion == 1.4 16:34:37 INFO - psutil == 3.1.1 16:34:37 INFO - requests == 1.2.3 16:34:37 INFO - wsgiref == 0.1.2 16:34:37 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:34:37 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:34:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:34:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:37 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:34:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:34:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:37 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 0xe101f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe4da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ae310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab400>, '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 0x10ac3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ac840>, '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': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', '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:34:37 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:34:37 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:34:37 INFO - Using env: {'DISPLAY': ':0', 16:34:37 INFO - 'HOME': '/home/cltbld', 16:34:37 INFO - 'LANG': 'en_US.UTF-8', 16:34:37 INFO - 'LANGUAGE': 'en_US:en', 16:34:37 INFO - 'LOGNAME': 'cltbld', 16:34:37 INFO - 'MAIL': '/var/mail/cltbld', 16:34:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:34:37 INFO - 'MOZ_NO_REMOTE': '1', 16:34:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:34:37 INFO - 'NO_EM_RESTART': '1', 16:34:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:34:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:34:37 INFO - 'PWD': '/builds/slave/test', 16:34:37 INFO - 'SHELL': '/bin/bash', 16:34:37 INFO - 'SHLVL': '1', 16:34:37 INFO - 'TERM': 'linux', 16:34:37 INFO - 'TMOUT': '86400', 16:34:37 INFO - 'USER': 'cltbld', 16:34:37 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', 16:34:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:34:37 INFO - '_': '/tools/buildbot/bin/python'} 16:34:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:34:38 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:34:38 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:34:38 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:34:38 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:34:38 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:34:38 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:34:38 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:34:38 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:34:38 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:34:38 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:34:38 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:34:38 INFO - Cleaning up... 16:34:38 INFO - Return code: 0 16:34:38 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 16:34:38 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:34:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:34:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:38 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:34:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:34:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:34:38 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 0xe101f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe4da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ae310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab400>, '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 0x10ac3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ac840>, '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': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', '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:34:38 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:34:38 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:34:38 INFO - Using env: {'DISPLAY': ':0', 16:34:38 INFO - 'HOME': '/home/cltbld', 16:34:38 INFO - 'LANG': 'en_US.UTF-8', 16:34:38 INFO - 'LANGUAGE': 'en_US:en', 16:34:38 INFO - 'LOGNAME': 'cltbld', 16:34:38 INFO - 'MAIL': '/var/mail/cltbld', 16:34:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:34:38 INFO - 'MOZ_NO_REMOTE': '1', 16:34:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:34:38 INFO - 'NO_EM_RESTART': '1', 16:34:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:34:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:34:38 INFO - 'PWD': '/builds/slave/test', 16:34:38 INFO - 'SHELL': '/bin/bash', 16:34:38 INFO - 'SHLVL': '1', 16:34:38 INFO - 'TERM': 'linux', 16:34:38 INFO - 'TMOUT': '86400', 16:34:38 INFO - 'USER': 'cltbld', 16:34:38 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', 16:34:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:34:38 INFO - '_': '/tools/buildbot/bin/python'} 16:34:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:34:38 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 16:34:38 INFO - Cleaning up... 16:34:38 INFO - Return code: 0 16:34:38 INFO - Running post-action listener: _resource_record_post_action 16:34:38 INFO - Running post-action listener: _start_resource_monitoring 16:34:38 INFO - Starting resource monitoring. 16:34:38 INFO - [mozharness: 2017-04-28 23:34:38.408001Z] Finished create-virtualenv step (success) 16:34:38 INFO - [mozharness: 2017-04-28 23:34:38.408469Z] Running install step. 16:34:38 INFO - Running pre-action listener: _resource_record_pre_action 16:34:38 INFO - Running main action method: install 16:34:38 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:34:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:34:38 INFO - Reading from file tmpfile_stdout 16:34:38 INFO - Detecting whether we're running mozinstall >=1.0... 16:34:38 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 16:34:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 16:34:38 INFO - Reading from file tmpfile_stdout 16:34:38 INFO - Output received: 16:34:38 INFO - Usage: mozinstall [options] installer 16:34:38 INFO - Options: 16:34:38 INFO - -h, --help show this help message and exit 16:34:38 INFO - -d DEST, --destination=DEST 16:34:38 INFO - Directory to install application into. [default: 16:34:38 INFO - "/builds/slave/test"] 16:34:38 INFO - --app=APP Application being installed. [default: firefox] 16:34:38 INFO - mkdir: /builds/slave/test/build/application 16:34:38 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:34:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 16:34:54 INFO - Reading from file tmpfile_stdout 16:34:54 INFO - Output received: 16:34:54 INFO - /builds/slave/test/build/application/firefox/firefox 16:34:54 INFO - Running post-action listener: _resource_record_post_action 16:34:54 INFO - [mozharness: 2017-04-28 23:34:54.928859Z] Finished install step (success) 16:34:54 INFO - [mozharness: 2017-04-28 23:34:54.929135Z] Running run-tests step. 16:34:54 INFO - Running pre-action listener: _resource_record_pre_action 16:34:54 INFO - Running main action method: run_tests 16:34:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 16:34:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 16:34:54 INFO - Python 2.7.3 16:34:54 INFO - Return code: 0 16:34:54 INFO - grabbing minidump binary from tooltool 16:34:54 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:34:54 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 0x10ab400>, '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 0x10ac3b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ac840>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 16:34:54 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:34:54 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:34:54 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:34:54 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:34:55 INFO - Return code: 0 16:34:55 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 16:34:55 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 16:34:55 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 16:34:55 INFO - ENV: RUST_BACKTRACE is now 1 16:34:55 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 16:34:55 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 16:34:55 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/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-027', '--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:34:55 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/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-027 --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:34:55 INFO - Using env: {'DISPLAY': ':0', 16:34:55 INFO - 'HOME': '/home/cltbld', 16:34:55 INFO - 'LANG': 'en_US.UTF-8', 16:34:55 INFO - 'LANGUAGE': 'en_US:en', 16:34:55 INFO - 'LOGNAME': 'cltbld', 16:34:55 INFO - 'MAIL': '/var/mail/cltbld', 16:34:55 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:34:55 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 16:34:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:34:55 INFO - 'MOZ_NO_REMOTE': '1', 16:34:55 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:34:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:34:55 INFO - 'NO_EM_RESTART': '1', 16:34:55 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:34:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:34:55 INFO - 'PWD': '/builds/slave/test', 16:34:55 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:34:55 INFO - 'RUST_BACKTRACE': '1', 16:34:55 INFO - 'SHELL': '/bin/bash', 16:34:55 INFO - 'SHLVL': '1', 16:34:55 INFO - 'TERM': 'linux', 16:34:55 INFO - 'TMOUT': '86400', 16:34:55 INFO - 'USER': 'cltbld', 16:34:55 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031', 16:34:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:34:55 INFO - '_': '/tools/buildbot/bin/python'} 16:34:55 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/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-027', '--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:34:55 INFO - mozversion application_buildid: 20170428224651 16:34:55 INFO - mozversion application_changeset: 1c994cd72265c48bbdc9f6404df87c4eae488b34 16:34:55 INFO - mozversion application_display_name: Nightly 16:34:55 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:34:55 INFO - mozversion application_name: Firefox 16:34:55 INFO - mozversion application_remotingname: firefox 16:34:55 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 16:34:55 INFO - mozversion application_vendor: Mozilla 16:34:55 INFO - mozversion application_version: 55.0a1 16:34:55 INFO - mozversion platform_buildid: 20170428224651 16:34:55 INFO - mozversion platform_changeset: 1c994cd72265c48bbdc9f6404df87c4eae488b34 16:34:55 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 16:34:55 INFO - mozversion platform_version: 55.0a1 16:34:55 INFO - using testdate: 1493422495 16:34:55 INFO - actual date: 1493422495 16:34:55 INFO - starting webserver on 'localhost:41917' 16:34:55 INFO - SUITE-START | Running 2 tests 16:34:55 INFO - TEST-START | dromaeo_css 16:34:55 INFO - operating with platform_type : linux_ 16:34:55 INFO - Initialising browser for dromaeo_css test... 16:34:55 INFO - TEST-INFO | started process 15157 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpj75XK3/profile http://localhost:41917/getInfo.html) 16:34:58 INFO - PID 15157 | __metrics Screen width/height:1600/1200 16:34:58 INFO - PID 15157 | colorDepth:24 16:34:58 INFO - PID 15157 | Browser inner width/height: 1024/697 16:34:58 INFO - PID 15157 | __metrics 16:35:00 INFO - PID 15157 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 673: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 16:35:00 INFO - PID 15157 | JavaScript error: resource:///modules/BrowserUsageTelemetry.jsm, line 334: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:35:01 INFO - TEST-INFO | 15157: exit 0 16:35:01 INFO - Browser initialized. 16:35:01 INFO - Running cycle 1/1 for dromaeo_css test... 16:35:01 INFO - TEST-INFO | started process 15256 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpj75XK3/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:35:12 INFO - PID 15256 | RSS: Main: 151457792 16:35:12 INFO - PID 15256 | 16:38:15 INFO - PID 15256 | Cycle 1(1): loaded http://localhost:41917/tests/dromaeo/cssquery-dojo.html (next: http://localhost:41917/tests/dromaeo/cssquery-ext.html) 16:38:16 INFO - PID 15256 | RSS: Main: 280584192 16:38:16 INFO - PID 15256 | 16:40:03 INFO - PID 15256 | ************************* 16:40:03 INFO - PID 15256 | A coding exception was thrown and uncaught in a Task. 16:40:03 INFO - PID 15256 | 16:40:03 ERROR - PID 15256 | Full message: TypeError: NetworkError when attempting to fetch resource. 16:40:03 INFO - PID 15256 | Full stack: 16:40:03 INFO - PID 15256 | ************************* 16:40:03 INFO - PID 15256 | ************************* 16:40:03 INFO - PID 15256 | A coding exception was thrown and uncaught in a Task. 16:40:03 INFO - PID 15256 | 16:40:03 ERROR - PID 15256 | Full message: TypeError: NetworkError when attempting to fetch resource. 16:40:03 INFO - PID 15256 | Full stack: 16:40:03 INFO - PID 15256 | ************************* 16:40:03 INFO - PID 15256 | ************************* 16:40:03 INFO - PID 15256 | A coding exception was thrown and uncaught in a Task. 16:40:03 INFO - PID 15256 | 16:40:03 ERROR - PID 15256 | Full message: TypeError: NetworkError when attempting to fetch resource. 16:40:03 INFO - PID 15256 | Full stack: 16:40:03 INFO - PID 15256 | ************************* 16:40:03 INFO - PID 15256 | ************************* 16:40:03 INFO - PID 15256 | A coding exception was thrown and uncaught in a Task. 16:40:03 INFO - PID 15256 | 16:40:03 ERROR - PID 15256 | Full message: TypeError: NetworkError when attempting to fetch resource. 16:40:03 INFO - PID 15256 | Full stack: 16:40:03 INFO - PID 15256 | ************************* 16:41:18 INFO - PID 15256 | Cycle 1(1): loaded http://localhost:41917/tests/dromaeo/cssquery-ext.html (next: http://localhost:41917/tests/dromaeo/cssquery-jquery.html) 16:41:19 INFO - PID 15256 | RSS: Main: 223834112 16:41:19 INFO - PID 15256 | 16:44:21 INFO - PID 15256 | Cycle 1(1): loaded http://localhost:41917/tests/dromaeo/cssquery-jquery.html (next: http://localhost:41917/tests/dromaeo/cssquery-mootools.html) 16:44:21 INFO - PID 15256 | RSS: Main: 215711744 16:44:21 INFO - PID 15256 | 16:47:23 INFO - PID 15256 | Cycle 1(1): loaded http://localhost:41917/tests/dromaeo/cssquery-mootools.html (next: http://localhost:41917/tests/dromaeo/cssquery-prototype.html) 16:47:24 INFO - PID 15256 | RSS: Main: 174583808 16:47:24 INFO - PID 15256 | 16:50:27 INFO - PID 15256 | Cycle 1(1): loaded http://localhost:41917/tests/dromaeo/cssquery-prototype.html (next: http://localhost:41917/tests/dromaeo/cssquery-yui.html) 16:50:27 INFO - PID 15256 | RSS: Main: 181850112 16:50:27 INFO - PID 15256 | 16:53:29 INFO - PID 15256 | Cycle 1(1): loaded http://localhost:41917/tests/dromaeo/cssquery-yui.html (next: http://localhost:41917/tests/dromaeo/cssquery-dojo.html) 16:53:29 INFO - PID 15256 | RSS: Main: 266698752 16:53:29 INFO - PID 15256 | 16:53:29 INFO - PID 15256 | __start_tp_report 16:53:29 INFO - PID 15256 | _x_x_mozilla_page_load 16:53:29 INFO - PID 15256 | _x_x_mozilla_page_load_details 16:53:29 INFO - PID 15256 | |i|pagename|runs| 16:53:29 INFO - PID 15256 | |0;dojo.html;3258.9185270368225;3270.0189943017094;3291.9506207406894;3317.7843440176403;3326.301476689895;5675.063614503602;5772.538196944245;5801.419858014191;5811.418858114186;5827.300723913126;5771.567132465061;5791.305043394788;5815.680137592431;5816.098504731774;5893.263342082239;5027.673201241926;5068.645194836354;5082.466341034194;5082.695038297696;5131.769070391822;5173.534381905628;5201.531862132408;5224.268602395668;5226.3989641191365;5249.42256351801;5178.974105129488;5223.059849227137;5228.581713462914;5235.214717792323;5240.3187585614005;5091.974540127313;5135.871603209912;5145.691258524463;5191.32512773337;5226.372835259755;5131.538161565477;5137.460566640524;5137.614678899097;5138.74306284688;5211.2443695663915;5716.1997320375185;5762.982955965421;5778.248827652378;5791.536677065825;5839.883202335929;6109.847253818646;6129.358790882775;6139.093519790236;6148.292946311142;6274.372562743689;6318.494520438354;6331;6335.904961425582;6336.936630633681;6355.618662880196;5846.8538286542325;5863.76544938202;5884.235049443588;5891.96890544153;5937.495312898409;6124.2693482561845;6281.466075383552;6335.524835637346;6341.841453963688;6349.777757778455;5966.910496342558;6004.189434426384;6034.064719968412;6047.334793172748;6048.637081775019;6138.357744607992;6147.293061297919;6147.477464415485;6181.443670069625;6237;6095.268567771807;6158.938410615926;6167.105769663373;6175.980963141032;6176.6911654418;6155.169052177898;6158.291796443376;6163.260408750889;6165.290991535941;6175.413335733098;4724.078804633133;4739.3838800955655;4742.217534106902;4756.048790241965;4801.01579176268;4235.788210589458;4240.809163587646;4252.681048921343;4273.572642735701;4275;5886.646801191942;5895.764169433174;5898.4101589840675;5906.5570082244;5907.8227653169615;6106.764041036324;6171.6297022178815;6236.158118654014;6289.40250676185;6314.936850631527;5908.143319218775;5908.822735317947;5911.9113213301835;5927.673977931169;5965.492933100735;5418.214358917935;5480.479354461319;5489.451054894478;5498.477644623755;5502.119660854244;6299.811005669837;6381.8723625528155;6422.486201103994;6441.677916104176;6531.346865313526;6289.08808222796;6324.272708638566;6327.525435592257;6329.588576742497;6332.2717887441695;6470.28826829039;6502.349765023649;6505.414512693691;6518.837029074311;6523.3150519194805;6069.0592958091565;6098.76506457472;6122.479589234965;6178.165947597017;6190.907136393048;6102.489251635809;6135.661410523283;6177.62934223948;6188.81433556994;6215.471684906834;6096.405739310827;6101.413632455682;6121.3572574879;6128.472568454306;6130.570860039755;5984.31180414258;6003.5797494174985;6069.848253793691;6104.4505994460715;6113.449789518964;6052.75788968454;6094.5014626406155;6109.404666050415;6113.506711826804;6144.969275153596;6036.486898613492;6090.817275481565;6096.451319381277;6105.267367915879;6124.969375153096;5869.266341707286;5926.733297001731;5928.49607783326;5930.614510056833;5933.851653708692 16:53:29 INFO - PID 15256 | |1;ext.html;713.1620346093342;757.3297631596037;783.1776634533738;1134.9432528373575;1163.7963356412627;29095.272618184557;29644.851775741117;35649.643503564956;36428;36539.451908221396;39301.21397572047;39684.801575992155;39707.801460992654;39713.40429893554;39747.602523974754;5666.575006874501;7206.279372062778;7361.889571656429;7362.484626076177;7371.152317483477;5735.913961290584;7086.503944723871;7264.782056538313;7265.455090868206;7268.527545709512;7307.451941104412;7357.852842943138;7358.300961408658;7358.816029599249;7359.3744531714865;5673.6879471629045;7277.3814225790875;7323.7070517179245;7331.596762178078;7337.00950371701;5731.914021289684;7013.26360732126;7250.274972502761;7252.3110304521515;7255.09311336083;35866;36067.63932360669;36145.81927090374;36219;36222.8188859054;3565.8217089145696;3604.4593311003296;3611.2416392557593;3615;3619.348517266891;28903;29110;29196.124116276547;29228;29252.41495170106;3776.754510956779;3824.29250588642;3825.48355971943;3840.961590384088;3870.806459677005;185950;185974.99999999866;185990;186673;186689;49001;49028.26457603139;49189.508104918496;49210;49211.50788492141;51011.74494127506;51032.74483627558;51067.7446612772;51086.74456627767;51119.7444012785;15441.382344706311;15516.68966620684;15517.5344739658;15520.689586208438;15532.378704851906;11002.559897604166;11210.831837522444;12710.555130570385;12713.809292860615;12718;14875.181864997528;15270.618234544225;15286.541403757905;15307;15431.61420964485;5976.322493631068;6029.8191054268445;6040.667763272974;6166.766646670684;6170.938290617126;1049.7952899184586;1063.7978784031009;1078.978420431587;1086.7935092332589;1088.482970588964;26675.862616479597;26962;26996.1901142966;27175.45649087007;27197.456050879267;1182.5624518928053;1183.5502509046507;1189.6728399689982;1194.4863708605383;1195.1156144453041;13323.66690832737;13680.863191367958;13758.17450952926;13945;13949;229088;229948;230569;230865;231361;53656.195157072674;54089;54110.45889541133;54142.45857541453;54210.72894635502;1449.0943160524673;1497.7378958682186;1522.5127959053218;1522.7335216337096;1526.63360793411;23985.760142398354;25027.374315642253;25167;25259.115930942327;25375.746242537338;37479.62520374871;37615;37702.62297376991;37709.622903770614;37746.245075098894;209675;210065;210608;211019;211498;28943.710562894103;29542.704572953997;34200;34437.65562344345;35534.822325888206;42856;43842.56157438385;45974.77012614915;46191.76904115592;46555;35029;35079.64920350764;35199.12002199863;35758.28483430265;36457.81771091127;35371.29257414786;35856.820715896254;35897.820510897276;36366;37355.626443735215;40131.39802903017;42177.36733948932;42180.36729449122;42292.36561451642;42643;35049.64950350566;35154.82422587871;35305.47041794426;35436.46845297271;36267.81866090652;26739.86630066915;28375.43249135047;28518;28681.713182867905;28797.424051519272 16:53:29 INFO - PID 15256 | |2;jquery.html;435.59489674602605;453.7050916904012;458.9862304130877;462.722366580052;466.7782803168495;20170.59658806825;21273.68089478659;21651.891740541294;22335.888320558413;22492.325230243117;22115.225967091155;22349.44126396841;22613.660795088086;22810;22985.885070574623;4498.685092043558;5519.144532597444;5677.460641239097;5689.6017278790505;5705.885882282352;5576.745232322735;5710.743016564244;5720.256366672327;5723.084306510959;5726.3414707308775;5441.156620723794;5519.503244707976;5636.577256705743;5684.005299072666;5694.829155125353;5570.832875013736;5613.045782217033;5623.353314368859;5623.8594035149035;5627.099664053731;5019.974900125512;5051.621128415383;5126.461721519224;5168.405633352175;5178.223266510016;25125.62311565328;25412;25421.745782542122;25479;26357.73642263572;2095.130520833852;2157.892105394724;2159.5356998245297;2160.4274867160216;2160.5786871560053;16904.23930923099;16943.322267109303;17344.739828902577;17378.826211737847;17480.300787968594;2155.698202251686;2179.683945827862;2227.922022729213;2233.6649502574583;2234.1510226114137;92760.53619731926;101961;110431.44784276027;111892.4405377976;112383;12466.252024878537;12560.246385216917;12906.548270810477;13228.669283267995;21298.893505532375;18182.636257286467;18189.7271540927;18204.180811863498;18207;18280.45158645243;9239.72280831576;9296.814063718688;9634.084761947604;9718.319717619699;9723;8397.412181147261;8619.870701939475;8695.304375649934;8778.561071946377;9241.861372079424;7965.641546130438;8021.879671804928;8120.228578285053;8290.295324897452;8351.742820300087;2218.3234113595186;2236.2843889955384;2261.197274967363;2266.3427605994075;2417.5648383291177;1006.3609607898891;1051.8211903976342;1061.4745700878116;1061.5276202089997;1062.4687656171914;19105.617887642446;21126.78873211279;21396.78603213979;21401.892990534947;21449.11614900623;1054.5781687324977;1070.272214893864;1085.3813326403874;1085.8316960871077;1095.8356246562919;10949.452527373758;11663.591774288028;11680.649580512598;11750.70623234409;11781.646550603497;451353;456928;456988;459201;482579;86164.13835861687;90415;96430;98351;98499;1155.2756093556409;1201.8617858946159;1230.2434003088035;1242.8881400673984;1244.7074937389887;20244.08901599402;20644.17423303111;20774.58450831005;21094.261700840398;21194.470138246666;45878.54121458876;46744.83137921579;46798.766006171114;47506.76246618745;47590.76204618955;59348;59566;60151.39848601633;60653.0902036461;60797.39202608094;9523.333366664267;9740.269479789185;9866.358686685342;9916.107550320507;9934.602615895283;14750.63123421923;15186.544403667907;15250.313735882133;15319.540413787605;15842.12868292255;13026.153300035467;13277.070605057554;13410.597682069554;13468.393922273326;13686.178829269877;11957.222780519238;11968.401579921143;12551.623451296477;12569.994400448126;12917.28954907489;12919.935400322938;12931.418086186331;13260.80108798388;13590.796138058135;13627.79558306646;9361.110694484014;9523.666671666459;9538.761530961781;9643.662471813454;9840.212782977202;12349.32078735678;12403.689907752378;12573.74852502963;12765.297908615115;13349.799753003907 16:53:29 INFO - PID 15256 | |3;mootools.html;1332.6601716562277;1394.7628903086475;1413.5829930170596;1419.7657386531223;1420.6448387903024;10432;10841.728956776085;10853.674389768299;10854.185936054788;10861.728456788584;10643;11184.888151118486;11497.827532586996;11578.826317605222;11598.826017609743;2291.553147136305;2326.4532834783813;2326.7905888470036;2329.965050524235;2330.067972810872;1966.3412756726443;2249.2465024216826;2316.1546035696933;2318.455163036685;2319.7564255753155;1956.911938962743;2221.3891179925567;2311.7341505726804;2316.559853627814;2318.0959425823944;2210.10490751246;2217.8780167090804;2233.3188377544843;2238.0935721032924;2238.4963383238724;2236.5303286309895;2237.3735354100877;2241.2827895073583;2244.2706120510898;2245.0682966568857;11116.888831111666;11241.775164496747;11274.718132046683;11299.378534180616;11315.377654229096;6039.849003774897;6056.4851987581105;6250.124982502453;6266.624002559861;6273;3547.9822600887087;3777.112378591029;3898.727089103764;3919.862804801818;3919.9020024499614;1279.8656141105237;1304.8042793580944;1335.0654541820668;1386.8682475164844;1393.2197969137214;17343.739843902353;17527.123643817886;17531.649367012717;17553.56116097108;17563.73654395185;4921.188003979303;5071.46749591295;5144.408393034774;5219.947800522022;5270.393904700932;11847.407629618485;11857.525698972117;11905.880941190477;11910;11914.46384912681;6222.253329600477;6342.175517182829;6342.682865856688;6348.492120630339;6349.238091428966;5829.47534721877;5950.8809823803285;5981.611195272293;5990.700464976734;6001.279846418371;4097.784205156681;4151.086760912594;4159.604837540429;4199.950012496875;4242.151569686013;1039.8804137524282;1138.1179585821055;1147.0766033343239;1151.9712007199719;1157.890000449956;790.6165509727778;858.411987788367;887.4630848336664;895.9641614335484;905.4160066757037;6528.151340325728;6603.570767900071;6643.10318107059;6679.0315404267085;6816.965915170393;967.3180407812475;971.820213260549;974.7563109222694;981.7741919358588;988.6391467114595;4114.136031433372;4218.704690671623;4243.108947121139;4340.913181736348;4344.804483798237;15254.161021143722;15421.228938553251;15574.143422111893;15703;15720.92139539295;14581;15428.15145167004;15453.768193477106;15455.84544154544;15458;9168.633254669872;9401.341906066646;9403.341766076446;9406.858897116548;9412.058794120534;7199.3520583147765;7356.77929662111;7420.925790742023;7517.285857843496;7556.093268807778;13525.59423217305;13739.313034348443;13890.166590004632;13927.721445570829;14109.576712698636;13763.862361376257;13973.790393143907;14005.929970350491;14177.432902683777;14217.360218789972;9302.581383837609;9519.428834269966;9696.95151524238;9704.660336888175;9770.218382529523;11189.776204475702;11240.718982025515;11387.373694446886;11387.886121138683;11400.315981041163;9044.321675874204;9411.576479058322;9486.95256523713;9488.715338539854;9508.85736713936;8947;8974.641014359353;9081.137291957253;9165.220956218529;9195;8081.797955051171;8146.511209327459;8197.754067377988;8211.343092552463;8212.753617391249;6301.212348456443;6365.586236894587;6394.6482943436695;6395.264544577433;6616.470682345304;6284.4344009039405;6321.336259692666;6444.130042444398;6466.773662921775;6600.669966501559 16:53:29 INFO - PID 15256 | |4;prototype.html;389.32646521517773;392.0805710608624;393.3568615313962;393.74013151320133;397.7514053716427;5664.943350566493;5696.287964004499;5701.116326969316;5708.286464191976;5709.514691251238;5462.972685136579;5564.165375193713;5622.8313150605545;5633.014222511065;5660.632058916168;4387.824487020515;4397.076613911083;4409.889752756175;4429.512753597118;4431.1580799648045;4417.580329868657;4419.955800441987;4422.933655995163;4429.712068715539;4430.379746835446;4079.3676980068135;4232.5767423257585;4234.364845273203;4246.490421149467;4385.215388228466;4205;4229.133027729324;4230.132822771356;4238.97880510597;4241.7879106044575;3648.616895226016;3677.9080522986874;3683.355412802749;3701.592824789298;3703;5352.330958630171;5446.863828404282;5522.834314970557;5541.390447050821;5548.250986116863;4970.254461830718;4977.278294647256;4991.950080499185;4998.150684246815;5015.949840501585;5970.641761494281;6072;6080.452759251689;6086.360932102154;6091.604045737057;4129.504459464853;4137.069159439132;4157.646600039;4158.958410415918;4182.393552934807;6002.96998515009;6168.938310616882;6244.250689917239;6285;6323.146375239376;3836.3094642964534;4082.9387559186634;4096.91806163881;4097.344424892003;4123.299039163349;4162.729422587522;4246.5116511600945;4247.511536173318;4255.5318914919335;4256.893577660583;4916.0905232532095;4930.605551555938;4939.2838038484215;4952.653314267966;4955.851324460272;5774.653520788766;6003.279606447167;6012.879742405127;6038.365971573009;6038.667873266924;1456.0826679192041;1462.276173294205;1462.9926850365894;1473.4179998900374;1480.2228829864407;940.4874343482818;960.577345967772;973.6884197057016;975.3855071305175;985.5663508056432;5813.157092221604;5819.883602328015;5833;5858.209141765892;5860.765569377178;6257.186565746424;6269.96865015672;6280.371962803774;6290.591111577824;6296.968515157395;5724.341700704389;5787.2187254720075;5809.593328467051;5847.152162936351;5864.882702345929;3264.526643636659;3278.5901762279714;3279.9016029519153;3297.2086699192023;3301.108700650811;6327.386516438279;6379.298277189506;6416.294207637156;6443.323451037667;6471.640955399324;6338.763941031455;6384.913655260637;6388.5528013039575;6416.422521973045;6423.96788016057;6203.604189057426;6385.776497822554;6395.584287021329;6411.903821442682;6455.289918109098;6227.283862355705;6241.906371404523;6255.655938923403;6260.843478913063;6268.6552239625435;5989.371116032754;6137.662428566472;6193.163922870355;6200.937990620217;6215.9378406217165;6433.7481881341155;6438.484921206386;6446.709898054505;6459.580127291711;6460.224773027267;4226.89432764171;4229.703920725519;4232.64022558086;4245.448091748053;4246.808893599734;5993.003498250874;6269.18500594938;6270.561060725706;6291.748330066746;6292.653904035322;6016.909746353721;6073.908891366545;6099;6107.236595425572;6119.755209791559;5908.615939963888;5990.520758339235;6050.364711705208;6060.575769692158;6062.696865156637;6011.188489554029;6027.457528822427;6031.879362412639;6032.276126864805;6050.757969681164;5955.344912059583;6088.178095957166;6120.44915957566;6128.698675645624;6133.294671112879;5872.119182122716;5873.9412605873395;5888.851673923544;5918.171455996078;5942.168096466412 16:53:29 INFO - PID 15256 | |5;yui.html;778.1362687416963;872.1801506583811;895.4940458640867;897.3180382908987;910.886139232596;13716.314184290795;17318.82681173188;17698.557536061606;17748.64502709945;17919.552011199725;15714.528564143066;15960.441384551543;15965.84034159658;15973.840261597381;15974.920125399385;997.9471657401439;1019.2763138171907;1036.19694736579;1036.6630844975375;1036.7926414717049;737.2406421385981;752.4281546025034;909.5179554835914;1047.4762618690654;1050.0077426831647;1088.8638920134983;1097.160672085855;1097.4128841070028;1097.6268068856587;1098.1653943003334;1092.431935393591;1093.4860615510697;1094.4637127807396;1095.2005036323449;1096.117625311624;801.3709238247948;803.4737247103157;803.4978138663336;803.6343463723991;804.252045597594;16552.42066527666;16664.41674541385;16753.581160470963;17692.91153544237;17867.106644667714;18879.244830206775;19079.427617171506;19200.61598768017;19205.423837284903;19421.9028904856;13703.314834258248;14104.08323458972;14225.502107426191;14246.715065698732;14319.498817541336;3468.843902024415;3469.826508674556;3489.59869614995;3493.6331685172945;3502.317048175607;83861.58069209676;84744.57627711883;85915.14084859134;86504.56747716284;87259.12740872637;14624.634384140481;14789.704205915821;14804.407823687146;14870.479533216285;14901.776473352907;26514;26712.19863404101;27065.86467067652;27450.176494705192;27681.169564913085;8249.505029698237;8250.422470427133;8288.958555207306;8334.291585215204;8341.958290208631;3919.3729003359326;4085.101277718897;4110.547839737626;4132.772697501606;4200.4539409876525;4516.277395616751;4548.56788605082;4622.630189584893;4626.7223966562115;4628;887.2166944441718;894.0433735902521;899.6086702284528;900.6037343568939;902.2105657549644;720.9387202087777;729.1104852080454;740.481662836017;750.6509473095037;753.4913933095139;10607.363558186533;11736.765264694659;11811.645650630495;11868.109891758153;11953.46209420578;694.8471336306004;698.4307789151825;721.0842230367404;727.2763600217711;732.1287667675449;5151.896962060738;5297.073012222845;5346.251524786533;5409.188621706697;5584.972075139598;72898;74029.62985185039;74800.62599686967;76059.61970190113;77650;66543.66728166328;66941.66529167323;67995;68119.65940170268;68425;52963.94072118536;57456.42543574594;57666;58258.417415826145;59042.40957590455;10721.142308615448;11235.831462528233;11311.7737645245;11351.829722554003;11414.143939204427;33295;33516.329673406886;34197.82901085479;34598;34964;40520.3921941177;40726.1854762909;41599;42025.78987105045;42715.57284427116;14588.635284117981;14683.339249734001;14810.259487025822;14942.103473791607;14992.775108373165;15099.471518496799;15321.540353789404;15472.381104755683;15479.380824766884;15770.211489425712;14565.708685826436;14624.85375146235;14793.482228121964;14849.480268190562;14968.251587420367;14383.928080359532;14440.711185776436;14473.92763036178;14761.630959226106;17505;16383.836161638232;16511.83488165103;16756.664866702842;16757.664846702755;17138.571535711708;11084.61203857861;11223.4388280584;11536.365499897585;11984.340861252365;12163.331016794162;12629.305388203737;13235.66910827237;13249.933750331187;13280.468781248643;13408.396622152222 16:53:29 INFO - PID 15256 | __end_tp_report 16:53:29 INFO - PID 15256 | __start_cc_report 16:53:29 INFO - PID 15256 | _x_x_mozilla_cycle_collect,1320 16:53:29 INFO - PID 15256 | __end_cc_report 16:53:29 INFO - PID 15256 | __startTimestamp1493423609742__endTimestamp 16:53:29 INFO - PID 15256 | 16:53:29 INFO - PID 15256 | ------- Summary: start ------- 16:53:29 INFO - PID 15256 | Number of tests: 6 16:53:29 INFO - PID 15256 | 16:53:29 INFO - PID 15256 | [#0] dojo.html Cycles:165 Average:5758.12 Median:6003.58 stddev:675.08 (11.2%) stddev-sans-first:648.05 16:53:29 INFO - PID 15256 | Values: 3258.9 3270.0 3292.0 3317.8 3326.3 5675.1 5772.5 5801.4 5811.4 5827.3 5771.6 5791.3 5815.7 5816.1 5893.3 5027.7 5068.6 5082.5 5082.7 5131.8 5173.5 5201.5 5224.3 5226.4 5249.4 5179.0 5223.1 5228.6 5235.2 5240.3 5092.0 5135.9 5145.7 5191.3 5226.4 5131.5 5137.5 5137.6 5138.7 5211.2 5716.2 5763.0 5778.2 5791.5 5839.9 6109.8 6129.4 6139.1 6148.3 6274.4 6318.5 6331.0 6335.9 6336.9 6355.6 5846.9 5863.8 5884.2 5892.0 5937.5 6124.3 6281.5 6335.5 6341.8 6349.8 5966.9 6004.2 6034.1 6047.3 6048.6 6138.4 6147.3 6147.5 6181.4 6237.0 6095.3 6158.9 6167.1 6176.0 6176.7 6155.2 6158.3 6163.3 6165.3 6175.4 4724.1 4739.4 4742.2 4756.0 4801.0 4235.8 4240.8 4252.7 4273.6 4275.0 5886.6 5895.8 5898.4 5906.6 5907.8 6106.8 6171.6 6236.2 6289.4 6314.9 5908.1 5908.8 5911.9 5927.7 5965.5 5418.2 5480.5 5489.5 5498.5 5502.1 6299.8 6381.9 6422.5 6441.7 6531.3 6289.1 6324.3 6327.5 6329.6 6332.3 6470.3 6502.3 6505.4 6518.8 6523.3 6069.1 6098.8 6122.5 6178.2 6190.9 6102.5 6135.7 6177.6 6188.8 6215.5 6096.4 6101.4 6121.4 6128.5 6130.6 5984.3 6003.6 6069.8 6104.5 6113.4 6052.8 6094.5 6109.4 6113.5 6145.0 6036.5 6090.8 6096.5 6105.3 6125.0 5869.3 5926.7 5928.5 5930.6 5933.9 16:53:29 INFO - PID 15256 | 16:53:29 INFO - PID 15256 | [#1] ext.html Cycles:180 Average:38169.74 Median:35861.41 stddev:54368.97 (151.6%) stddev-sans-first:54448.75 16:53:29 INFO - PID 15256 | Values: 713.2 757.3 783.2 1134.9 1163.8 29095.3 29644.9 35649.6 36428.0 36539.5 39301.2 39684.8 39707.8 39713.4 39747.6 5666.6 7206.3 7361.9 7362.5 7371.2 5735.9 7086.5 7264.8 7265.5 7268.5 7307.5 7357.9 7358.3 7358.8 7359.4 5673.7 7277.4 7323.7 7331.6 7337.0 5731.9 7013.3 7250.3 7252.3 7255.1 35866.0 36067.6 36145.8 36219.0 36222.8 3565.8 3604.5 3611.2 3615.0 3619.3 28903.0 29110.0 29196.1 29228.0 29252.4 3776.8 3824.3 3825.5 3841.0 3870.8 185950.0 185975.0 185990.0 186673.0 186689.0 49001.0 49028.3 49189.5 49210.0 49211.5 51011.7 51032.7 51067.7 51086.7 51119.7 15441.4 15516.7 15517.5 15520.7 15532.4 11002.6 11210.8 12710.6 12713.8 12718.0 14875.2 15270.6 15286.5 15307.0 15431.6 5976.3 6029.8 6040.7 6166.8 6170.9 1049.8 1063.8 1079.0 1086.8 1088.5 26675.9 26962.0 26996.2 27175.5 27197.5 1182.6 1183.6 1189.7 1194.5 1195.1 13323.7 13680.9 13758.2 13945.0 13949.0 229088.0 229948.0 230569.0 230865.0 231361.0 53656.2 54089.0 54110.5 54142.5 54210.7 1449.1 1497.7 1522.5 1522.7 1526.6 23985.8 25027.4 25167.0 25259.1 25375.7 37479.6 37615.0 37702.6 37709.6 37746.2 209675.0 210065.0 210608.0 211019.0 211498.0 28943.7 29542.7 34200.0 34437.7 35534.8 42856.0 43842.6 45974.8 46191.8 46555.0 35029.0 35079.6 35199.1 35758.3 36457.8 35371.3 35856.8 35897.8 36366.0 37355.6 40131.4 42177.4 42180.4 42292.4 42643.0 35049.6 35154.8 35305.5 35436.5 36267.8 26739.9 28375.4 28518.0 28681.7 28797.4 16:53:29 INFO - PID 15256 | 16:53:29 INFO - PID 15256 | [#2] jquery.html Cycles:180 Average:30327.88 Median:12292.86 stddev:76738.64 (624.3%) stddev-sans-first:76921.09 16:53:29 INFO - PID 15256 | Values: 435.6 453.7 459.0 462.7 466.8 20170.6 21273.7 21651.9 22335.9 22492.3 22115.2 22349.4 22613.7 22810.0 22985.9 4498.7 5519.1 5677.5 5689.6 5705.9 5576.7 5710.7 5720.3 5723.1 5726.3 5441.2 5519.5 5636.6 5684.0 5694.8 5570.8 5613.0 5623.4 5623.9 5627.1 5020.0 5051.6 5126.5 5168.4 5178.2 25125.6 25412.0 25421.7 25479.0 26357.7 2095.1 2157.9 2159.5 2160.4 2160.6 16904.2 16943.3 17344.7 17378.8 17480.3 2155.7 2179.7 2227.9 2233.7 2234.2 92760.5 101961.0 110431.4 111892.4 112383.0 12466.3 12560.2 12906.5 13228.7 21298.9 18182.6 18189.7 18204.2 18207.0 18280.5 9239.7 9296.8 9634.1 9718.3 9723.0 8397.4 8619.9 8695.3 8778.6 9241.9 7965.6 8021.9 8120.2 8290.3 8351.7 2218.3 2236.3 2261.2 2266.3 2417.6 1006.4 1051.8 1061.5 1061.5 1062.5 19105.6 21126.8 21396.8 21401.9 21449.1 1054.6 1070.3 1085.4 1085.8 1095.8 10949.5 11663.6 11680.6 11750.7 11781.6 451353.0 456928.0 456988.0 459201.0 482579.0 86164.1 90415.0 96430.0 98351.0 98499.0 1155.3 1201.9 1230.2 1242.9 1244.7 20244.1 20644.2 20774.6 21094.3 21194.5 45878.5 46744.8 46798.8 47506.8 47590.8 59348.0 59566.0 60151.4 60653.1 60797.4 9523.3 9740.3 9866.4 9916.1 9934.6 14750.6 15186.5 15250.3 15319.5 15842.1 13026.2 13277.1 13410.6 13468.4 13686.2 11957.2 11968.4 12551.6 12570.0 12917.3 12919.9 12931.4 13260.8 13590.8 13627.8 9361.1 9523.7 9538.8 9643.7 9840.2 12349.3 12403.7 12573.7 12765.3 13349.8 16:53:29 INFO - PID 15256 | 16:53:29 INFO - PID 15256 | [#3] mootools.html Cycles:180 Average:7165.65 Median:3662.55 stddev:4672.31 (127.6%) stddev-sans-first:4664.86 16:53:29 INFO - PID 15256 | Values: 1332.7 1394.8 1413.6 1419.8 1420.6 10432.0 10841.7 10853.7 10854.2 10861.7 10643.0 11184.9 11497.8 11578.8 11598.8 2291.6 2326.5 2326.8 2330.0 2330.1 1966.3 2249.2 2316.2 2318.5 2319.8 1956.9 2221.4 2311.7 2316.6 2318.1 2210.1 2217.9 2233.3 2238.1 2238.5 2236.5 2237.4 2241.3 2244.3 2245.1 11116.9 11241.8 11274.7 11299.4 11315.4 6039.8 6056.5 6250.1 6266.6 6273.0 3548.0 3777.1 3898.7 3919.9 3919.9 1279.9 1304.8 1335.1 1386.9 1393.2 17343.7 17527.1 17531.6 17553.6 17563.7 4921.2 5071.5 5144.4 5219.9 5270.4 11847.4 11857.5 11905.9 11910.0 11914.5 6222.3 6342.2 6342.7 6348.5 6349.2 5829.5 5950.9 5981.6 5990.7 6001.3 4097.8 4151.1 4159.6 4200.0 4242.2 1039.9 1138.1 1147.1 1152.0 1157.9 790.6 858.4 887.5 896.0 905.4 6528.2 6603.6 6643.1 6679.0 6817.0 967.3 971.8 974.8 981.8 988.6 4114.1 4218.7 4243.1 4340.9 4344.8 15254.2 15421.2 15574.1 15703.0 15720.9 14581.0 15428.2 15453.8 15455.8 15458.0 9168.6 9401.3 9403.3 9406.9 9412.1 7199.4 7356.8 7420.9 7517.3 7556.1 13525.6 13739.3 13890.2 13927.7 14109.6 13763.9 13973.8 14005.9 14177.4 14217.4 9302.6 9519.4 9697.0 9704.7 9770.2 11189.8 11240.7 11387.4 11387.9 11400.3 9044.3 9411.6 9487.0 9488.7 9508.9 8947.0 8974.6 9081.1 9165.2 9195.0 8081.8 8146.5 8197.8 8211.3 8212.8 6301.2 6365.6 6394.6 6395.3 6616.5 6284.4 6321.3 6444.1 6466.8 6600.7 16:53:29 INFO - PID 15256 | 16:53:29 INFO - PID 15256 | [#4] prototype.html Cycles:180 Average:5027.05 Median:5826.44 stddev:1536.10 (26.4%) stddev-sans-first:1500.45 16:53:29 INFO - PID 15256 | Values: 389.3 392.1 393.4 393.7 397.8 5664.9 5696.3 5701.1 5708.3 5709.5 5463.0 5564.2 5622.8 5633.0 5660.6 4387.8 4397.1 4409.9 4429.5 4431.2 4417.6 4420.0 4422.9 4429.7 4430.4 4079.4 4232.6 4234.4 4246.5 4385.2 4205.0 4229.1 4230.1 4239.0 4241.8 3648.6 3677.9 3683.4 3701.6 3703.0 5352.3 5446.9 5522.8 5541.4 5548.3 4970.3 4977.3 4992.0 4998.2 5015.9 5970.6 6072.0 6080.5 6086.4 6091.6 4129.5 4137.1 4157.6 4159.0 4182.4 6003.0 6168.9 6244.3 6285.0 6323.1 3836.3 4082.9 4096.9 4097.3 4123.3 4162.7 4246.5 4247.5 4255.5 4256.9 4916.1 4930.6 4939.3 4952.7 4955.9 5774.7 6003.3 6012.9 6038.4 6038.7 1456.1 1462.3 1463.0 1473.4 1480.2 940.5 960.6 973.7 975.4 985.6 5813.2 5819.9 5833.0 5858.2 5860.8 6257.2 6270.0 6280.4 6290.6 6297.0 5724.3 5787.2 5809.6 5847.2 5864.9 3264.5 3278.6 3279.9 3297.2 3301.1 6327.4 6379.3 6416.3 6443.3 6471.6 6338.8 6384.9 6388.6 6416.4 6424.0 6203.6 6385.8 6395.6 6411.9 6455.3 6227.3 6241.9 6255.7 6260.8 6268.7 5989.4 6137.7 6193.2 6200.9 6215.9 6433.7 6438.5 6446.7 6459.6 6460.2 4226.9 4229.7 4232.6 4245.4 4246.8 5993.0 6269.2 6270.6 6291.7 6292.7 6016.9 6073.9 6099.0 6107.2 6119.8 5908.6 5990.5 6050.4 6060.6 6062.7 6011.2 6027.5 6031.9 6032.3 6050.8 5955.3 6088.2 6120.4 6128.7 6133.3 5872.1 5873.9 5888.9 5918.2 5942.2 16:53:29 INFO - PID 15256 | 16:53:29 INFO - PID 15256 | [#5] yui.html Cycles:180 Average:17901.47 Median:22967.95 stddev:21419.78 (93.3%) stddev-sans-first:21441.27 16:53:29 INFO - PID 15256 | Values: 778.1 872.2 895.5 897.3 910.9 13716.3 17318.8 17698.6 17748.6 17919.6 15714.5 15960.4 15965.8 15973.8 15974.9 997.9 1019.3 1036.2 1036.7 1036.8 737.2 752.4 909.5 1047.5 1050.0 1088.9 1097.2 1097.4 1097.6 1098.2 1092.4 1093.5 1094.5 1095.2 1096.1 801.4 803.5 803.5 803.6 804.3 16552.4 16664.4 16753.6 17692.9 17867.1 18879.2 19079.4 19200.6 19205.4 19421.9 13703.3 14104.1 14225.5 14246.7 14319.5 3468.8 3469.8 3489.6 3493.6 3502.3 83861.6 84744.6 85915.1 86504.6 87259.1 14624.6 14789.7 14804.4 14870.5 14901.8 26514.0 26712.2 27065.9 27450.2 27681.2 8249.5 8250.4 8289.0 8334.3 8342.0 3919.4 4085.1 4110.5 4132.8 4200.5 4516.3 4548.6 4622.6 4626.7 4628.0 887.2 894.0 899.6 900.6 902.2 720.9 729.1 740.5 750.7 753.5 10607.4 11736.8 11811.6 11868.1 11953.5 694.8 698.4 721.1 727.3 732.1 5151.9 5297.1 5346.3 5409.2 5585.0 72898.0 74029.6 74800.6 76059.6 77650.0 66543.7 66941.7 67995.0 68119.7 68425.0 52963.9 57456.4 57666.0 58258.4 59042.4 10721.1 11235.8 11311.8 11351.8 11414.1 33295.0 33516.3 34197.8 34598.0 34964.0 40520.4 40726.2 41599.0 42025.8 42715.6 14588.6 14683.3 14810.3 14942.1 14992.8 15099.5 15321.5 15472.4 15479.4 15770.2 14565.7 14624.9 14793.5 14849.5 14968.3 14383.9 14440.7 14473.9 14761.6 17505.0 16383.8 16511.8 16756.7 16757.7 17138.6 11084.6 11223.4 11536.4 11984.3 12163.3 12629.3 13235.7 13249.9 13280.5 13408.4 16:53:29 INFO - PID 15256 | -------- Summary: end -------- 16:53:29 INFO - PID 15256 | 16:53:30 INFO - TEST-INFO | 15256: exit 0 16:53:30 INFO - TEST-OK | dromaeo_css | took 1115336ms 16:53:30 INFO - TEST-START | kraken 16:53:30 INFO - operating with platform_type : linux_ 16:53:30 INFO - Initialising browser for kraken test... 16:53:30 INFO - TEST-INFO | started process 15587 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmplhXnbK/profile http://localhost:41917/getInfo.html) 16:53:34 INFO - PID 15587 | __metrics Screen width/height:1600/1200 16:53:34 INFO - PID 15587 | colorDepth:24 16:53:34 INFO - PID 15587 | Browser inner width/height: 1024/697 16:53:34 INFO - PID 15587 | __metrics 16:53:35 INFO - PID 15587 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 673: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 16:53:35 INFO - PID 15587 | JavaScript error: resource:///modules/BrowserUsageTelemetry.jsm, line 334: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:53:36 INFO - TEST-INFO | 15587: exit 0 16:53:36 INFO - Browser initialized. 16:53:36 INFO - Running cycle 1/1 for kraken test... 16:53:36 INFO - TEST-INFO | started process 15687 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmplhXnbK/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:53:48 INFO - PID 15687 | RSS: Main: 151388160 16:53:48 INFO - PID 15687 | 16:53:50 INFO - PID 15687 | Cycle 1(1): loaded http://localhost:41917/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:41917/tests/kraken/driver.html?testName=audio-beat-detection) 16:53:51 INFO - PID 15687 | RSS: Main: 223137792 16:53:51 INFO - PID 15687 | 16:53:54 INFO - PID 15687 | Cycle 1(1): loaded http://localhost:41917/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:41917/tests/kraken/driver.html?testName=audio-dft) 16:53:54 INFO - PID 15687 | RSS: Main: 183992320 16:53:54 INFO - PID 15687 | 16:53:57 INFO - PID 15687 | Cycle 1(1): loaded http://localhost:41917/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:41917/tests/kraken/driver.html?testName=audio-fft) 16:53:58 INFO - PID 15687 | RSS: Main: 264916992 16:53:58 INFO - PID 15687 | 16:54:00 INFO - PID 15687 | Cycle 1(1): loaded http://localhost:41917/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:41917/tests/kraken/driver.html?testName=audio-oscillator) 16:54:00 INFO - PID 15687 | RSS: Main: 177106944 16:54:00 INFO - PID 15687 | 16:54:02 INFO - PID 15687 | Cycle 1(1): loaded http://localhost:41917/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:41917/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:54:03 INFO - PID 15687 | RSS: Main: 179523584 16:54:03 INFO - PID 15687 | 16:54:06 INFO - PID 15687 | Cycle 1(1): loaded http://localhost:41917/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:41917/tests/kraken/driver.html?testName=imaging-darkroom) 16:54:07 INFO - PID 15687 | RSS: Main: 240455680 16:54:07 INFO - PID 15687 | 16:54:10 INFO - PID 15687 | Cycle 1(1): loaded http://localhost:41917/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:41917/tests/kraken/driver.html?testName=imaging-desaturate) 16:54:11 INFO - PID 15687 | RSS: Main: 258764800 16:54:11 INFO - PID 15687 | 16:54:13 INFO - PID 15687 | Cycle 1(1): loaded http://localhost:41917/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:41917/tests/kraken/driver.html?testName=json-parse-financial) 16:54:14 INFO - PID 15687 | RSS: Main: 272687104 16:54:14 INFO - PID 15687 | 16:54:15 INFO - PID 15687 | Cycle 1(1): loaded http://localhost:41917/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:41917/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:54:16 INFO - PID 15687 | RSS: Main: 204808192 16:54:16 INFO - PID 15687 | 16:54:18 INFO - PID 15687 | Cycle 1(1): loaded http://localhost:41917/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:41917/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:54:18 INFO - PID 15687 | RSS: Main: 209256448 16:54:18 INFO - PID 15687 | 16:54:20 INFO - PID 15687 | Cycle 1(1): loaded http://localhost:41917/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:41917/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:54:21 INFO - PID 15687 | RSS: Main: 218746880 16:54:21 INFO - PID 15687 | 16:54:23 INFO - PID 15687 | Cycle 1(1): loaded http://localhost:41917/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:41917/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:54:24 INFO - PID 15687 | RSS: Main: 226664448 16:54:24 INFO - PID 15687 | 16:54:27 INFO - PID 15687 | Cycle 1(1): loaded http://localhost:41917/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:41917/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:54:28 INFO - PID 15687 | RSS: Main: 222875648 16:54:28 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | Cycle 1(1): loaded http://localhost:41917/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:41917/tests/kraken/driver.html?testName=ai-astar) 16:54:29 INFO - PID 15687 | RSS: Main: 272465920 16:54:29 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | __start_tp_report 16:54:29 INFO - PID 15687 | _x_x_mozilla_page_load 16:54:29 INFO - PID 15687 | _x_x_mozilla_page_load_details 16:54:29 INFO - PID 15687 | |i|pagename|runs| 16:54:29 INFO - PID 15687 | |0;ai-astar;103;109;109;110;111;108;109;109;110;109 16:54:29 INFO - PID 15687 | |1;audio-beat-detection;141;120;127;169;119;118;118;118;142;118 16:54:29 INFO - PID 15687 | |2;audio-dft;160;160;161;161;162;161;161;162;163;162 16:54:29 INFO - PID 15687 | |3;audio-fft;73;75;74;109;75;75;74;73;96;75 16:54:29 INFO - PID 15687 | |4;audio-oscillator;83;81;106;83;83;83;96;83;83;104 16:54:29 INFO - PID 15687 | |5;imaging-gaussian-blur;114;114;113;114;113;114;113;113;113;113 16:54:29 INFO - PID 15687 | |6;imaging-darkroom;147;146;147;147;147;147;146;148;146;147 16:54:29 INFO - PID 15687 | |7;imaging-desaturate;95;94;94;94;93;93;93;94;94;93 16:54:29 INFO - PID 15687 | |8;json-parse-financial;47;45;46;48;48;48;48;48;47;48 16:54:29 INFO - PID 15687 | |9;json-stringify-tinderbox;54;54;54;55;55;54;56;54;54;54 16:54:29 INFO - PID 15687 | |10;stanford-crypto-aes;82;81;80;82;83;80;81;82;80;81 16:54:29 INFO - PID 15687 | |11;stanford-crypto-ccm;129;132;130;124;123;129;124;123;177;123 16:54:29 INFO - PID 15687 | |12;stanford-crypto-pbkdf2;182;185;181;175;184;182;179;181;187;177 16:54:29 INFO - PID 15687 | |13;stanford-crypto-sha256-iterative;66;64;66;65;66;64;64;64;66;64 16:54:29 INFO - PID 15687 | __end_tp_report 16:54:29 INFO - PID 15687 | __start_cc_report 16:54:29 INFO - PID 15687 | _x_x_mozilla_cycle_collect,1673 16:54:29 INFO - PID 15687 | __end_cc_report 16:54:29 INFO - PID 15687 | __startTimestamp1493423669938__endTimestamp 16:54:29 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | ------- Summary: start ------- 16:54:29 INFO - PID 15687 | Number of tests: 14 16:54:29 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | [#0] ai-astar Cycles:10 Average:108.70 Median:109.00 stddev:2.16 (2.0%) stddev-sans-first:0.87 16:54:29 INFO - PID 15687 | Values: 103.0 109.0 109.0 110.0 111.0 108.0 109.0 109.0 110.0 109.0 16:54:29 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | [#1] audio-beat-detection Cycles:10 Average:129.00 Median:123.50 stddev:16.94 (13.7%) stddev-sans-first:17.40 16:54:29 INFO - PID 15687 | Values: 141.0 120.0 127.0 169.0 119.0 118.0 118.0 118.0 142.0 118.0 16:54:29 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | [#2] audio-dft Cycles:10 Average:161.30 Median:161.50 stddev:0.95 (0.6%) stddev-sans-first:0.88 16:54:29 INFO - PID 15687 | Values: 160.0 160.0 161.0 161.0 162.0 161.0 161.0 162.0 163.0 162.0 16:54:29 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | [#3] audio-fft Cycles:10 Average:79.90 Median:75.00 stddev:12.32 (16.4%) stddev-sans-first:12.82 16:54:29 INFO - PID 15687 | Values: 73.0 75.0 74.0 109.0 75.0 75.0 74.0 73.0 96.0 75.0 16:54:29 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | [#4] audio-oscillator Cycles:10 Average:88.50 Median:83.00 stddev:9.66 (11.6%) stddev-sans-first:10.04 16:54:29 INFO - PID 15687 | Values: 83.0 81.0 106.0 83.0 83.0 83.0 96.0 83.0 83.0 104.0 16:54:29 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | [#5] imaging-gaussian-blur Cycles:10 Average:113.40 Median:113.50 stddev:0.52 (0.5%) stddev-sans-first:0.50 16:54:29 INFO - PID 15687 | Values: 114.0 114.0 113.0 114.0 113.0 114.0 113.0 113.0 113.0 113.0 16:54:29 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | [#6] imaging-darkroom Cycles:10 Average:146.80 Median:147.00 stddev:0.63 (0.4%) stddev-sans-first:0.67 16:54:29 INFO - PID 15687 | Values: 147.0 146.0 147.0 147.0 147.0 147.0 146.0 148.0 146.0 147.0 16:54:29 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | [#7] imaging-desaturate Cycles:10 Average:93.70 Median:94.00 stddev:0.67 (0.7%) stddev-sans-first:0.53 16:54:29 INFO - PID 15687 | Values: 95.0 94.0 94.0 94.0 93.0 93.0 93.0 94.0 94.0 93.0 16:54:29 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | [#8] json-parse-financial Cycles:10 Average:47.30 Median:48.00 stddev:1.06 (2.2%) stddev-sans-first:1.12 16:54:29 INFO - PID 15687 | Values: 47.0 45.0 46.0 48.0 48.0 48.0 48.0 48.0 47.0 48.0 16:54:29 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | [#9] json-stringify-tinderbox Cycles:10 Average:54.40 Median:54.00 stddev:0.70 (1.3%) stddev-sans-first:0.73 16:54:29 INFO - PID 15687 | Values: 54.0 54.0 54.0 55.0 55.0 54.0 56.0 54.0 54.0 54.0 16:54:29 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | [#10] stanford-crypto-aes Cycles:10 Average:81.20 Median:81.50 stddev:1.03 (1.3%) stddev-sans-first:1.05 16:54:29 INFO - PID 15687 | Values: 82.0 81.0 80.0 82.0 83.0 80.0 81.0 82.0 80.0 81.0 16:54:29 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | [#11] stanford-crypto-ccm Cycles:10 Average:131.40 Median:129.00 stddev:16.38 (12.7%) stddev-sans-first:17.35 16:54:29 INFO - PID 15687 | Values: 129.0 132.0 130.0 124.0 123.0 129.0 124.0 123.0 177.0 123.0 16:54:29 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:181.30 Median:182.00 stddev:3.62 (2.0%) stddev-sans-first:3.83 16:54:29 INFO - PID 15687 | Values: 182.0 185.0 181.0 175.0 184.0 182.0 179.0 181.0 187.0 177.0 16:54:29 INFO - PID 15687 | 16:54:29 INFO - PID 15687 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:64.90 Median:65.50 stddev:0.99 (1.5%) stddev-sans-first:0.97 16:54:29 INFO - PID 15687 | Values: 66.0 64.0 66.0 65.0 66.0 64.0 64.0 64.0 66.0 64.0 16:54:29 INFO - PID 15687 | -------- Summary: end -------- 16:54:29 INFO - PID 15687 | 16:54:31 INFO - TEST-INFO | 15687: exit 0 16:54:31 INFO - TEST-OK | kraken | took 60657ms 16:54:31 INFO - SUITE-END | took 1175s 16:54:31 INFO - Completed test suite (00:19:36) 16:54:31 INFO - javascript benchmark 16:54:31 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": [], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7633.139797617019, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3258.9185270368225, 3270.0189943017094, 3291.9506207406894, 3317.7843440176403, 3326.301476689895, 5675.063614503602, 5772.538196944245, 5801.419858014191, 5811.418858114186, 5827.300723913126, 5771.567132465061, 5791.305043394788, 5815.680137592431, 5816.098504731774, 5893.263342082239, 5027.673201241926, 5068.645194836354, 5082.466341034194, 5082.695038297696, 5131.769070391822, 5173.534381905628, 5201.531862132408, 5224.268602395668, 5226.3989641191365, 5249.42256351801, 5178.974105129488, 5223.059849227137, 5228.581713462914, 5235.214717792323, 5240.3187585614005, 5091.974540127313, 5135.871603209912, 5145.691258524463, 5191.32512773337, 5226.372835259755, 5131.538161565477, 5137.460566640524, 5137.614678899097, 5138.74306284688, 5211.2443695663915, 5716.1997320375185, 5762.982955965421, 5778.248827652378, 5791.536677065825, 5839.883202335929, 6109.847253818646, 6129.358790882775, 6139.093519790236, 6148.292946311142, 6274.372562743689, 6318.494520438354, 6331.0, 6335.904961425582, 6336.936630633681, 6355.618662880196, 5846.8538286542325, 5863.76544938202, 5884.235049443588, 5891.96890544153, 5937.495312898409, 6124.2693482561845, 6281.466075383552, 6335.524835637346, 6341.841453963688, 6349.777757778455, 5966.910496342558, 6004.189434426384, 6034.064719968412, 6047.334793172748, 6048.637081775019, 6138.357744607992, 6147.293061297919, 6147.477464415485, 6181.443670069625, 6237.0, 6095.268567771807, 6158.938410615926, 6167.105769663373, 6175.980963141032, 6176.6911654418, 6155.169052177898, 6158.291796443376, 6163.260408750889, 6165.290991535941, 6175.413335733098, 4724.078804633133, 4739.3838800955655, 4742.217534106902, 4756.048790241965, 4801.01579176268, 4235.788210589458, 4240.809163587646, 4252.681048921343, 4273.572642735701, 4275.0, 5886.646801191942, 5895.764169433174, 5898.4101589840675, 5906.5570082244, 5907.8227653169615, 6106.764041036324, 6171.6297022178815, 6236.158118654014, 6289.40250676185, 6314.936850631527, 5908.143319218775, 5908.822735317947, 5911.9113213301835, 5927.673977931169, 5965.492933100735, 5418.214358917935, 5480.479354461319, 5489.451054894478, 5498.477644623755, 5502.119660854244, 6299.811005669837, 6381.8723625528155, 6422.486201103994, 6441.677916104176, 6531.346865313526, 6289.08808222796, 6324.272708638566, 6327.525435592257, 6329.588576742497, 6332.2717887441695, 6470.28826829039, 6502.349765023649, 6505.414512693691, 6518.837029074311, 6523.3150519194805, 6069.0592958091565, 6098.76506457472, 6122.479589234965, 6178.165947597017, 6190.907136393048, 6102.489251635809, 6135.661410523283, 6177.62934223948, 6188.81433556994, 6215.471684906834, 6096.405739310827, 6101.413632455682, 6121.3572574879, 6128.472568454306, 6130.570860039755, 5984.31180414258, 6003.5797494174985, 6069.848253793691, 6104.4505994460715, 6113.449789518964, 6052.75788968454, 6094.5014626406155, 6109.404666050415, 6113.506711826804, 6144.969275153596, 6036.486898613492, 6090.817275481565, 6096.451319381277, 6105.267367915879, 6124.969375153096, 5869.266341707286, 5926.733297001731, 5928.49607783326, 5930.614510056833, 5933.851653708692], "value": 5710.835022943995, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [713.1620346093342, 757.3297631596037, 783.1776634533738, 1134.9432528373575, 1163.7963356412627, 29095.272618184557, 29644.851775741117, 35649.643503564956, 36428.0, 36539.451908221396, 39301.21397572047, 39684.801575992155, 39707.801460992654, 39713.40429893554, 39747.602523974754, 5666.575006874501, 7206.279372062778, 7361.889571656429, 7362.484626076177, 7371.152317483477, 5735.913961290584, 7086.503944723871, 7264.782056538313, 7265.455090868206, 7268.527545709512, 7307.451941104412, 7357.852842943138, 7358.300961408658, 7358.816029599249, 7359.3744531714865, 5673.6879471629045, 7277.3814225790875, 7323.7070517179245, 7331.596762178078, 7337.00950371701, 5731.914021289684, 7013.26360732126, 7250.274972502761, 7252.3110304521515, 7255.09311336083, 35866.0, 36067.63932360669, 36145.81927090374, 36219.0, 36222.8188859054, 3565.8217089145696, 3604.4593311003296, 3611.2416392557593, 3615.0, 3619.348517266891, 28903.0, 29110.0, 29196.124116276547, 29228.0, 29252.41495170106, 3776.754510956779, 3824.29250588642, 3825.48355971943, 3840.961590384088, 3870.806459677005, 185950.0, 185974.99999999866, 185990.0, 186673.0, 186689.0, 49001.0, 49028.26457603139, 49189.508104918496, 49210.0, 49211.50788492141, 51011.74494127506, 51032.74483627558, 51067.7446612772, 51086.74456627767, 51119.7444012785, 15441.382344706311, 15516.68966620684, 15517.5344739658, 15520.689586208438, 15532.378704851906, 11002.559897604166, 11210.831837522444, 12710.555130570385, 12713.809292860615, 12718.0, 14875.181864997528, 15270.618234544225, 15286.541403757905, 15307.0, 15431.61420964485, 5976.322493631068, 6029.8191054268445, 6040.667763272974, 6166.766646670684, 6170.938290617126, 1049.7952899184586, 1063.7978784031009, 1078.978420431587, 1086.7935092332589, 1088.482970588964, 26675.862616479597, 26962.0, 26996.1901142966, 27175.45649087007, 27197.456050879267, 1182.5624518928053, 1183.5502509046507, 1189.6728399689982, 1194.4863708605383, 1195.1156144453041, 13323.66690832737, 13680.863191367958, 13758.17450952926, 13945.0, 13949.0, 229088.0, 229948.0, 230569.0, 230865.0, 231361.0, 53656.195157072674, 54089.0, 54110.45889541133, 54142.45857541453, 54210.72894635502, 1449.0943160524673, 1497.7378958682186, 1522.5127959053218, 1522.7335216337096, 1526.63360793411, 23985.760142398354, 25027.374315642253, 25167.0, 25259.115930942327, 25375.746242537338, 37479.62520374871, 37615.0, 37702.62297376991, 37709.622903770614, 37746.245075098894, 209675.0, 210065.0, 210608.0, 211019.0, 211498.0, 28943.710562894103, 29542.704572953997, 34200.0, 34437.65562344345, 35534.822325888206, 42856.0, 43842.56157438385, 45974.77012614915, 46191.76904115592, 46555.0, 35029.0, 35079.64920350764, 35199.12002199863, 35758.28483430265, 36457.81771091127, 35371.29257414786, 35856.820715896254, 35897.820510897276, 36366.0, 37355.626443735215, 40131.39802903017, 42177.36733948932, 42180.36729449122, 42292.36561451642, 42643.0, 35049.64950350566, 35154.82422587871, 35305.47041794426, 35436.46845297271, 36267.81866090652, 26739.86630066915, 28375.43249135047, 28518.0, 28681.713182867905, 28797.424051519272], "value": 17255.190767786677, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [435.59489674602605, 453.7050916904012, 458.9862304130877, 462.722366580052, 466.7782803168495, 20170.59658806825, 21273.68089478659, 21651.891740541294, 22335.888320558413, 22492.325230243117, 22115.225967091155, 22349.44126396841, 22613.660795088086, 22810.0, 22985.885070574623, 4498.685092043558, 5519.144532597444, 5677.460641239097, 5689.6017278790505, 5705.885882282352, 5576.745232322735, 5710.743016564244, 5720.256366672327, 5723.084306510959, 5726.3414707308775, 5441.156620723794, 5519.503244707976, 5636.577256705743, 5684.005299072666, 5694.829155125353, 5570.832875013736, 5613.045782217033, 5623.353314368859, 5623.8594035149035, 5627.099664053731, 5019.974900125512, 5051.621128415383, 5126.461721519224, 5168.405633352175, 5178.223266510016, 25125.62311565328, 25412.0, 25421.745782542122, 25479.0, 26357.73642263572, 2095.130520833852, 2157.892105394724, 2159.5356998245297, 2160.4274867160216, 2160.5786871560053, 16904.23930923099, 16943.322267109303, 17344.739828902577, 17378.826211737847, 17480.300787968594, 2155.698202251686, 2179.683945827862, 2227.922022729213, 2233.6649502574583, 2234.1510226114137, 92760.53619731926, 101961.0, 110431.44784276027, 111892.4405377976, 112383.0, 12466.252024878537, 12560.246385216917, 12906.548270810477, 13228.669283267995, 21298.893505532375, 18182.636257286467, 18189.7271540927, 18204.180811863498, 18207.0, 18280.45158645243, 9239.72280831576, 9296.814063718688, 9634.084761947604, 9718.319717619699, 9723.0, 8397.412181147261, 8619.870701939475, 8695.304375649934, 8778.561071946377, 9241.861372079424, 7965.641546130438, 8021.879671804928, 8120.228578285053, 8290.295324897452, 8351.742820300087, 2218.3234113595186, 2236.2843889955384, 2261.197274967363, 2266.3427605994075, 2417.5648383291177, 1006.3609607898891, 1051.8211903976342, 1061.4745700878116, 1061.5276202089997, 1062.4687656171914, 19105.617887642446, 21126.78873211279, 21396.78603213979, 21401.892990534947, 21449.11614900623, 1054.5781687324977, 1070.272214893864, 1085.3813326403874, 1085.8316960871077, 1095.8356246562919, 10949.452527373758, 11663.591774288028, 11680.649580512598, 11750.70623234409, 11781.646550603497, 451353.0, 456928.0, 456988.0, 459201.0, 482579.0, 86164.13835861687, 90415.0, 96430.0, 98351.0, 98499.0, 1155.2756093556409, 1201.8617858946159, 1230.2434003088035, 1242.8881400673984, 1244.7074937389887, 20244.08901599402, 20644.17423303111, 20774.58450831005, 21094.261700840398, 21194.470138246666, 45878.54121458876, 46744.83137921579, 46798.766006171114, 47506.76246618745, 47590.76204618955, 59348.0, 59566.0, 60151.39848601633, 60653.0902036461, 60797.39202608094, 9523.333366664267, 9740.269479789185, 9866.358686685342, 9916.107550320507, 9934.602615895283, 14750.63123421923, 15186.544403667907, 15250.313735882133, 15319.540413787605, 15842.12868292255, 13026.153300035467, 13277.070605057554, 13410.597682069554, 13468.393922273326, 13686.178829269877, 11957.222780519238, 11968.401579921143, 12551.623451296477, 12569.994400448126, 12917.28954907489, 12919.935400322938, 12931.418086186331, 13260.80108798388, 13590.796138058135, 13627.79558306646, 9361.110694484014, 9523.666671666459, 9538.761530961781, 9643.662471813454, 9840.212782977202, 12349.32078735678, 12403.689907752378, 12573.74852502963, 12765.297908615115, 13349.799753003907], "value": 10342.034909562453, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1332.6601716562277, 1394.7628903086475, 1413.5829930170596, 1419.7657386531223, 1420.6448387903024, 10432.0, 10841.728956776085, 10853.674389768299, 10854.185936054788, 10861.728456788584, 10643.0, 11184.888151118486, 11497.827532586996, 11578.826317605222, 11598.826017609743, 2291.553147136305, 2326.4532834783813, 2326.7905888470036, 2329.965050524235, 2330.067972810872, 1966.3412756726443, 2249.2465024216826, 2316.1546035696933, 2318.455163036685, 2319.7564255753155, 1956.911938962743, 2221.3891179925567, 2311.7341505726804, 2316.559853627814, 2318.0959425823944, 2210.10490751246, 2217.8780167090804, 2233.3188377544843, 2238.0935721032924, 2238.4963383238724, 2236.5303286309895, 2237.3735354100877, 2241.2827895073583, 2244.2706120510898, 2245.0682966568857, 11116.888831111666, 11241.775164496747, 11274.718132046683, 11299.378534180616, 11315.377654229096, 6039.849003774897, 6056.4851987581105, 6250.124982502453, 6266.624002559861, 6273.0, 3547.9822600887087, 3777.112378591029, 3898.727089103764, 3919.862804801818, 3919.9020024499614, 1279.8656141105237, 1304.8042793580944, 1335.0654541820668, 1386.8682475164844, 1393.2197969137214, 17343.739843902353, 17527.123643817886, 17531.649367012717, 17553.56116097108, 17563.73654395185, 4921.188003979303, 5071.46749591295, 5144.408393034774, 5219.947800522022, 5270.393904700932, 11847.407629618485, 11857.525698972117, 11905.880941190477, 11910.0, 11914.46384912681, 6222.253329600477, 6342.175517182829, 6342.682865856688, 6348.492120630339, 6349.238091428966, 5829.47534721877, 5950.8809823803285, 5981.611195272293, 5990.700464976734, 6001.279846418371, 4097.784205156681, 4151.086760912594, 4159.604837540429, 4199.950012496875, 4242.151569686013, 1039.8804137524282, 1138.1179585821055, 1147.0766033343239, 1151.9712007199719, 1157.890000449956, 790.6165509727778, 858.411987788367, 887.4630848336664, 895.9641614335484, 905.4160066757037, 6528.151340325728, 6603.570767900071, 6643.10318107059, 6679.0315404267085, 6816.965915170393, 967.3180407812475, 971.820213260549, 974.7563109222694, 981.7741919358588, 988.6391467114595, 4114.136031433372, 4218.704690671623, 4243.108947121139, 4340.913181736348, 4344.804483798237, 15254.161021143722, 15421.228938553251, 15574.143422111893, 15703.0, 15720.92139539295, 14581.0, 15428.15145167004, 15453.768193477106, 15455.84544154544, 15458.0, 9168.633254669872, 9401.341906066646, 9403.341766076446, 9406.858897116548, 9412.058794120534, 7199.3520583147765, 7356.77929662111, 7420.925790742023, 7517.285857843496, 7556.093268807778, 13525.59423217305, 13739.313034348443, 13890.166590004632, 13927.721445570829, 14109.576712698636, 13763.862361376257, 13973.790393143907, 14005.929970350491, 14177.432902683777, 14217.360218789972, 9302.581383837609, 9519.428834269966, 9696.95151524238, 9704.660336888175, 9770.218382529523, 11189.776204475702, 11240.718982025515, 11387.373694446886, 11387.886121138683, 11400.315981041163, 9044.321675874204, 9411.576479058322, 9486.95256523713, 9488.715338539854, 9508.85736713936, 8947.0, 8974.641014359353, 9081.137291957253, 9165.220956218529, 9195.0, 8081.797955051171, 8146.511209327459, 8197.754067377988, 8211.343092552463, 8212.753617391249, 6301.212348456443, 6365.586236894587, 6394.6482943436695, 6395.264544577433, 6616.470682345304, 6284.4344009039405, 6321.336259692666, 6444.130042444398, 6466.773662921775, 6600.669966501559], "value": 5341.366592552476, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [389.32646521517773, 392.0805710608624, 393.3568615313962, 393.74013151320133, 397.7514053716427, 5664.943350566493, 5696.287964004499, 5701.116326969316, 5708.286464191976, 5709.514691251238, 5462.972685136579, 5564.165375193713, 5622.8313150605545, 5633.014222511065, 5660.632058916168, 4387.824487020515, 4397.076613911083, 4409.889752756175, 4429.512753597118, 4431.1580799648045, 4417.580329868657, 4419.955800441987, 4422.933655995163, 4429.712068715539, 4430.379746835446, 4079.3676980068135, 4232.5767423257585, 4234.364845273203, 4246.490421149467, 4385.215388228466, 4205.0, 4229.133027729324, 4230.132822771356, 4238.97880510597, 4241.7879106044575, 3648.616895226016, 3677.9080522986874, 3683.355412802749, 3701.592824789298, 3703.0, 5352.330958630171, 5446.863828404282, 5522.834314970557, 5541.390447050821, 5548.250986116863, 4970.254461830718, 4977.278294647256, 4991.950080499185, 4998.150684246815, 5015.949840501585, 5970.641761494281, 6072.0, 6080.452759251689, 6086.360932102154, 6091.604045737057, 4129.504459464853, 4137.069159439132, 4157.646600039, 4158.958410415918, 4182.393552934807, 6002.96998515009, 6168.938310616882, 6244.250689917239, 6285.0, 6323.146375239376, 3836.3094642964534, 4082.9387559186634, 4096.91806163881, 4097.344424892003, 4123.299039163349, 4162.729422587522, 4246.5116511600945, 4247.511536173318, 4255.5318914919335, 4256.893577660583, 4916.0905232532095, 4930.605551555938, 4939.2838038484215, 4952.653314267966, 4955.851324460272, 5774.653520788766, 6003.279606447167, 6012.879742405127, 6038.365971573009, 6038.667873266924, 1456.0826679192041, 1462.276173294205, 1462.9926850365894, 1473.4179998900374, 1480.2228829864407, 940.4874343482818, 960.577345967772, 973.6884197057016, 975.3855071305175, 985.5663508056432, 5813.157092221604, 5819.883602328015, 5833.0, 5858.209141765892, 5860.765569377178, 6257.186565746424, 6269.96865015672, 6280.371962803774, 6290.591111577824, 6296.968515157395, 5724.341700704389, 5787.2187254720075, 5809.593328467051, 5847.152162936351, 5864.882702345929, 3264.526643636659, 3278.5901762279714, 3279.9016029519153, 3297.2086699192023, 3301.108700650811, 6327.386516438279, 6379.298277189506, 6416.294207637156, 6443.323451037667, 6471.640955399324, 6338.763941031455, 6384.913655260637, 6388.5528013039575, 6416.422521973045, 6423.96788016057, 6203.604189057426, 6385.776497822554, 6395.584287021329, 6411.903821442682, 6455.289918109098, 6227.283862355705, 6241.906371404523, 6255.655938923403, 6260.843478913063, 6268.6552239625435, 5989.371116032754, 6137.662428566472, 6193.163922870355, 6200.937990620217, 6215.9378406217165, 6433.7481881341155, 6438.484921206386, 6446.709898054505, 6459.580127291711, 6460.224773027267, 4226.89432764171, 4229.703920725519, 4232.64022558086, 4245.448091748053, 4246.808893599734, 5993.003498250874, 6269.18500594938, 6270.561060725706, 6291.748330066746, 6292.653904035322, 6016.909746353721, 6073.908891366545, 6099.0, 6107.236595425572, 6119.755209791559, 5908.615939963888, 5990.520758339235, 6050.364711705208, 6060.575769692158, 6062.696865156637, 6011.188489554029, 6027.457528822427, 6031.879362412639, 6032.276126864805, 6050.757969681164, 5955.344912059583, 6088.178095957166, 6120.44915957566, 6128.698675645624, 6133.294671112879, 5872.119182122716, 5873.9412605873395, 5888.851673923544, 5918.171455996078, 5942.168096466412], "value": 4544.504430950638, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [778.1362687416963, 872.1801506583811, 895.4940458640867, 897.3180382908987, 910.886139232596, 13716.314184290795, 17318.82681173188, 17698.557536061606, 17748.64502709945, 17919.552011199725, 15714.528564143066, 15960.441384551543, 15965.84034159658, 15973.840261597381, 15974.920125399385, 997.9471657401439, 1019.2763138171907, 1036.19694736579, 1036.6630844975375, 1036.7926414717049, 737.2406421385981, 752.4281546025034, 909.5179554835914, 1047.4762618690654, 1050.0077426831647, 1088.8638920134983, 1097.160672085855, 1097.4128841070028, 1097.6268068856587, 1098.1653943003334, 1092.431935393591, 1093.4860615510697, 1094.4637127807396, 1095.2005036323449, 1096.117625311624, 801.3709238247948, 803.4737247103157, 803.4978138663336, 803.6343463723991, 804.252045597594, 16552.42066527666, 16664.41674541385, 16753.581160470963, 17692.91153544237, 17867.106644667714, 18879.244830206775, 19079.427617171506, 19200.61598768017, 19205.423837284903, 19421.9028904856, 13703.314834258248, 14104.08323458972, 14225.502107426191, 14246.715065698732, 14319.498817541336, 3468.843902024415, 3469.826508674556, 3489.59869614995, 3493.6331685172945, 3502.317048175607, 83861.58069209676, 84744.57627711883, 85915.14084859134, 86504.56747716284, 87259.12740872637, 14624.634384140481, 14789.704205915821, 14804.407823687146, 14870.479533216285, 14901.776473352907, 26514.0, 26712.19863404101, 27065.86467067652, 27450.176494705192, 27681.169564913085, 8249.505029698237, 8250.422470427133, 8288.958555207306, 8334.291585215204, 8341.958290208631, 3919.3729003359326, 4085.101277718897, 4110.547839737626, 4132.772697501606, 4200.4539409876525, 4516.277395616751, 4548.56788605082, 4622.630189584893, 4626.7223966562115, 4628.0, 887.2166944441718, 894.0433735902521, 899.6086702284528, 900.6037343568939, 902.2105657549644, 720.9387202087777, 729.1104852080454, 740.481662836017, 750.6509473095037, 753.4913933095139, 10607.363558186533, 11736.765264694659, 11811.645650630495, 11868.109891758153, 11953.46209420578, 694.8471336306004, 698.4307789151825, 721.0842230367404, 727.2763600217711, 732.1287667675449, 5151.896962060738, 5297.073012222845, 5346.251524786533, 5409.188621706697, 5584.972075139598, 72898.0, 74029.62985185039, 74800.62599686967, 76059.61970190113, 77650.0, 66543.66728166328, 66941.66529167323, 67995.0, 68119.65940170268, 68425.0, 52963.94072118536, 57456.42543574594, 57666.0, 58258.417415826145, 59042.40957590455, 10721.142308615448, 11235.831462528233, 11311.7737645245, 11351.829722554003, 11414.143939204427, 33295.0, 33516.329673406886, 34197.82901085479, 34598.0, 34964.0, 40520.3921941177, 40726.1854762909, 41599.0, 42025.78987105045, 42715.57284427116, 14588.635284117981, 14683.339249734001, 14810.259487025822, 14942.103473791607, 14992.775108373165, 15099.471518496799, 15321.540353789404, 15472.381104755683, 15479.380824766884, 15770.211489425712, 14565.708685826436, 14624.85375146235, 14793.482228121964, 14849.480268190562, 14968.251587420367, 14383.928080359532, 14440.711185776436, 14473.92763036178, 14761.630959226106, 17505.0, 16383.836161638232, 16511.83488165103, 16756.664866702842, 16757.664846702755, 17138.571535711708, 11084.61203857861, 11223.4388280584, 11536.365499897585, 11984.340861252365, 12163.331016794162, 12629.305388203737, 13235.66910827237, 13249.933750331187, 13280.468781248643, 13408.396622152222], "value": 7995.064729041276, "unit": "score"}]}, {"extraOptions": [], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1481.8, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 109.0, 109.0, 110.0, 111.0, 108.0, 109.0, 109.0, 110.0, 109.0], "value": 108.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [141.0, 120.0, 127.0, 169.0, 119.0, 118.0, 118.0, 118.0, 142.0, 118.0], "value": 129.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 160.0, 161.0, 161.0, 162.0, 161.0, 161.0, 162.0, 163.0, 162.0], "value": 161.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [73.0, 75.0, 74.0, 109.0, 75.0, 75.0, 74.0, 73.0, 96.0, 75.0], "value": 79.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 81.0, 106.0, 83.0, 83.0, 83.0, 96.0, 83.0, 83.0, 104.0], "value": 88.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 114.0, 113.0, 114.0, 113.0, 114.0, 113.0, 113.0, 113.0, 113.0], "value": 113.4, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 146.0, 147.0, 147.0, 147.0, 147.0, 146.0, 148.0, 146.0, 147.0], "value": 146.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 94.0, 94.0, 94.0, 93.0, 93.0, 93.0, 94.0, 94.0, 93.0], "value": 93.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [47.0, 45.0, 46.0, 48.0, 48.0, 48.0, 48.0, 48.0, 47.0, 48.0], "value": 47.3, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 54.0, 54.0, 55.0, 55.0, 54.0, 56.0, 54.0, 54.0, 54.0], "value": 54.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 81.0, 80.0, 82.0, 83.0, 80.0, 81.0, 82.0, 80.0, 81.0], "value": 81.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [129.0, 132.0, 130.0, 124.0, 123.0, 129.0, 124.0, 123.0, 177.0, 123.0], "value": 131.4, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [182.0, 185.0, 181.0, 175.0, 184.0, 182.0, 179.0, 181.0, 187.0, 177.0], "value": 181.3, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 64.0, 66.0, 65.0, 66.0, 64.0, 64.0, 64.0, 66.0, 64.0], "value": 64.9, "unit": "score"}]}]} 16:54:31 INFO - Return code: 0 16:54:31 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 16:54:31 ERROR - # TBPL SUCCESS # 16:54:31 INFO - Running post-action listener: _resource_record_post_action 16:54:31 INFO - [mozharness: 2017-04-28 23:54:31.773210Z] Finished run-tests step (success) 16:54:31 INFO - Running post-run listener: _resource_record_post_run 16:54:31 INFO - Total resource usage - Wall time: 1193s; CPU: 13.0%; Read bytes: 389120; Write bytes: 359661568; Read time: 28; Write time: 246232 16:54:31 INFO - TinderboxPrint: CPU usage
12.9% 16:54:31 INFO - TinderboxPrint: I/O read bytes / time
389,120 / 28 16:54:31 INFO - TinderboxPrint: I/O write bytes / time
359,661,568 / 246,232 16:54:31 INFO - TinderboxPrint: CPU idle
8,293.9 (87.1%) 16:54:31 INFO - TinderboxPrint: CPU user
1,185.3 (12.4%) 16:54:31 INFO - TinderboxPrint: Swap in / out
0 / 0 16:54:31 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 108269568; Read time: 0; Write time: 103040 16:54:31 INFO - run-tests - Wall time: 1177s; CPU: 13.0%; Read bytes: 385024; Write bytes: 251392000; Read time: 16; Write time: 143192 16:54:32 INFO - Running post-run listener: _upload_blobber_files 16:54:32 INFO - Blob upload gear active. 16:54:32 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 16:54:32 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:54:32 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:54:32 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:54:32 INFO - (blobuploader) - INFO - Open directory for files ... 16:54:32 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 16:54:32 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:54:32 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:54:33 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 16:54:33 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:54:33 INFO - (blobuploader) - INFO - Done attempting. 16:54:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 16:54:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:54:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:54:38 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 16:54:38 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:54:38 INFO - (blobuploader) - INFO - Done attempting. 16:54:38 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 16:54:38 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:54:38 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:54:39 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 16:54:39 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:54:39 INFO - (blobuploader) - INFO - Done attempting. 16:54:39 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 16:54:39 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:54:39 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:54:40 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 16:54:40 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:54:40 INFO - (blobuploader) - INFO - Done attempting. 16:54:40 INFO - (blobuploader) - INFO - Iteration through files over. 16:54:40 INFO - Return code: 0 16:54:40 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 16:54:40 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 16:54:40 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/1172a2fad9ec752efdd438489d00e8852f40bdf028765bb14bfefd3fd1c5ccdc6943ab655f0aa629cb335f0ff2edafb419ba90f906b08f535dc9bf4cba5241a4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/1e1dbe7c09396197496c0d408de8cdc4cb80c3c3a794fdaced1c66bbf7c436e7a29019b1f62eed961d094e5f5555125c25bb84261af2e8be980f5398cfb6da48", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/19a60f6bd449e8f721682bb5021cce0d25039e5ee63437a91332c3062caf008fcb042239599f99bcd25386a58504196a38a09a9f7084e8eb8a15494c9f065522", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c962683142558a4a549cc5ada6c378709267cf5aa2108c684bd233f635ec1a519756d1bd59bd6cc42e16baf3fb0670dc9c53dbce7775ff2d82756ac4edffb530"} 16:54:40 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 16:54:40 INFO - Writing to file /builds/slave/test/properties/blobber_files 16:54:40 INFO - Contents: 16:54:40 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/1172a2fad9ec752efdd438489d00e8852f40bdf028765bb14bfefd3fd1c5ccdc6943ab655f0aa629cb335f0ff2edafb419ba90f906b08f535dc9bf4cba5241a4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/1e1dbe7c09396197496c0d408de8cdc4cb80c3c3a794fdaced1c66bbf7c436e7a29019b1f62eed961d094e5f5555125c25bb84261af2e8be980f5398cfb6da48", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/19a60f6bd449e8f721682bb5021cce0d25039e5ee63437a91332c3062caf008fcb042239599f99bcd25386a58504196a38a09a9f7084e8eb8a15494c9f065522", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c962683142558a4a549cc5ada6c378709267cf5aa2108c684bd233f635ec1a519756d1bd59bd6cc42e16baf3fb0670dc9c53dbce7775ff2d82756ac4edffb530"} 16:54:40 INFO - Running post-run listener: copy_logs_to_upload_dir 16:54:40 INFO - Copying logs to upload dir... 16:54:40 INFO - mkdir: /builds/slave/test/build/upload/logs 16:54:40 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1252.382336 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 52 secs) (at 2017-04-28 16:54:40.163371) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-04-28 16:54:40.169724) ========= 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=1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/1172a2fad9ec752efdd438489d00e8852f40bdf028765bb14bfefd3fd1c5ccdc6943ab655f0aa629cb335f0ff2edafb419ba90f906b08f535dc9bf4cba5241a4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/1e1dbe7c09396197496c0d408de8cdc4cb80c3c3a794fdaced1c66bbf7c436e7a29019b1f62eed961d094e5f5555125c25bb84261af2e8be980f5398cfb6da48", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/19a60f6bd449e8f721682bb5021cce0d25039e5ee63437a91332c3062caf008fcb042239599f99bcd25386a58504196a38a09a9f7084e8eb8a15494c9f065522", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c962683142558a4a549cc5ada6c378709267cf5aa2108c684bd233f635ec1a519756d1bd59bd6cc42e16baf3fb0670dc9c53dbce7775ff2d82756ac4edffb530"} build_url:https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011229 build_url: 'https://queue.taskcluster.net/v1/task/DaZH08FRTw6H11wAXAindQ/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/1172a2fad9ec752efdd438489d00e8852f40bdf028765bb14bfefd3fd1c5ccdc6943ab655f0aa629cb335f0ff2edafb419ba90f906b08f535dc9bf4cba5241a4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/1e1dbe7c09396197496c0d408de8cdc4cb80c3c3a794fdaced1c66bbf7c436e7a29019b1f62eed961d094e5f5555125c25bb84261af2e8be980f5398cfb6da48", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/19a60f6bd449e8f721682bb5021cce0d25039e5ee63437a91332c3062caf008fcb042239599f99bcd25386a58504196a38a09a9f7084e8eb8a15494c9f065522", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c962683142558a4a549cc5ada6c378709267cf5aa2108c684bd233f635ec1a519756d1bd59bd6cc42e16baf3fb0670dc9c53dbce7775ff2d82756ac4edffb530"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-04-28 16:54:40.194578) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-04-28 16:54:40.194868) ========= 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=1f5564757af27664ca02d71f000001b0-1493422425.927412-643041031 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004555 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-04-28 16:54:40.277056) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-04-28 16:54:40.279394) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-04-28 16:54:40.279709) ========= ========= Total master_lag: 0.19 =========